Console Output

Skipping 220 KB.. Full Log
I0709 00:27:10.006408   12564 postexecutorstep.go:88] Executing step: remove previous image
I0709 00:27:10.006440   12564 postexecutorstep.go:102] Removing previously-tagged image sha256:eeb1238ba9eec4f92ff7391347e7c4de606d4249f225c5d28905df700cd6f15c
I0709 00:27:10.012000   12564 docker.go:980] Removing container "f169c50842cbc20dcadfceff9d98bd3bb79427acf4c77126458db59210277837" ...
I0709 00:27:10.023945   12564 docker.go:990] Removed container "f169c50842cbc20dcadfceff9d98bd3bb79427acf4c77126458db59210277837"
I0709 00:27:10.024104   12564 cleanup.go:33] Removing temporary directory /tmp/s2i268513643
I0709 00:27:10.024146   12564 fs.go:314] Removing directory '/tmp/s2i268513643'
--- PASS: TestIncrementalBuildAndRemovePreviousImage (8.18s)
=== RUN   TestIncrementalBuildAndKeepPreviousImage
I0709 00:27:11.565900   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:11.571309   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:11.571369   12564 docker.go:730] Image sha256:0bf6fa8d65546a5ca414e692035bbce64d7372174b26421d7b3dc2ce49192759 contains io.openshift.s2i.scripts-url set to "http://127.0.0.1:23456/.s2i/bin"
I0709 00:27:11.571423   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:11.571548   12564 sti.go:204] Preparing to build test/sti-incremental-app
I0709 00:27:11.571975   12564 clone.go:36] Downloading "https://github.com/openshift/ruby-hello-world" ...
I0709 00:27:11.572027   12564 clone.go:40] Cloning sources into "/tmp/s2i097710293/upload/src"
I0709 00:27:11.818084   12564 clone.go:56] Checked out "HEAD"
I0709 00:27:11.841713   12564 clone.go:62] Updated submodules for "HEAD"
I0709 00:27:11.854179   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/assemble'
I0709 00:27:11.854303   12564 install.go:261] Using "assemble" installed from "http://127.0.0.1:23456/.s2i/bin/assemble"
I0709 00:27:11.855791   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/run'
I0709 00:27:11.855901   12564 install.go:261] Using "run" installed from "http://127.0.0.1:23456/.s2i/bin/run"
I0709 00:27:11.857350   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/save-artifacts'
I0709 00:27:11.857451   12564 install.go:261] Using "save-artifacts" installed from "http://127.0.0.1:23456/.s2i/bin/save-artifacts"
I0709 00:27:11.857552   12564 ignore.go:66] .s2iignore file does not exist
I0709 00:27:11.857587   12564 sti.go:213] Clean build will be performed
I0709 00:27:11.857628   12564 sti.go:216] Performing source build from https://github.com/openshift/ruby-hello-world
I0709 00:27:11.857690   12564 sti.go:227] Running "assemble" in "test/sti-incremental-app"
I0709 00:27:11.857739   12564 sti.go:585] Using image name sti_test/sti-fake
I0709 00:27:11.859987   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:11.860106   12564 environment.go:41] Setting 1 environment variables provided by environment file in sources
I0709 00:27:11.860277   12564 sti.go:703] starting the source uploading ...
I0709 00:27:11.860340   12564 tar.go:239] Adding "/tmp/s2i097710293/upload" to tar ...
I0709 00:27:11.860711   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/scripts as scripts
I0709 00:27:11.864205   12564 docker.go:793] Both scripts and untarred source will be placed in '/tmp'
I0709 00:27:11.864295   12564 docker.go:961] Setting "/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble" command for container ...
I0709 00:27:11.864620   12564 docker.go:970] Creating container with options {Name:"s2i_sti_test_sti_fake_846cd776" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:true StdinOnce:true Env:[RACK_ENV=production] Cmd:[/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble] Healthcheck:<nil> ArgsEscaped:false Image:sti_test/sti-fake:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:12.234007   12564 docker.go:1002] Attaching to container "deba9d61b5b77005bc0952d81946666213868afdf1d45368d1952070bb562b6d" ...
I0709 00:27:12.235506   12564 docker.go:1013] Starting container "deba9d61b5b77005bc0952d81946666213868afdf1d45368d1952070bb562b6d" ...
I0709 00:27:12.528422   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/scripts/assemble as scripts/assemble
I0709 00:27:12.528991   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/scripts/run as scripts/run
I0709 00:27:12.529507   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/scripts/save-artifacts as scripts/save-artifacts
I0709 00:27:12.530126   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src as src
I0709 00:27:12.533559   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/.gitignore as src/.gitignore
I0709 00:27:12.534111   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/.s2i as src/.s2i
I0709 00:27:12.534614   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/.s2i/bin as src/.s2i/bin
I0709 00:27:12.535061   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/.s2i/bin/README as src/.s2i/bin/README
I0709 00:27:12.535558   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/.s2i/environment as src/.s2i/environment
I0709 00:27:12.535984   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/.travis.yml as src/.travis.yml
I0709 00:27:12.536441   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/Dockerfile as src/Dockerfile
I0709 00:27:12.537015   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/Gemfile as src/Gemfile
I0709 00:27:12.537641   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/Gemfile.lock as src/Gemfile.lock
I0709 00:27:12.538152   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/README.md as src/README.md
I0709 00:27:12.539179   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/Rakefile as src/Rakefile
I0709 00:27:12.540160   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/app.rb as src/app.rb
I0709 00:27:12.541124   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/config as src/config
I0709 00:27:12.541888   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/config/database.rb as src/config/database.rb
I0709 00:27:12.542395   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/config/database.yml as src/config/database.yml
I0709 00:27:12.542904   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/config.ru as src/config.ru
I0709 00:27:12.543397   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/db as src/db
I0709 00:27:12.543911   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/db/migrate as src/db/migrate
I0709 00:27:12.544435   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/db/migrate/20141102191902_create_key_pair.rb as src/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:12.544845   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/models.rb as src/models.rb
I0709 00:27:12.545218   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/run.sh as src/run.sh
I0709 00:27:12.545588   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/test as src/test
I0709 00:27:12.546106   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/test/sample_test.rb as src/test/sample_test.rb
I0709 00:27:12.546649   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/views as src/views
I0709 00:27:12.547106   12564 tar.go:337] Adding to tar: /tmp/s2i097710293/upload/src/views/main.erb as src/views/main.erb
I0709 00:27:12.596662   12564 docker.go:1044] Waiting for container "deba9d61b5b77005bc0952d81946666213868afdf1d45368d1952070bb562b6d" to stop ...
I0709 00:27:12.749982   12564 docker.go:1069] Invoking PostExecute function
I0709 00:27:12.750038   12564 postexecutorstep.go:68] Skipping step: store previous image
I0709 00:27:12.750071   12564 postexecutorstep.go:117] Executing step: commit image
I0709 00:27:12.752220   12564 postexecutorstep.go:523] Checking for new Labels to apply... 
I0709 00:27:12.752280   12564 postexecutorstep.go:531] Creating the download path '/tmp/s2i097710293/metadata'
I0709 00:27:12.752438   12564 postexecutorstep.go:465] Downloading file "/tmp/.s2i/image_metadata.json"
I0709 00:27:12.893572   12564 tar.go:401] Creating directory /tmp/s2i097710293/metadata
I0709 00:27:12.893658   12564 tar.go:469] Creating /tmp/s2i097710293/metadata/image_metadata.json
I0709 00:27:12.893817   12564 tar.go:479] Extracting/writing /tmp/s2i097710293/metadata/image_metadata.json
I0709 00:27:12.893976   12564 tar.go:425] Done extracting tar stream
I0709 00:27:12.894113   12564 postexecutorstep.go:556] new Labels File contents : 
{
  "labels": [
    {"testLabel": "testLabel_value"}
  ]
}

I0709 00:27:12.898275   12564 docker.go:1103] Committing container with dockerOpts: {Reference:test/sti-incremental-app Comment: Author: Changes:[] Pause:false Config:0xc0001f6280}, config: {Hostname: Domainname: User: AttachStdin:false AttachStdout:false AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[RACK_ENV=production] Cmd:[/tmp/scripts/run] Healthcheck:<nil> ArgsEscaped:false Image: Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[io.k8s.display-name:test/sti-incremental-app io.openshift.s2i.build.commit.author:Ben Parees <bparees@users.noreply.github.com> io.openshift.s2i.build.commit.date:Thu Jan 17 17:21:03 2019 -0500 io.openshift.s2i.build.commit.id:787f1beae9956c959c6af62ee43bfdda73769cf7 io.openshift.s2i.build.commit.message:Merge pull request #78 from bparees/v22 io.openshift.s2i.build.commit.ref:master io.openshift.s2i.build.image:sti_test/sti-fake io.openshift.s2i.build.source-location:https://github.com/openshift/ruby-hello-world io.openshift.s2i.scripts-url:http://127.0.0.1:23456/.s2i/bin testLabel:testLabel_value] StopSignal: StopTimeout:<nil> Shell:[]}
I0709 00:27:13.531300   12564 postexecutorstep.go:393] Executing step: report success
I0709 00:27:13.531359   12564 postexecutorstep.go:398] Successfully built test/sti-incremental-app
I0709 00:27:13.531391   12564 postexecutorstep.go:93] Skipping step: remove previous image
I0709 00:27:13.531491   12564 docker.go:980] Removing container "deba9d61b5b77005bc0952d81946666213868afdf1d45368d1952070bb562b6d" ...
I0709 00:27:13.544134   12564 docker.go:990] Removed container "deba9d61b5b77005bc0952d81946666213868afdf1d45368d1952070bb562b6d"
I0709 00:27:13.544273   12564 cleanup.go:33] Removing temporary directory /tmp/s2i097710293
I0709 00:27:13.544315   12564 fs.go:314] Removing directory '/tmp/s2i097710293'
I0709 00:27:13.548863   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:13.554328   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:13.554390   12564 docker.go:730] Image sha256:0bf6fa8d65546a5ca414e692035bbce64d7372174b26421d7b3dc2ce49192759 contains io.openshift.s2i.scripts-url set to "http://127.0.0.1:23456/.s2i/bin"
I0709 00:27:13.554450   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:13.554549   12564 sti.go:204] Preparing to build test/sti-incremental-app
I0709 00:27:13.554927   12564 clone.go:36] Downloading "https://github.com/openshift/ruby-hello-world" ...
I0709 00:27:13.554970   12564 clone.go:40] Cloning sources into "/tmp/s2i216355791/upload/src"
I0709 00:27:13.743725   12564 clone.go:56] Checked out "HEAD"
I0709 00:27:13.767391   12564 clone.go:62] Updated submodules for "HEAD"
I0709 00:27:13.782105   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/assemble'
I0709 00:27:13.782219   12564 install.go:261] Using "assemble" installed from "http://127.0.0.1:23456/.s2i/bin/assemble"
I0709 00:27:13.783603   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/run'
I0709 00:27:13.783712   12564 install.go:261] Using "run" installed from "http://127.0.0.1:23456/.s2i/bin/run"
I0709 00:27:13.785075   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/save-artifacts'
I0709 00:27:13.785197   12564 install.go:261] Using "save-artifacts" installed from "http://127.0.0.1:23456/.s2i/bin/save-artifacts"
I0709 00:27:13.785274   12564 ignore.go:66] .s2iignore file does not exist
I0709 00:27:13.787989   12564 docker.go:490] Using locally available image "test/sti-incremental-app:latest"
I0709 00:27:13.790289   12564 sti.go:211] Existing image for tag test/sti-incremental-app detected for incremental build
I0709 00:27:13.790339   12564 sti.go:216] Performing source build from https://github.com/openshift/ruby-hello-world
I0709 00:27:13.790463   12564 sti.go:522] Saving build artifacts from image test/sti-incremental-app to path /tmp/s2i216355791/upload/artifacts
I0709 00:27:13.792628   12564 sti.go:546] The assemble user is not set, defaulting to "" user
I0709 00:27:13.797174   12564 docker.go:793] Both scripts and untarred source will be placed in '/tmp'
I0709 00:27:13.797242   12564 docker.go:961] Setting "/tmp/scripts/save-artifacts" command for container ...
I0709 00:27:13.797505   12564 docker.go:970] Creating container with options {Name:"s2i_test_sti_incremental_app_c4a84d8a" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[] Cmd:[/tmp/scripts/save-artifacts] Healthcheck:<nil> ArgsEscaped:false Image:test/sti-incremental-app:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:14.159902   12564 docker.go:1002] Attaching to container "d5c20b5e346bae1f5439477bf4dc1c2cb78ea2037432d81b97503c83c8a85d09" ...
I0709 00:27:14.161166   12564 docker.go:1013] Starting container "d5c20b5e346bae1f5439477bf4dc1c2cb78ea2037432d81b97503c83c8a85d09" ...
I0709 00:27:14.480208   12564 tar.go:392] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.480446   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.480541   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/.gitignore
I0709 00:27:14.480693   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/.gitignore
I0709 00:27:14.481000   12564 tar.go:392] Creating directory /tmp/s2i216355791/upload/artifacts/.s2i
I0709 00:27:14.481228   12564 tar.go:392] Creating directory /tmp/s2i216355791/upload/artifacts/.s2i/bin
I0709 00:27:14.481482   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts/.s2i/bin
I0709 00:27:14.481603   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/.s2i/bin/README
I0709 00:27:14.481713   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/.s2i/bin/README
I0709 00:27:14.481999   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts/.s2i
I0709 00:27:14.482072   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/.s2i/environment
I0709 00:27:14.482174   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/.s2i/environment
I0709 00:27:14.483459   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.483562   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/.travis.yml
I0709 00:27:14.483671   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/.travis.yml
I0709 00:27:14.485009   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.485101   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/Dockerfile
I0709 00:27:14.485204   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/Dockerfile
I0709 00:27:14.489869   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.489964   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/Gemfile
I0709 00:27:14.490072   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/Gemfile
I0709 00:27:14.497098   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.497167   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/Gemfile.lock
I0709 00:27:14.497243   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/Gemfile.lock
I0709 00:27:14.497462   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.497541   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/README.md
I0709 00:27:14.497638   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/README.md
I0709 00:27:14.497818   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.497880   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/Rakefile
I0709 00:27:14.497954   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/Rakefile
I0709 00:27:14.498133   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.498186   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/app.rb
I0709 00:27:14.498267   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/app.rb
I0709 00:27:14.498488   12564 tar.go:392] Creating directory /tmp/s2i216355791/upload/artifacts/config
I0709 00:27:14.498730   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts/config
I0709 00:27:14.498805   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/config/database.rb
I0709 00:27:14.498907   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/config/database.rb
I0709 00:27:14.499120   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts/config
I0709 00:27:14.499188   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/config/database.yml
I0709 00:27:14.499286   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/config/database.yml
I0709 00:27:14.499492   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.499578   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/config.ru
I0709 00:27:14.499677   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/config.ru
I0709 00:27:14.499877   12564 tar.go:392] Creating directory /tmp/s2i216355791/upload/artifacts/db
I0709 00:27:14.500098   12564 tar.go:392] Creating directory /tmp/s2i216355791/upload/artifacts/db/migrate
I0709 00:27:14.500311   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts/db/migrate
I0709 00:27:14.500384   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:14.500471   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:14.500711   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.500783   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/models.rb
I0709 00:27:14.500890   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/models.rb
I0709 00:27:14.501154   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.501223   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/run.sh
I0709 00:27:14.501326   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/run.sh
I0709 00:27:14.501542   12564 tar.go:392] Creating directory /tmp/s2i216355791/upload/artifacts/test
I0709 00:27:14.501831   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts/test
I0709 00:27:14.501900   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/test/sample_test.rb
I0709 00:27:14.502000   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/test/sample_test.rb
I0709 00:27:14.510407   12564 tar.go:392] Creating directory /tmp/s2i216355791/upload/artifacts/views
I0709 00:27:14.510672   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts/views
I0709 00:27:14.510739   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/views/main.erb
I0709 00:27:14.510840   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/views/main.erb
I0709 00:27:14.511051   12564 tar.go:401] Creating directory /tmp/s2i216355791/upload/artifacts
I0709 00:27:14.511125   12564 tar.go:469] Creating /tmp/s2i216355791/upload/artifacts/save-artifacts-invoked
I0709 00:27:14.511234   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/upload/artifacts/save-artifacts-invoked
I0709 00:27:14.511388   12564 tar.go:425] Done extracting tar stream
I0709 00:27:14.583680   12564 docker.go:1044] Waiting for container "d5c20b5e346bae1f5439477bf4dc1c2cb78ea2037432d81b97503c83c8a85d09" to stop ...
I0709 00:27:14.723060   12564 docker.go:980] Removing container "d5c20b5e346bae1f5439477bf4dc1c2cb78ea2037432d81b97503c83c8a85d09" ...
I0709 00:27:14.736648   12564 docker.go:990] Removed container "d5c20b5e346bae1f5439477bf4dc1c2cb78ea2037432d81b97503c83c8a85d09"
I0709 00:27:14.736817   12564 sti.go:227] Running "assemble" in "test/sti-incremental-app"
I0709 00:27:14.736864   12564 sti.go:585] Using image name sti_test/sti-fake
I0709 00:27:14.738901   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:14.739029   12564 environment.go:41] Setting 1 environment variables provided by environment file in sources
I0709 00:27:14.739239   12564 sti.go:703] starting the source uploading ...
I0709 00:27:14.739303   12564 tar.go:239] Adding "/tmp/s2i216355791/upload" to tar ...
I0709 00:27:14.739742   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts as artifacts
I0709 00:27:14.743060   12564 docker.go:793] Both scripts and untarred source will be placed in '/tmp'
I0709 00:27:14.743148   12564 docker.go:961] Setting "/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble" command for container ...
I0709 00:27:14.743464   12564 docker.go:970] Creating container with options {Name:"s2i_sti_test_sti_fake_89a4cd68" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:true StdinOnce:true Env:[RACK_ENV=production] Cmd:[/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble] Healthcheck:<nil> ArgsEscaped:false Image:sti_test/sti-fake:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:15.086924   12564 docker.go:1002] Attaching to container "1a54ff2f9a67432da349be00b26e9173705cbb6ff25bed5f60ba20cf08858b5f" ...
I0709 00:27:15.088648   12564 docker.go:1013] Starting container "1a54ff2f9a67432da349be00b26e9173705cbb6ff25bed5f60ba20cf08858b5f" ...
I0709 00:27:15.385179   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/.gitignore as artifacts/.gitignore
I0709 00:27:15.385704   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/.s2i as artifacts/.s2i
I0709 00:27:15.386211   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/.s2i/bin as artifacts/.s2i/bin
I0709 00:27:15.386685   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/.s2i/bin/README as artifacts/.s2i/bin/README
I0709 00:27:15.387212   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/.s2i/environment as artifacts/.s2i/environment
I0709 00:27:15.387757   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/.travis.yml as artifacts/.travis.yml
I0709 00:27:15.388320   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/Dockerfile as artifacts/Dockerfile
I0709 00:27:15.388915   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/Gemfile as artifacts/Gemfile
I0709 00:27:15.389427   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/Gemfile.lock as artifacts/Gemfile.lock
I0709 00:27:15.390011   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/README.md as artifacts/README.md
I0709 00:27:15.390891   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/Rakefile as artifacts/Rakefile
I0709 00:27:15.391823   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/app.rb as artifacts/app.rb
I0709 00:27:15.392753   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/config as artifacts/config
I0709 00:27:15.393549   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/config/database.rb as artifacts/config/database.rb
I0709 00:27:15.394087   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/config/database.yml as artifacts/config/database.yml
I0709 00:27:15.394591   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/config.ru as artifacts/config.ru
I0709 00:27:15.395148   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/db as artifacts/db
I0709 00:27:15.395603   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/db/migrate as artifacts/db/migrate
I0709 00:27:15.396065   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/db/migrate/20141102191902_create_key_pair.rb as artifacts/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:15.396497   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/models.rb as artifacts/models.rb
I0709 00:27:15.396900   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/run.sh as artifacts/run.sh
I0709 00:27:15.397315   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/save-artifacts-invoked as artifacts/save-artifacts-invoked
I0709 00:27:15.397749   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/test as artifacts/test
I0709 00:27:15.398114   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/test/sample_test.rb as artifacts/test/sample_test.rb
I0709 00:27:15.398544   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/views as artifacts/views
I0709 00:27:15.398906   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/artifacts/views/main.erb as artifacts/views/main.erb
I0709 00:27:15.399349   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/scripts as scripts
I0709 00:27:15.399773   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/scripts/assemble as scripts/assemble
I0709 00:27:15.400278   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/scripts/run as scripts/run
I0709 00:27:15.400777   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/scripts/save-artifacts as scripts/save-artifacts
I0709 00:27:15.401283   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src as src
I0709 00:27:15.404644   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/.gitignore as src/.gitignore
I0709 00:27:15.405190   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/.s2i as src/.s2i
I0709 00:27:15.405652   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/.s2i/bin as src/.s2i/bin
I0709 00:27:15.406100   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/.s2i/bin/README as src/.s2i/bin/README
I0709 00:27:15.406575   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/.s2i/environment as src/.s2i/environment
I0709 00:27:15.407022   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/.travis.yml as src/.travis.yml
I0709 00:27:15.407507   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/Dockerfile as src/Dockerfile
I0709 00:27:15.407983   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/Gemfile as src/Gemfile
I0709 00:27:15.408430   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/Gemfile.lock as src/Gemfile.lock
I0709 00:27:15.408932   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/README.md as src/README.md
I0709 00:27:15.409363   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/Rakefile as src/Rakefile
I0709 00:27:15.409832   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/app.rb as src/app.rb
I0709 00:27:15.410741   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/config as src/config
I0709 00:27:15.411683   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/config/database.rb as src/config/database.rb
I0709 00:27:15.412422   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/config/database.yml as src/config/database.yml
I0709 00:27:15.412960   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/config.ru as src/config.ru
I0709 00:27:15.413832   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/db as src/db
I0709 00:27:15.414329   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/db/migrate as src/db/migrate
I0709 00:27:15.415178   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/db/migrate/20141102191902_create_key_pair.rb as src/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:15.415674   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/models.rb as src/models.rb
I0709 00:27:15.416681   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/run.sh as src/run.sh
I0709 00:27:15.417206   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/test as src/test
I0709 00:27:15.417688   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/test/sample_test.rb as src/test/sample_test.rb
I0709 00:27:15.418168   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/views as src/views
I0709 00:27:15.418792   12564 tar.go:337] Adding to tar: /tmp/s2i216355791/upload/src/views/main.erb as src/views/main.erb
I0709 00:27:15.474619   12564 docker.go:1044] Waiting for container "1a54ff2f9a67432da349be00b26e9173705cbb6ff25bed5f60ba20cf08858b5f" to stop ...
I0709 00:27:15.641124   12564 docker.go:1069] Invoking PostExecute function
I0709 00:27:15.641175   12564 postexecutorstep.go:68] Skipping step: store previous image
I0709 00:27:15.641206   12564 postexecutorstep.go:117] Executing step: commit image
I0709 00:27:15.643388   12564 postexecutorstep.go:523] Checking for new Labels to apply... 
I0709 00:27:15.643446   12564 postexecutorstep.go:531] Creating the download path '/tmp/s2i216355791/metadata'
I0709 00:27:15.643983   12564 postexecutorstep.go:465] Downloading file "/tmp/.s2i/image_metadata.json"
I0709 00:27:15.797593   12564 tar.go:401] Creating directory /tmp/s2i216355791/metadata
I0709 00:27:15.797683   12564 tar.go:469] Creating /tmp/s2i216355791/metadata/image_metadata.json
I0709 00:27:15.797830   12564 tar.go:479] Extracting/writing /tmp/s2i216355791/metadata/image_metadata.json
I0709 00:27:15.797976   12564 tar.go:425] Done extracting tar stream
I0709 00:27:15.798122   12564 postexecutorstep.go:556] new Labels File contents : 
{
  "labels": [
    {"testLabel": "testLabel_value"}
  ]
}

I0709 00:27:15.802234   12564 docker.go:1103] Committing container with dockerOpts: {Reference:test/sti-incremental-app Comment: Author: Changes:[] Pause:false Config:0xc0004b3cc0}, config: {Hostname: Domainname: User: AttachStdin:false AttachStdout:false AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[RACK_ENV=production] Cmd:[/tmp/scripts/run] Healthcheck:<nil> ArgsEscaped:false Image: Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[io.k8s.display-name:test/sti-incremental-app io.openshift.s2i.build.commit.author:Ben Parees <bparees@users.noreply.github.com> io.openshift.s2i.build.commit.date:Thu Jan 17 17:21:03 2019 -0500 io.openshift.s2i.build.commit.id:787f1beae9956c959c6af62ee43bfdda73769cf7 io.openshift.s2i.build.commit.message:Merge pull request #78 from bparees/v22 io.openshift.s2i.build.commit.ref:master io.openshift.s2i.build.image:sti_test/sti-fake io.openshift.s2i.build.source-location:https://github.com/openshift/ruby-hello-world io.openshift.s2i.scripts-url:http://127.0.0.1:23456/.s2i/bin testLabel:testLabel_value] StopSignal: StopTimeout:<nil> Shell:[]}
I0709 00:27:16.435293   12564 postexecutorstep.go:393] Executing step: report success
I0709 00:27:16.435346   12564 postexecutorstep.go:398] Successfully built test/sti-incremental-app
I0709 00:27:16.435382   12564 postexecutorstep.go:93] Skipping step: remove previous image
I0709 00:27:16.435482   12564 docker.go:980] Removing container "1a54ff2f9a67432da349be00b26e9173705cbb6ff25bed5f60ba20cf08858b5f" ...
I0709 00:27:16.448090   12564 docker.go:990] Removed container "1a54ff2f9a67432da349be00b26e9173705cbb6ff25bed5f60ba20cf08858b5f"
I0709 00:27:16.448227   12564 cleanup.go:33] Removing temporary directory /tmp/s2i216355791
I0709 00:27:16.448269   12564 fs.go:314] Removing directory '/tmp/s2i216355791'
--- PASS: TestIncrementalBuildAndKeepPreviousImage (6.37s)
=== RUN   TestIncrementalBuildUser
I0709 00:27:17.935663   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:17.941227   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:17.941289   12564 docker.go:730] Image sha256:0bf6fa8d65546a5ca414e692035bbce64d7372174b26421d7b3dc2ce49192759 contains io.openshift.s2i.scripts-url set to "http://127.0.0.1:23456/.s2i/bin"
I0709 00:27:17.941353   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:17.941464   12564 sti.go:204] Preparing to build test/sti-incremental-app-user
I0709 00:27:17.941932   12564 clone.go:36] Downloading "https://github.com/openshift/ruby-hello-world" ...
I0709 00:27:17.941983   12564 clone.go:40] Cloning sources into "/tmp/s2i691755737/upload/src"
I0709 00:27:18.150896   12564 clone.go:56] Checked out "HEAD"
I0709 00:27:18.175571   12564 clone.go:62] Updated submodules for "HEAD"
I0709 00:27:18.188143   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/assemble'
I0709 00:27:18.188236   12564 install.go:261] Using "assemble" installed from "http://127.0.0.1:23456/.s2i/bin/assemble"
I0709 00:27:18.189679   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/run'
I0709 00:27:18.189776   12564 install.go:261] Using "run" installed from "http://127.0.0.1:23456/.s2i/bin/run"
I0709 00:27:18.191179   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/save-artifacts'
I0709 00:27:18.191291   12564 install.go:261] Using "save-artifacts" installed from "http://127.0.0.1:23456/.s2i/bin/save-artifacts"
I0709 00:27:18.191369   12564 ignore.go:66] .s2iignore file does not exist
I0709 00:27:18.191410   12564 sti.go:213] Clean build will be performed
I0709 00:27:18.191452   12564 sti.go:216] Performing source build from https://github.com/openshift/ruby-hello-world
I0709 00:27:18.191503   12564 sti.go:227] Running "assemble" in "test/sti-incremental-app-user"
I0709 00:27:18.191561   12564 sti.go:585] Using image name sti_test/sti-fake
I0709 00:27:18.193775   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:18.193875   12564 environment.go:41] Setting 1 environment variables provided by environment file in sources
I0709 00:27:18.194023   12564 sti.go:703] starting the source uploading ...
I0709 00:27:18.194101   12564 tar.go:239] Adding "/tmp/s2i691755737/upload" to tar ...
I0709 00:27:18.194465   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/scripts as scripts
I0709 00:27:18.197885   12564 docker.go:793] Both scripts and untarred source will be placed in '/tmp'
I0709 00:27:18.197976   12564 docker.go:961] Setting "/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble" command for container ...
I0709 00:27:18.198280   12564 docker.go:970] Creating container with options {Name:"s2i_sti_test_sti_fake_c026c8de" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:true StdinOnce:true Env:[RACK_ENV=production] Cmd:[/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble] Healthcheck:<nil> ArgsEscaped:false Image:sti_test/sti-fake:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:18.562567   12564 docker.go:1002] Attaching to container "f67964c196d3a30b8aac21dbe356b70821bb8bb170223135a6bc0d42e1bb450e" ...
I0709 00:27:18.563936   12564 docker.go:1013] Starting container "f67964c196d3a30b8aac21dbe356b70821bb8bb170223135a6bc0d42e1bb450e" ...
I0709 00:27:18.875339   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/scripts/assemble as scripts/assemble
I0709 00:27:18.875890   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/scripts/run as scripts/run
I0709 00:27:18.876392   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/scripts/save-artifacts as scripts/save-artifacts
I0709 00:27:18.876956   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src as src
I0709 00:27:18.880684   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/.gitignore as src/.gitignore
I0709 00:27:18.881101   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/.s2i as src/.s2i
I0709 00:27:18.881591   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/.s2i/bin as src/.s2i/bin
I0709 00:27:18.882026   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/.s2i/bin/README as src/.s2i/bin/README
I0709 00:27:18.882481   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/.s2i/environment as src/.s2i/environment
I0709 00:27:18.882940   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/.travis.yml as src/.travis.yml
I0709 00:27:18.883350   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/Dockerfile as src/Dockerfile
I0709 00:27:18.883742   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/Gemfile as src/Gemfile
I0709 00:27:18.884089   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/Gemfile.lock as src/Gemfile.lock
I0709 00:27:18.884437   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/README.md as src/README.md
I0709 00:27:18.884833   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/Rakefile as src/Rakefile
I0709 00:27:18.885189   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/app.rb as src/app.rb
I0709 00:27:18.885590   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/config as src/config
I0709 00:27:18.886041   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/config/database.rb as src/config/database.rb
I0709 00:27:18.887859   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/config/database.yml as src/config/database.yml
I0709 00:27:18.888416   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/config.ru as src/config.ru
I0709 00:27:18.888973   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/db as src/db
I0709 00:27:18.889466   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/db/migrate as src/db/migrate
I0709 00:27:18.890410   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/db/migrate/20141102191902_create_key_pair.rb as src/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:18.890946   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/models.rb as src/models.rb
I0709 00:27:18.891326   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/run.sh as src/run.sh
I0709 00:27:18.891786   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/test as src/test
I0709 00:27:18.892289   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/test/sample_test.rb as src/test/sample_test.rb
I0709 00:27:18.892698   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/views as src/views
I0709 00:27:18.892997   12564 tar.go:337] Adding to tar: /tmp/s2i691755737/upload/src/views/main.erb as src/views/main.erb
I0709 00:27:18.942392   12564 docker.go:1044] Waiting for container "f67964c196d3a30b8aac21dbe356b70821bb8bb170223135a6bc0d42e1bb450e" to stop ...
I0709 00:27:19.105964   12564 docker.go:1069] Invoking PostExecute function
I0709 00:27:19.106016   12564 postexecutorstep.go:68] Skipping step: store previous image
I0709 00:27:19.106045   12564 postexecutorstep.go:117] Executing step: commit image
I0709 00:27:19.108210   12564 postexecutorstep.go:523] Checking for new Labels to apply... 
I0709 00:27:19.108267   12564 postexecutorstep.go:531] Creating the download path '/tmp/s2i691755737/metadata'
I0709 00:27:19.108426   12564 postexecutorstep.go:465] Downloading file "/tmp/.s2i/image_metadata.json"
I0709 00:27:19.261603   12564 tar.go:401] Creating directory /tmp/s2i691755737/metadata
I0709 00:27:19.261692   12564 tar.go:469] Creating /tmp/s2i691755737/metadata/image_metadata.json
I0709 00:27:19.261828   12564 tar.go:479] Extracting/writing /tmp/s2i691755737/metadata/image_metadata.json
I0709 00:27:19.261970   12564 tar.go:425] Done extracting tar stream
I0709 00:27:19.262092   12564 postexecutorstep.go:556] new Labels File contents : 
{
  "labels": [
    {"testLabel": "testLabel_value"}
  ]
}

I0709 00:27:19.266166   12564 docker.go:1103] Committing container with dockerOpts: {Reference:test/sti-incremental-app-user Comment: Author: Changes:[] Pause:false Config:0xc0004b3a40}, config: {Hostname: Domainname: User: AttachStdin:false AttachStdout:false AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[RACK_ENV=production] Cmd:[/tmp/scripts/run] Healthcheck:<nil> ArgsEscaped:false Image: Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[io.k8s.display-name:test/sti-incremental-app-user io.openshift.s2i.build.commit.author:Ben Parees <bparees@users.noreply.github.com> io.openshift.s2i.build.commit.date:Thu Jan 17 17:21:03 2019 -0500 io.openshift.s2i.build.commit.id:787f1beae9956c959c6af62ee43bfdda73769cf7 io.openshift.s2i.build.commit.message:Merge pull request #78 from bparees/v22 io.openshift.s2i.build.commit.ref:master io.openshift.s2i.build.image:sti_test/sti-fake io.openshift.s2i.build.source-location:https://github.com/openshift/ruby-hello-world io.openshift.s2i.scripts-url:http://127.0.0.1:23456/.s2i/bin testLabel:testLabel_value] StopSignal: StopTimeout:<nil> Shell:[]}
I0709 00:27:19.892318   12564 postexecutorstep.go:393] Executing step: report success
I0709 00:27:19.892373   12564 postexecutorstep.go:398] Successfully built test/sti-incremental-app-user
I0709 00:27:19.892406   12564 postexecutorstep.go:93] Skipping step: remove previous image
I0709 00:27:19.893206   12564 docker.go:980] Removing container "f67964c196d3a30b8aac21dbe356b70821bb8bb170223135a6bc0d42e1bb450e" ...
I0709 00:27:19.908723   12564 docker.go:990] Removed container "f67964c196d3a30b8aac21dbe356b70821bb8bb170223135a6bc0d42e1bb450e"
I0709 00:27:19.908853   12564 cleanup.go:33] Removing temporary directory /tmp/s2i691755737
I0709 00:27:19.908894   12564 fs.go:314] Removing directory '/tmp/s2i691755737'
I0709 00:27:19.913453   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:19.918855   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:19.918915   12564 docker.go:730] Image sha256:0bf6fa8d65546a5ca414e692035bbce64d7372174b26421d7b3dc2ce49192759 contains io.openshift.s2i.scripts-url set to "http://127.0.0.1:23456/.s2i/bin"
I0709 00:27:19.918980   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:19.919091   12564 sti.go:204] Preparing to build test/sti-incremental-app-user
I0709 00:27:19.919572   12564 clone.go:36] Downloading "https://github.com/openshift/ruby-hello-world" ...
I0709 00:27:19.919622   12564 clone.go:40] Cloning sources into "/tmp/s2i251018867/upload/src"
I0709 00:27:20.129117   12564 clone.go:56] Checked out "HEAD"
I0709 00:27:20.153009   12564 clone.go:62] Updated submodules for "HEAD"
I0709 00:27:20.165603   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/assemble'
I0709 00:27:20.165715   12564 install.go:261] Using "assemble" installed from "http://127.0.0.1:23456/.s2i/bin/assemble"
I0709 00:27:20.167144   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/run'
I0709 00:27:20.167246   12564 install.go:261] Using "run" installed from "http://127.0.0.1:23456/.s2i/bin/run"
I0709 00:27:20.169561   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/save-artifacts'
I0709 00:27:20.169660   12564 install.go:261] Using "save-artifacts" installed from "http://127.0.0.1:23456/.s2i/bin/save-artifacts"
I0709 00:27:20.169750   12564 ignore.go:66] .s2iignore file does not exist
I0709 00:27:20.173630   12564 docker.go:490] Using locally available image "test/sti-incremental-app-user:latest"
I0709 00:27:20.175952   12564 sti.go:211] Existing image for tag test/sti-incremental-app-user detected for incremental build
I0709 00:27:20.176004   12564 sti.go:216] Performing source build from https://github.com/openshift/ruby-hello-world
I0709 00:27:20.176129   12564 sti.go:522] Saving build artifacts from image test/sti-incremental-app-user to path /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.178378   12564 sti.go:546] The assemble user is not set, defaulting to "" user
I0709 00:27:20.183024   12564 docker.go:793] Both scripts and untarred source will be placed in '/tmp'
I0709 00:27:20.183088   12564 docker.go:961] Setting "/tmp/scripts/save-artifacts" command for container ...
I0709 00:27:20.183357   12564 docker.go:970] Creating container with options {Name:"s2i_test_sti_incremental_app_user_0e68c83d" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[] Cmd:[/tmp/scripts/save-artifacts] Healthcheck:<nil> ArgsEscaped:false Image:test/sti-incremental-app-user:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:20.558873   12564 docker.go:1002] Attaching to container "ee80d754df742d5e3ad55144eaab6362bb678ebca1bbfc74f83a3756fb3dcd3f" ...
I0709 00:27:20.560169   12564 docker.go:1013] Starting container "ee80d754df742d5e3ad55144eaab6362bb678ebca1bbfc74f83a3756fb3dcd3f" ...
I0709 00:27:20.939031   12564 tar.go:392] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.939252   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.939327   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/.gitignore
I0709 00:27:20.939537   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/.gitignore
I0709 00:27:20.939777   12564 tar.go:392] Creating directory /tmp/s2i251018867/upload/artifacts/.s2i
I0709 00:27:20.940013   12564 tar.go:392] Creating directory /tmp/s2i251018867/upload/artifacts/.s2i/bin
I0709 00:27:20.940266   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts/.s2i/bin
I0709 00:27:20.940355   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/.s2i/bin/README
I0709 00:27:20.940457   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/.s2i/bin/README
I0709 00:27:20.940772   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts/.s2i
I0709 00:27:20.940851   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/.s2i/environment
I0709 00:27:20.940983   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/.s2i/environment
I0709 00:27:20.941195   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.941304   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/.travis.yml
I0709 00:27:20.941402   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/.travis.yml
I0709 00:27:20.941706   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.941783   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/Dockerfile
I0709 00:27:20.941886   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/Dockerfile
I0709 00:27:20.942817   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.942892   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/Gemfile
I0709 00:27:20.942998   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/Gemfile
I0709 00:27:20.958779   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.958859   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/Gemfile.lock
I0709 00:27:20.958983   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/Gemfile.lock
I0709 00:27:20.959210   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.959286   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/README.md
I0709 00:27:20.959419   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/README.md
I0709 00:27:20.959655   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.959733   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/Rakefile
I0709 00:27:20.959842   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/Rakefile
I0709 00:27:20.960061   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.960136   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/app.rb
I0709 00:27:20.960242   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/app.rb
I0709 00:27:20.960471   12564 tar.go:392] Creating directory /tmp/s2i251018867/upload/artifacts/config
I0709 00:27:20.960696   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts/config
I0709 00:27:20.960763   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/config/database.rb
I0709 00:27:20.960860   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/config/database.rb
I0709 00:27:20.961082   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts/config
I0709 00:27:20.961156   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/config/database.yml
I0709 00:27:20.961260   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/config/database.yml
I0709 00:27:20.961463   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.961554   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/config.ru
I0709 00:27:20.961659   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/config.ru
I0709 00:27:20.961861   12564 tar.go:392] Creating directory /tmp/s2i251018867/upload/artifacts/db
I0709 00:27:20.962069   12564 tar.go:392] Creating directory /tmp/s2i251018867/upload/artifacts/db/migrate
I0709 00:27:20.962297   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts/db/migrate
I0709 00:27:20.962375   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:20.962477   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:20.962699   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.962777   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/models.rb
I0709 00:27:20.962883   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/models.rb
I0709 00:27:20.963092   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.963165   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/run.sh
I0709 00:27:20.963265   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/run.sh
I0709 00:27:20.963472   12564 tar.go:392] Creating directory /tmp/s2i251018867/upload/artifacts/test
I0709 00:27:20.963705   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts/test
I0709 00:27:20.963776   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/test/sample_test.rb
I0709 00:27:20.963869   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/test/sample_test.rb
I0709 00:27:20.964071   12564 tar.go:392] Creating directory /tmp/s2i251018867/upload/artifacts/views
I0709 00:27:20.964300   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts/views
I0709 00:27:20.964368   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/views/main.erb
I0709 00:27:20.964472   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/views/main.erb
I0709 00:27:20.964705   12564 tar.go:401] Creating directory /tmp/s2i251018867/upload/artifacts
I0709 00:27:20.964779   12564 tar.go:469] Creating /tmp/s2i251018867/upload/artifacts/save-artifacts-invoked
I0709 00:27:20.964890   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/upload/artifacts/save-artifacts-invoked
I0709 00:27:20.965036   12564 tar.go:425] Done extracting tar stream
I0709 00:27:21.040671   12564 docker.go:1044] Waiting for container "ee80d754df742d5e3ad55144eaab6362bb678ebca1bbfc74f83a3756fb3dcd3f" to stop ...
I0709 00:27:21.172029   12564 docker.go:980] Removing container "ee80d754df742d5e3ad55144eaab6362bb678ebca1bbfc74f83a3756fb3dcd3f" ...
I0709 00:27:21.184515   12564 docker.go:990] Removed container "ee80d754df742d5e3ad55144eaab6362bb678ebca1bbfc74f83a3756fb3dcd3f"
I0709 00:27:21.184758   12564 sti.go:227] Running "assemble" in "test/sti-incremental-app-user"
I0709 00:27:21.184798   12564 sti.go:585] Using image name sti_test/sti-fake
I0709 00:27:21.186842   12564 docker.go:490] Using locally available image "sti_test/sti-fake:latest"
I0709 00:27:21.186971   12564 environment.go:41] Setting 1 environment variables provided by environment file in sources
I0709 00:27:21.187198   12564 sti.go:703] starting the source uploading ...
I0709 00:27:21.187265   12564 tar.go:239] Adding "/tmp/s2i251018867/upload" to tar ...
I0709 00:27:21.187736   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts as artifacts
I0709 00:27:21.190948   12564 docker.go:793] Both scripts and untarred source will be placed in '/tmp'
I0709 00:27:21.191038   12564 docker.go:961] Setting "/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble" command for container ...
I0709 00:27:21.191332   12564 docker.go:970] Creating container with options {Name:"s2i_sti_test_sti_fake_f8a4481a" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:true StdinOnce:true Env:[RACK_ENV=production] Cmd:[/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble] Healthcheck:<nil> ArgsEscaped:false Image:sti_test/sti-fake:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:21.548238   12564 docker.go:1002] Attaching to container "3e3bab1e42008214508369dd33061512fa33753cfb8f0c2f87120d810579a751" ...
I0709 00:27:21.549483   12564 docker.go:1013] Starting container "3e3bab1e42008214508369dd33061512fa33753cfb8f0c2f87120d810579a751" ...
I0709 00:27:21.842162   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/.gitignore as artifacts/.gitignore
I0709 00:27:21.842719   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/.s2i as artifacts/.s2i
I0709 00:27:21.843137   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/.s2i/bin as artifacts/.s2i/bin
I0709 00:27:21.843515   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/.s2i/bin/README as artifacts/.s2i/bin/README
I0709 00:27:21.843987   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/.s2i/environment as artifacts/.s2i/environment
I0709 00:27:21.844388   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/.travis.yml as artifacts/.travis.yml
I0709 00:27:21.844944   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/Dockerfile as artifacts/Dockerfile
I0709 00:27:21.845436   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/Gemfile as artifacts/Gemfile
I0709 00:27:21.845964   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/Gemfile.lock as artifacts/Gemfile.lock
I0709 00:27:21.846450   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/README.md as artifacts/README.md
I0709 00:27:21.846940   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/Rakefile as artifacts/Rakefile
I0709 00:27:21.847371   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/app.rb as artifacts/app.rb
I0709 00:27:21.847843   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/config as artifacts/config
I0709 00:27:21.848223   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/config/database.rb as artifacts/config/database.rb
I0709 00:27:21.848727   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/config/database.yml as artifacts/config/database.yml
I0709 00:27:21.849666   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/config.ru as artifacts/config.ru
I0709 00:27:21.850832   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/db as artifacts/db
I0709 00:27:21.851350   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/db/migrate as artifacts/db/migrate
I0709 00:27:21.851918   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/db/migrate/20141102191902_create_key_pair.rb as artifacts/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:21.853227   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/models.rb as artifacts/models.rb
I0709 00:27:21.853735   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/run.sh as artifacts/run.sh
I0709 00:27:21.854241   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/save-artifacts-invoked as artifacts/save-artifacts-invoked
I0709 00:27:21.854783   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/test as artifacts/test
I0709 00:27:21.855258   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/test/sample_test.rb as artifacts/test/sample_test.rb
I0709 00:27:21.855679   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/views as artifacts/views
I0709 00:27:21.856041   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/artifacts/views/main.erb as artifacts/views/main.erb
I0709 00:27:21.856454   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/scripts as scripts
I0709 00:27:21.856819   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/scripts/assemble as scripts/assemble
I0709 00:27:21.857212   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/scripts/run as scripts/run
I0709 00:27:21.857618   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/scripts/save-artifacts as scripts/save-artifacts
I0709 00:27:21.858065   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src as src
I0709 00:27:21.861718   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/.gitignore as src/.gitignore
I0709 00:27:21.862231   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/.s2i as src/.s2i
I0709 00:27:21.862735   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/.s2i/bin as src/.s2i/bin
I0709 00:27:21.863128   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/.s2i/bin/README as src/.s2i/bin/README
I0709 00:27:21.863593   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/.s2i/environment as src/.s2i/environment
I0709 00:27:21.864045   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/.travis.yml as src/.travis.yml
I0709 00:27:21.864448   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/Dockerfile as src/Dockerfile
I0709 00:27:21.864828   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/Gemfile as src/Gemfile
I0709 00:27:21.865189   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/Gemfile.lock as src/Gemfile.lock
I0709 00:27:21.865598   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/README.md as src/README.md
I0709 00:27:21.865992   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/Rakefile as src/Rakefile
I0709 00:27:21.866492   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/app.rb as src/app.rb
I0709 00:27:21.867027   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/config as src/config
I0709 00:27:21.867378   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/config/database.rb as src/config/database.rb
I0709 00:27:21.867894   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/config/database.yml as src/config/database.yml
I0709 00:27:21.868400   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/config.ru as src/config.ru
I0709 00:27:21.868934   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/db as src/db
I0709 00:27:21.869317   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/db/migrate as src/db/migrate
I0709 00:27:21.869821   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/db/migrate/20141102191902_create_key_pair.rb as src/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:21.870319   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/models.rb as src/models.rb
I0709 00:27:21.870807   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/run.sh as src/run.sh
I0709 00:27:21.871338   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/test as src/test
I0709 00:27:21.871798   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/test/sample_test.rb as src/test/sample_test.rb
I0709 00:27:21.872230   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/views as src/views
I0709 00:27:21.872659   12564 tar.go:337] Adding to tar: /tmp/s2i251018867/upload/src/views/main.erb as src/views/main.erb
I0709 00:27:21.917735   12564 docker.go:1044] Waiting for container "3e3bab1e42008214508369dd33061512fa33753cfb8f0c2f87120d810579a751" to stop ...
I0709 00:27:22.086464   12564 docker.go:1069] Invoking PostExecute function
I0709 00:27:22.086516   12564 postexecutorstep.go:63] Executing step: store previous image
I0709 00:27:22.091096   12564 postexecutorstep.go:117] Executing step: commit image
I0709 00:27:22.092982   12564 postexecutorstep.go:523] Checking for new Labels to apply... 
I0709 00:27:22.093043   12564 postexecutorstep.go:531] Creating the download path '/tmp/s2i251018867/metadata'
I0709 00:27:22.093193   12564 postexecutorstep.go:465] Downloading file "/tmp/.s2i/image_metadata.json"
I0709 00:27:22.243519   12564 tar.go:401] Creating directory /tmp/s2i251018867/metadata
I0709 00:27:22.243620   12564 tar.go:469] Creating /tmp/s2i251018867/metadata/image_metadata.json
I0709 00:27:22.243753   12564 tar.go:479] Extracting/writing /tmp/s2i251018867/metadata/image_metadata.json
I0709 00:27:22.243897   12564 tar.go:425] Done extracting tar stream
I0709 00:27:22.244010   12564 postexecutorstep.go:556] new Labels File contents : 
{
  "labels": [
    {"testLabel": "testLabel_value"}
  ]
}

I0709 00:27:22.248095   12564 docker.go:1103] Committing container with dockerOpts: {Reference:test/sti-incremental-app-user Comment: Author: Changes:[] Pause:false Config:0xc0004b3cc0}, config: {Hostname: Domainname: User: AttachStdin:false AttachStdout:false AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[RACK_ENV=production] Cmd:[/tmp/scripts/run] Healthcheck:<nil> ArgsEscaped:false Image: Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[io.k8s.display-name:test/sti-incremental-app-user io.openshift.s2i.build.commit.author:Ben Parees <bparees@users.noreply.github.com> io.openshift.s2i.build.commit.date:Thu Jan 17 17:21:03 2019 -0500 io.openshift.s2i.build.commit.id:787f1beae9956c959c6af62ee43bfdda73769cf7 io.openshift.s2i.build.commit.message:Merge pull request #78 from bparees/v22 io.openshift.s2i.build.commit.ref:master io.openshift.s2i.build.image:sti_test/sti-fake io.openshift.s2i.build.source-location:https://github.com/openshift/ruby-hello-world io.openshift.s2i.scripts-url:http://127.0.0.1:23456/.s2i/bin testLabel:testLabel_value] StopSignal: StopTimeout:<nil> Shell:[]}
I0709 00:27:23.281327   12564 postexecutorstep.go:393] Executing step: report success
I0709 00:27:23.281382   12564 postexecutorstep.go:398] Successfully built test/sti-incremental-app-user
I0709 00:27:23.281414   12564 postexecutorstep.go:88] Executing step: remove previous image
I0709 00:27:23.281442   12564 postexecutorstep.go:102] Removing previously-tagged image sha256:2588e8a8e6667ce84ec489ad94e799681409eb4ee0440e4e5347080d14947ed7
I0709 00:27:23.287048   12564 docker.go:980] Removing container "3e3bab1e42008214508369dd33061512fa33753cfb8f0c2f87120d810579a751" ...
I0709 00:27:23.299892   12564 docker.go:990] Removed container "3e3bab1e42008214508369dd33061512fa33753cfb8f0c2f87120d810579a751"
I0709 00:27:23.300053   12564 cleanup.go:33] Removing temporary directory /tmp/s2i251018867
I0709 00:27:23.300092   12564 fs.go:314] Removing directory '/tmp/s2i251018867'
--- PASS: TestIncrementalBuildUser (6.85s)
=== RUN   TestIncrementalBuildScripts
I0709 00:27:24.788337   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts:latest"
I0709 00:27:24.793761   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts:latest"
I0709 00:27:24.793820   12564 docker.go:730] Image sha256:f197c17b3ffceed9f5542138f02d96386672e2cc1a4059bc669c6eb6f4ecbbc6 contains io.openshift.s2i.scripts-url set to "image:///tmp/scripts/"
I0709 00:27:24.793882   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:24.794003   12564 sti.go:204] Preparing to build test/sti-incremental-app-scripts
I0709 00:27:24.794462   12564 clone.go:36] Downloading "https://github.com/openshift/ruby-hello-world" ...
I0709 00:27:24.794514   12564 clone.go:40] Cloning sources into "/tmp/s2i161235741/upload/src"
I0709 00:27:24.984259   12564 clone.go:56] Checked out "HEAD"
I0709 00:27:25.007752   12564 clone.go:62] Updated submodules for "HEAD"
I0709 00:27:25.018867   12564 install.go:261] Using "assemble" installed from "image:///tmp/scripts//assemble"
I0709 00:27:25.018989   12564 install.go:261] Using "run" installed from "image:///tmp/scripts//run"
I0709 00:27:25.019121   12564 install.go:261] Using "save-artifacts" installed from "image:///tmp/scripts//save-artifacts"
I0709 00:27:25.019197   12564 ignore.go:66] .s2iignore file does not exist
I0709 00:27:25.019243   12564 sti.go:213] Clean build will be performed
I0709 00:27:25.019287   12564 sti.go:216] Performing source build from https://github.com/openshift/ruby-hello-world
I0709 00:27:25.019356   12564 sti.go:227] Running "assemble" in "test/sti-incremental-app-scripts"
I0709 00:27:25.019403   12564 sti.go:585] Using image name sti_test/sti-fake-scripts
I0709 00:27:25.021759   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts:latest"
I0709 00:27:25.021854   12564 environment.go:41] Setting 1 environment variables provided by environment file in sources
I0709 00:27:25.022015   12564 sti.go:703] starting the source uploading ...
I0709 00:27:25.022096   12564 tar.go:239] Adding "/tmp/s2i161235741/upload" to tar ...
I0709 00:27:25.022430   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/scripts as scripts
I0709 00:27:25.026669   12564 docker.go:730] Image sha256:f197c17b3ffceed9f5542138f02d96386672e2cc1a4059bc669c6eb6f4ecbbc6 contains io.openshift.s2i.scripts-url set to "image:///tmp/scripts/"
I0709 00:27:25.026719   12564 docker.go:804] Base directory for S2I scripts is '/tmp/scripts/'. Untarring destination is '/tmp'.
I0709 00:27:25.026793   12564 docker.go:961] Setting "/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble" command for container ...
I0709 00:27:25.027108   12564 docker.go:970] Creating container with options {Name:"s2i_sti_test_sti_fake_scripts_ff597cc5" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:true StdinOnce:true Env:[RACK_ENV=production] Cmd:[/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble] Healthcheck:<nil> ArgsEscaped:false Image:sti_test/sti-fake-scripts:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:25.407118   12564 docker.go:1002] Attaching to container "0b69ef2a3c216775f13b159066280d4b372da19c33a5a94d7e547dec9c7f4829" ...
I0709 00:27:25.408287   12564 docker.go:1013] Starting container "0b69ef2a3c216775f13b159066280d4b372da19c33a5a94d7e547dec9c7f4829" ...
I0709 00:27:25.688610   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src as src
I0709 00:27:25.692614   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/.gitignore as src/.gitignore
I0709 00:27:25.693168   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/.s2i as src/.s2i
I0709 00:27:25.693635   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/.s2i/bin as src/.s2i/bin
I0709 00:27:25.693980   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/.s2i/bin/README as src/.s2i/bin/README
I0709 00:27:25.694342   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/.s2i/environment as src/.s2i/environment
I0709 00:27:25.694888   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/.travis.yml as src/.travis.yml
I0709 00:27:25.695396   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/Dockerfile as src/Dockerfile
I0709 00:27:25.695912   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/Gemfile as src/Gemfile
I0709 00:27:25.696389   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/Gemfile.lock as src/Gemfile.lock
I0709 00:27:25.696870   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/README.md as src/README.md
I0709 00:27:25.697357   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/Rakefile as src/Rakefile
I0709 00:27:25.697896   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/app.rb as src/app.rb
I0709 00:27:25.698418   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/config as src/config
I0709 00:27:25.698879   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/config/database.rb as src/config/database.rb
I0709 00:27:25.699358   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/config/database.yml as src/config/database.yml
I0709 00:27:25.699897   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/config.ru as src/config.ru
I0709 00:27:25.700366   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/db as src/db
I0709 00:27:25.700865   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/db/migrate as src/db/migrate
I0709 00:27:25.701247   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/db/migrate/20141102191902_create_key_pair.rb as src/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:25.701634   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/models.rb as src/models.rb
I0709 00:27:25.701990   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/run.sh as src/run.sh
I0709 00:27:25.702367   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/test as src/test
I0709 00:27:25.702806   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/test/sample_test.rb as src/test/sample_test.rb
I0709 00:27:25.703184   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/views as src/views
I0709 00:27:25.703508   12564 tar.go:337] Adding to tar: /tmp/s2i161235741/upload/src/views/main.erb as src/views/main.erb
I0709 00:27:25.763723   12564 docker.go:1044] Waiting for container "0b69ef2a3c216775f13b159066280d4b372da19c33a5a94d7e547dec9c7f4829" to stop ...
I0709 00:27:25.944699   12564 docker.go:1069] Invoking PostExecute function
I0709 00:27:25.944763   12564 postexecutorstep.go:68] Skipping step: store previous image
I0709 00:27:25.944793   12564 postexecutorstep.go:117] Executing step: commit image
I0709 00:27:25.946929   12564 postexecutorstep.go:523] Checking for new Labels to apply... 
I0709 00:27:25.946985   12564 postexecutorstep.go:531] Creating the download path '/tmp/s2i161235741/metadata'
I0709 00:27:25.947143   12564 postexecutorstep.go:465] Downloading file "/tmp/.s2i/image_metadata.json"
I0709 00:27:26.090575   12564 tar.go:401] Creating directory /tmp/s2i161235741/metadata
I0709 00:27:26.090667   12564 tar.go:469] Creating /tmp/s2i161235741/metadata/image_metadata.json
I0709 00:27:26.090816   12564 tar.go:479] Extracting/writing /tmp/s2i161235741/metadata/image_metadata.json
I0709 00:27:26.090962   12564 tar.go:425] Done extracting tar stream
I0709 00:27:26.091107   12564 postexecutorstep.go:556] new Labels File contents : 
{
  "labels": [
    {"testLabel": "testLabel_value"}
  ]
}

I0709 00:27:26.095300   12564 docker.go:1103] Committing container with dockerOpts: {Reference:test/sti-incremental-app-scripts Comment: Author: Changes:[] Pause:false Config:0xc0004b3a40}, config: {Hostname: Domainname: User: AttachStdin:false AttachStdout:false AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[RACK_ENV=production] Cmd:[/tmp/scripts//run] Healthcheck:<nil> ArgsEscaped:false Image: Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[io.k8s.display-name:test/sti-incremental-app-scripts io.openshift.s2i.build.commit.author:Ben Parees <bparees@users.noreply.github.com> io.openshift.s2i.build.commit.date:Thu Jan 17 17:21:03 2019 -0500 io.openshift.s2i.build.commit.id:787f1beae9956c959c6af62ee43bfdda73769cf7 io.openshift.s2i.build.commit.message:Merge pull request #78 from bparees/v22 io.openshift.s2i.build.commit.ref:master io.openshift.s2i.build.image:sti_test/sti-fake-scripts io.openshift.s2i.build.source-location:https://github.com/openshift/ruby-hello-world io.openshift.s2i.scripts-url:image:///tmp/scripts/ testLabel:testLabel_value] StopSignal: StopTimeout:<nil> Shell:[]}
I0709 00:27:26.709287   12564 postexecutorstep.go:393] Executing step: report success
I0709 00:27:26.709343   12564 postexecutorstep.go:398] Successfully built test/sti-incremental-app-scripts
I0709 00:27:26.709383   12564 postexecutorstep.go:93] Skipping step: remove previous image
I0709 00:27:26.709481   12564 docker.go:980] Removing container "0b69ef2a3c216775f13b159066280d4b372da19c33a5a94d7e547dec9c7f4829" ...
I0709 00:27:26.722878   12564 docker.go:990] Removed container "0b69ef2a3c216775f13b159066280d4b372da19c33a5a94d7e547dec9c7f4829"
I0709 00:27:26.723091   12564 cleanup.go:33] Removing temporary directory /tmp/s2i161235741
I0709 00:27:26.723146   12564 fs.go:314] Removing directory '/tmp/s2i161235741'
I0709 00:27:26.729185   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts:latest"
I0709 00:27:26.734668   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts:latest"
I0709 00:27:26.734725   12564 docker.go:730] Image sha256:f197c17b3ffceed9f5542138f02d96386672e2cc1a4059bc669c6eb6f4ecbbc6 contains io.openshift.s2i.scripts-url set to "image:///tmp/scripts/"
I0709 00:27:26.734784   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:26.734869   12564 sti.go:204] Preparing to build test/sti-incremental-app-scripts
I0709 00:27:26.735293   12564 clone.go:36] Downloading "https://github.com/openshift/ruby-hello-world" ...
I0709 00:27:26.735345   12564 clone.go:40] Cloning sources into "/tmp/s2i087813463/upload/src"
I0709 00:27:26.943637   12564 clone.go:56] Checked out "HEAD"
I0709 00:27:26.966968   12564 clone.go:62] Updated submodules for "HEAD"
I0709 00:27:26.978091   12564 install.go:261] Using "assemble" installed from "image:///tmp/scripts//assemble"
I0709 00:27:26.978209   12564 install.go:261] Using "run" installed from "image:///tmp/scripts//run"
I0709 00:27:26.978337   12564 install.go:261] Using "save-artifacts" installed from "image:///tmp/scripts//save-artifacts"
I0709 00:27:26.978416   12564 ignore.go:66] .s2iignore file does not exist
I0709 00:27:26.981219   12564 docker.go:490] Using locally available image "test/sti-incremental-app-scripts:latest"
I0709 00:27:26.983409   12564 sti.go:211] Existing image for tag test/sti-incremental-app-scripts detected for incremental build
I0709 00:27:26.983461   12564 sti.go:216] Performing source build from https://github.com/openshift/ruby-hello-world
I0709 00:27:26.983600   12564 sti.go:522] Saving build artifacts from image test/sti-incremental-app-scripts to path /tmp/s2i087813463/upload/artifacts
I0709 00:27:26.985819   12564 sti.go:546] The assemble user is not set, defaulting to "" user
I0709 00:27:26.990499   12564 docker.go:730] Image sha256:f1be2913b532cd40c37ac8c34ab0d3753bf867ca30a88a32491a148602cb0ddc contains io.openshift.s2i.scripts-url set to "image:///tmp/scripts/"
I0709 00:27:26.990558   12564 docker.go:804] Base directory for S2I scripts is '/tmp/scripts/'. Untarring destination is '/tmp'.
I0709 00:27:26.990610   12564 docker.go:961] Setting "/tmp/scripts/save-artifacts" command for container ...
I0709 00:27:26.990858   12564 docker.go:970] Creating container with options {Name:"s2i_test_sti_incremental_app_scripts_b976c78e" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[] Cmd:[/tmp/scripts/save-artifacts] Healthcheck:<nil> ArgsEscaped:false Image:test/sti-incremental-app-scripts:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:27.356053   12564 docker.go:1002] Attaching to container "1a1f565ec2aa624c9423192d82d7d778c226efd7c05c445e5744ee59d8278219" ...
I0709 00:27:27.357601   12564 docker.go:1013] Starting container "1a1f565ec2aa624c9423192d82d7d778c226efd7c05c445e5744ee59d8278219" ...
I0709 00:27:27.664811   12564 tar.go:392] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.665012   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.665099   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/.gitignore
I0709 00:27:27.665221   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/.gitignore
I0709 00:27:27.665778   12564 tar.go:392] Creating directory /tmp/s2i087813463/upload/artifacts/.s2i
I0709 00:27:27.666880   12564 tar.go:392] Creating directory /tmp/s2i087813463/upload/artifacts/.s2i/bin
I0709 00:27:27.667127   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts/.s2i/bin
I0709 00:27:27.667208   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/.s2i/bin/README
I0709 00:27:27.667311   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/.s2i/bin/README
I0709 00:27:27.667600   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts/.s2i
I0709 00:27:27.667670   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/.s2i/environment
I0709 00:27:27.667769   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/.s2i/environment
I0709 00:27:27.669260   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.669343   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/.travis.yml
I0709 00:27:27.669474   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/.travis.yml
I0709 00:27:27.669753   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.669856   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/Dockerfile
I0709 00:27:27.669963   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/Dockerfile
I0709 00:27:27.670585   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.670663   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/Gemfile
I0709 00:27:27.670770   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/Gemfile
I0709 00:27:27.670980   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.671051   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/Gemfile.lock
I0709 00:27:27.671154   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/Gemfile.lock
I0709 00:27:27.671355   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.671421   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/README.md
I0709 00:27:27.671581   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/README.md
I0709 00:27:27.680735   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.680822   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/Rakefile
I0709 00:27:27.680934   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/Rakefile
I0709 00:27:27.681159   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.681237   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/app.rb
I0709 00:27:27.681356   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/app.rb
I0709 00:27:27.681597   12564 tar.go:392] Creating directory /tmp/s2i087813463/upload/artifacts/config
I0709 00:27:27.681861   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts/config
I0709 00:27:27.681936   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/config/database.rb
I0709 00:27:27.682080   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/config/database.rb
I0709 00:27:27.682317   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts/config
I0709 00:27:27.682412   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/config/database.yml
I0709 00:27:27.682540   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/config/database.yml
I0709 00:27:27.682809   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.682883   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/config.ru
I0709 00:27:27.683004   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/config.ru
I0709 00:27:27.683251   12564 tar.go:392] Creating directory /tmp/s2i087813463/upload/artifacts/db
I0709 00:27:27.683475   12564 tar.go:392] Creating directory /tmp/s2i087813463/upload/artifacts/db/migrate
I0709 00:27:27.683747   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts/db/migrate
I0709 00:27:27.683827   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:27.683939   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:27.684196   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.684271   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/models.rb
I0709 00:27:27.684382   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/models.rb
I0709 00:27:27.684669   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.684740   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/run.sh
I0709 00:27:27.684845   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/run.sh
I0709 00:27:27.685106   12564 tar.go:392] Creating directory /tmp/s2i087813463/upload/artifacts/test
I0709 00:27:27.685353   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts/test
I0709 00:27:27.685419   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/test/sample_test.rb
I0709 00:27:27.685508   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/test/sample_test.rb
I0709 00:27:27.685786   12564 tar.go:392] Creating directory /tmp/s2i087813463/upload/artifacts/views
I0709 00:27:27.685992   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts/views
I0709 00:27:27.686058   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/views/main.erb
I0709 00:27:27.686146   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/views/main.erb
I0709 00:27:27.686408   12564 tar.go:401] Creating directory /tmp/s2i087813463/upload/artifacts
I0709 00:27:27.686476   12564 tar.go:469] Creating /tmp/s2i087813463/upload/artifacts/save-artifacts-invoked
I0709 00:27:27.686591   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/upload/artifacts/save-artifacts-invoked
I0709 00:27:27.686710   12564 tar.go:425] Done extracting tar stream
I0709 00:27:27.763422   12564 docker.go:1044] Waiting for container "1a1f565ec2aa624c9423192d82d7d778c226efd7c05c445e5744ee59d8278219" to stop ...
I0709 00:27:27.943186   12564 docker.go:980] Removing container "1a1f565ec2aa624c9423192d82d7d778c226efd7c05c445e5744ee59d8278219" ...
I0709 00:27:27.956583   12564 docker.go:990] Removed container "1a1f565ec2aa624c9423192d82d7d778c226efd7c05c445e5744ee59d8278219"
I0709 00:27:27.956714   12564 sti.go:227] Running "assemble" in "test/sti-incremental-app-scripts"
I0709 00:27:27.956757   12564 sti.go:585] Using image name sti_test/sti-fake-scripts
I0709 00:27:27.958817   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts:latest"
I0709 00:27:27.958945   12564 environment.go:41] Setting 1 environment variables provided by environment file in sources
I0709 00:27:27.959302   12564 sti.go:703] starting the source uploading ...
I0709 00:27:27.959372   12564 tar.go:239] Adding "/tmp/s2i087813463/upload" to tar ...
I0709 00:27:27.959812   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts as artifacts
I0709 00:27:27.962994   12564 docker.go:730] Image sha256:f197c17b3ffceed9f5542138f02d96386672e2cc1a4059bc669c6eb6f4ecbbc6 contains io.openshift.s2i.scripts-url set to "image:///tmp/scripts/"
I0709 00:27:27.963052   12564 docker.go:804] Base directory for S2I scripts is '/tmp/scripts/'. Untarring destination is '/tmp'.
I0709 00:27:27.963126   12564 docker.go:961] Setting "/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble" command for container ...
I0709 00:27:27.963413   12564 docker.go:970] Creating container with options {Name:"s2i_sti_test_sti_fake_scripts_4ca2672c" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:true StdinOnce:true Env:[RACK_ENV=production] Cmd:[/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble] Healthcheck:<nil> ArgsEscaped:false Image:sti_test/sti-fake-scripts:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:28.323131   12564 docker.go:1002] Attaching to container "dd2a7c68a55bc406946696e00640066467c9aac359465319734c99d3b2856917" ...
I0709 00:27:28.324586   12564 docker.go:1013] Starting container "dd2a7c68a55bc406946696e00640066467c9aac359465319734c99d3b2856917" ...
I0709 00:27:28.604434   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/.gitignore as artifacts/.gitignore
I0709 00:27:28.604943   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/.s2i as artifacts/.s2i
I0709 00:27:28.605397   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/.s2i/bin as artifacts/.s2i/bin
I0709 00:27:28.605929   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/.s2i/bin/README as artifacts/.s2i/bin/README
I0709 00:27:28.606401   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/.s2i/environment as artifacts/.s2i/environment
I0709 00:27:28.607362   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/.travis.yml as artifacts/.travis.yml
I0709 00:27:28.608306   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/Dockerfile as artifacts/Dockerfile
I0709 00:27:28.609094   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/Gemfile as artifacts/Gemfile
I0709 00:27:28.609995   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/Gemfile.lock as artifacts/Gemfile.lock
I0709 00:27:28.610539   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/README.md as artifacts/README.md
I0709 00:27:28.611040   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/Rakefile as artifacts/Rakefile
I0709 00:27:28.611539   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/app.rb as artifacts/app.rb
I0709 00:27:28.612089   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/config as artifacts/config
I0709 00:27:28.612477   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/config/database.rb as artifacts/config/database.rb
I0709 00:27:28.613004   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/config/database.yml as artifacts/config/database.yml
I0709 00:27:28.613453   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/config.ru as artifacts/config.ru
I0709 00:27:28.613862   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/db as artifacts/db
I0709 00:27:28.614238   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/db/migrate as artifacts/db/migrate
I0709 00:27:28.614722   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/db/migrate/20141102191902_create_key_pair.rb as artifacts/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:28.615224   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/models.rb as artifacts/models.rb
I0709 00:27:28.615733   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/run.sh as artifacts/run.sh
I0709 00:27:28.616279   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/save-artifacts-invoked as artifacts/save-artifacts-invoked
I0709 00:27:28.616843   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/test as artifacts/test
I0709 00:27:28.617341   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/test/sample_test.rb as artifacts/test/sample_test.rb
I0709 00:27:28.617756   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/views as artifacts/views
I0709 00:27:28.618102   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/artifacts/views/main.erb as artifacts/views/main.erb
I0709 00:27:28.618458   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/scripts as scripts
I0709 00:27:28.618864   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src as src
I0709 00:27:28.622574   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/.gitignore as src/.gitignore
I0709 00:27:28.622985   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/.s2i as src/.s2i
I0709 00:27:28.623358   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/.s2i/bin as src/.s2i/bin
I0709 00:27:28.623841   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/.s2i/bin/README as src/.s2i/bin/README
I0709 00:27:28.624296   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/.s2i/environment as src/.s2i/environment
I0709 00:27:28.624763   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/.travis.yml as src/.travis.yml
I0709 00:27:28.625287   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/Dockerfile as src/Dockerfile
I0709 00:27:28.625809   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/Gemfile as src/Gemfile
I0709 00:27:28.626300   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/Gemfile.lock as src/Gemfile.lock
I0709 00:27:28.626725   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/README.md as src/README.md
I0709 00:27:28.627147   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/Rakefile as src/Rakefile
I0709 00:27:28.627516   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/app.rb as src/app.rb
I0709 00:27:28.628334   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/config as src/config
I0709 00:27:28.629372   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/config/database.rb as src/config/database.rb
I0709 00:27:28.629958   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/config/database.yml as src/config/database.yml
I0709 00:27:28.630774   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/config.ru as src/config.ru
I0709 00:27:28.631548   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/db as src/db
I0709 00:27:28.631946   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/db/migrate as src/db/migrate
I0709 00:27:28.632361   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/db/migrate/20141102191902_create_key_pair.rb as src/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:28.633339   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/models.rb as src/models.rb
I0709 00:27:28.633859   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/run.sh as src/run.sh
I0709 00:27:28.634941   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/test as src/test
I0709 00:27:28.635688   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/test/sample_test.rb as src/test/sample_test.rb
I0709 00:27:28.636184   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/views as src/views
I0709 00:27:28.636555   12564 tar.go:337] Adding to tar: /tmp/s2i087813463/upload/src/views/main.erb as src/views/main.erb
I0709 00:27:28.682129   12564 docker.go:1044] Waiting for container "dd2a7c68a55bc406946696e00640066467c9aac359465319734c99d3b2856917" to stop ...
I0709 00:27:28.842291   12564 docker.go:1069] Invoking PostExecute function
I0709 00:27:28.842344   12564 postexecutorstep.go:63] Executing step: store previous image
I0709 00:27:28.844928   12564 postexecutorstep.go:117] Executing step: commit image
I0709 00:27:28.846817   12564 postexecutorstep.go:523] Checking for new Labels to apply... 
I0709 00:27:28.846876   12564 postexecutorstep.go:531] Creating the download path '/tmp/s2i087813463/metadata'
I0709 00:27:28.847042   12564 postexecutorstep.go:465] Downloading file "/tmp/.s2i/image_metadata.json"
I0709 00:27:28.991507   12564 tar.go:401] Creating directory /tmp/s2i087813463/metadata
I0709 00:27:28.991602   12564 tar.go:469] Creating /tmp/s2i087813463/metadata/image_metadata.json
I0709 00:27:28.991756   12564 tar.go:479] Extracting/writing /tmp/s2i087813463/metadata/image_metadata.json
I0709 00:27:28.991914   12564 tar.go:425] Done extracting tar stream
I0709 00:27:28.992061   12564 postexecutorstep.go:556] new Labels File contents : 
{
  "labels": [
    {"testLabel": "testLabel_value"}
  ]
}

I0709 00:27:28.996183   12564 docker.go:1103] Committing container with dockerOpts: {Reference:test/sti-incremental-app-scripts Comment: Author: Changes:[] Pause:false Config:0xc0004b3cc0}, config: {Hostname: Domainname: User: AttachStdin:false AttachStdout:false AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[RACK_ENV=production] Cmd:[/tmp/scripts//run] Healthcheck:<nil> ArgsEscaped:false Image: Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[io.k8s.display-name:test/sti-incremental-app-scripts io.openshift.s2i.build.commit.author:Ben Parees <bparees@users.noreply.github.com> io.openshift.s2i.build.commit.date:Thu Jan 17 17:21:03 2019 -0500 io.openshift.s2i.build.commit.id:787f1beae9956c959c6af62ee43bfdda73769cf7 io.openshift.s2i.build.commit.message:Merge pull request #78 from bparees/v22 io.openshift.s2i.build.commit.ref:master io.openshift.s2i.build.image:sti_test/sti-fake-scripts io.openshift.s2i.build.source-location:https://github.com/openshift/ruby-hello-world io.openshift.s2i.scripts-url:image:///tmp/scripts/ testLabel:testLabel_value] StopSignal: StopTimeout:<nil> Shell:[]}
I0709 00:27:29.846315   12564 postexecutorstep.go:393] Executing step: report success
I0709 00:27:29.846371   12564 postexecutorstep.go:398] Successfully built test/sti-incremental-app-scripts
I0709 00:27:29.846408   12564 postexecutorstep.go:88] Executing step: remove previous image
I0709 00:27:29.846436   12564 postexecutorstep.go:102] Removing previously-tagged image sha256:f1be2913b532cd40c37ac8c34ab0d3753bf867ca30a88a32491a148602cb0ddc
I0709 00:27:29.852310   12564 docker.go:980] Removing container "dd2a7c68a55bc406946696e00640066467c9aac359465319734c99d3b2856917" ...
I0709 00:27:29.865310   12564 docker.go:990] Removed container "dd2a7c68a55bc406946696e00640066467c9aac359465319734c99d3b2856917"
I0709 00:27:29.865429   12564 cleanup.go:33] Removing temporary directory /tmp/s2i087813463
I0709 00:27:29.865471   12564 fs.go:314] Removing directory '/tmp/s2i087813463'
--- PASS: TestIncrementalBuildScripts (6.54s)
=== RUN   TestIncrementalBuildScriptsNoSaveArtifacts
I0709 00:27:31.320871   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts-no-save-artifacts:latest"
I0709 00:27:31.328315   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts-no-save-artifacts:latest"
I0709 00:27:31.328376   12564 docker.go:730] Image sha256:b65e909f150bc489f216239dd3e38a460fac29156d09b6c9123ffcf4289d7311 contains io.openshift.s2i.scripts-url set to "image:///tmp/scripts/"
I0709 00:27:31.328431   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:31.328560   12564 sti.go:204] Preparing to build test/sti-incremental-app-scripts-no-save-artifacts
I0709 00:27:31.329007   12564 clone.go:36] Downloading "https://github.com/openshift/ruby-hello-world" ...
I0709 00:27:31.329071   12564 clone.go:40] Cloning sources into "/tmp/s2i122918305/upload/src"
I0709 00:27:31.550316   12564 clone.go:56] Checked out "HEAD"
I0709 00:27:31.575339   12564 clone.go:62] Updated submodules for "HEAD"
I0709 00:27:31.586374   12564 install.go:261] Using "assemble" installed from "image:///tmp/scripts//assemble"
I0709 00:27:31.586482   12564 install.go:261] Using "run" installed from "image:///tmp/scripts//run"
I0709 00:27:31.586603   12564 install.go:261] Using "save-artifacts" installed from "image:///tmp/scripts//save-artifacts"
I0709 00:27:31.586667   12564 ignore.go:66] .s2iignore file does not exist
I0709 00:27:31.586705   12564 sti.go:213] Clean build will be performed
I0709 00:27:31.586745   12564 sti.go:216] Performing source build from https://github.com/openshift/ruby-hello-world
I0709 00:27:31.586797   12564 sti.go:227] Running "assemble" in "test/sti-incremental-app-scripts-no-save-artifacts"
I0709 00:27:31.586832   12564 sti.go:585] Using image name sti_test/sti-fake-scripts-no-save-artifacts
I0709 00:27:31.589837   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts-no-save-artifacts:latest"
I0709 00:27:31.589936   12564 environment.go:41] Setting 1 environment variables provided by environment file in sources
I0709 00:27:31.590274   12564 sti.go:703] starting the source uploading ...
I0709 00:27:31.590344   12564 tar.go:239] Adding "/tmp/s2i122918305/upload" to tar ...
I0709 00:27:31.590737   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/scripts as scripts
I0709 00:27:31.594119   12564 docker.go:730] Image sha256:b65e909f150bc489f216239dd3e38a460fac29156d09b6c9123ffcf4289d7311 contains io.openshift.s2i.scripts-url set to "image:///tmp/scripts/"
I0709 00:27:31.594178   12564 docker.go:804] Base directory for S2I scripts is '/tmp/scripts/'. Untarring destination is '/tmp'.
I0709 00:27:31.594252   12564 docker.go:961] Setting "/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble" command for container ...
I0709 00:27:31.594572   12564 docker.go:970] Creating container with options {Name:"s2i_sti_test_sti_fake_scripts_no_save_artifacts_3fdfb4c6" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:true StdinOnce:true Env:[RACK_ENV=production] Cmd:[/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble] Healthcheck:<nil> ArgsEscaped:false Image:sti_test/sti-fake-scripts-no-save-artifacts:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:31.984087   12564 docker.go:1002] Attaching to container "57b6ffeb1d16b02f123547a0937368175936dd8afe162eee257124d33ba6777c" ...
I0709 00:27:31.986381   12564 docker.go:1013] Starting container "57b6ffeb1d16b02f123547a0937368175936dd8afe162eee257124d33ba6777c" ...
I0709 00:27:32.273174   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src as src
I0709 00:27:32.277042   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/.gitignore as src/.gitignore
I0709 00:27:32.277583   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/.s2i as src/.s2i
I0709 00:27:32.278066   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/.s2i/bin as src/.s2i/bin
I0709 00:27:32.278545   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/.s2i/bin/README as src/.s2i/bin/README
I0709 00:27:32.279076   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/.s2i/environment as src/.s2i/environment
I0709 00:27:32.279556   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/.travis.yml as src/.travis.yml
I0709 00:27:32.280041   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/Dockerfile as src/Dockerfile
I0709 00:27:32.280458   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/Gemfile as src/Gemfile
I0709 00:27:32.280879   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/Gemfile.lock as src/Gemfile.lock
I0709 00:27:32.281306   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/README.md as src/README.md
I0709 00:27:32.281758   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/Rakefile as src/Rakefile
I0709 00:27:32.282270   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/app.rb as src/app.rb
I0709 00:27:32.282725   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/config as src/config
I0709 00:27:32.283094   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/config/database.rb as src/config/database.rb
I0709 00:27:32.283511   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/config/database.yml as src/config/database.yml
I0709 00:27:32.283911   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/config.ru as src/config.ru
I0709 00:27:32.284336   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/db as src/db
I0709 00:27:32.284728   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/db/migrate as src/db/migrate
I0709 00:27:32.285136   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/db/migrate/20141102191902_create_key_pair.rb as src/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:32.285575   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/models.rb as src/models.rb
I0709 00:27:32.285984   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/run.sh as src/run.sh
I0709 00:27:32.286382   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/test as src/test
I0709 00:27:32.286771   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/test/sample_test.rb as src/test/sample_test.rb
I0709 00:27:32.287181   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/views as src/views
I0709 00:27:32.287530   12564 tar.go:337] Adding to tar: /tmp/s2i122918305/upload/src/views/main.erb as src/views/main.erb
I0709 00:27:32.340297   12564 docker.go:1044] Waiting for container "57b6ffeb1d16b02f123547a0937368175936dd8afe162eee257124d33ba6777c" to stop ...
I0709 00:27:32.503976   12564 docker.go:1069] Invoking PostExecute function
I0709 00:27:32.504039   12564 postexecutorstep.go:68] Skipping step: store previous image
I0709 00:27:32.504070   12564 postexecutorstep.go:117] Executing step: commit image
I0709 00:27:32.506262   12564 postexecutorstep.go:523] Checking for new Labels to apply... 
I0709 00:27:32.506319   12564 postexecutorstep.go:531] Creating the download path '/tmp/s2i122918305/metadata'
I0709 00:27:32.506485   12564 postexecutorstep.go:465] Downloading file "/tmp/.s2i/image_metadata.json"
I0709 00:27:32.654655   12564 tar.go:401] Creating directory /tmp/s2i122918305/metadata
I0709 00:27:32.654750   12564 tar.go:469] Creating /tmp/s2i122918305/metadata/image_metadata.json
I0709 00:27:32.654951   12564 tar.go:479] Extracting/writing /tmp/s2i122918305/metadata/image_metadata.json
I0709 00:27:32.655107   12564 tar.go:425] Done extracting tar stream
I0709 00:27:32.655240   12564 postexecutorstep.go:556] new Labels File contents : 
{
  "labels": [
    {"testLabel": "testLabel_value"}
  ]
}

I0709 00:27:32.659494   12564 docker.go:1103] Committing container with dockerOpts: {Reference:test/sti-incremental-app-scripts-no-save-artifacts Comment: Author: Changes:[] Pause:false Config:0xc00024e000}, config: {Hostname: Domainname: User: AttachStdin:false AttachStdout:false AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[RACK_ENV=production] Cmd:[/tmp/scripts//run] Healthcheck:<nil> ArgsEscaped:false Image: Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[io.k8s.display-name:test/sti-incremental-app-scripts-no-save-artifacts io.openshift.s2i.build.commit.author:Ben Parees <bparees@users.noreply.github.com> io.openshift.s2i.build.commit.date:Thu Jan 17 17:21:03 2019 -0500 io.openshift.s2i.build.commit.id:787f1beae9956c959c6af62ee43bfdda73769cf7 io.openshift.s2i.build.commit.message:Merge pull request #78 from bparees/v22 io.openshift.s2i.build.commit.ref:master io.openshift.s2i.build.image:sti_test/sti-fake-scripts-no-save-artifacts io.openshift.s2i.build.source-location:https://github.com/openshift/ruby-hello-world io.openshift.s2i.scripts-url:image:///tmp/scripts/ testLabel:testLabel_value] StopSignal: StopTimeout:<nil> Shell:[]}
I0709 00:27:33.293313   12564 postexecutorstep.go:393] Executing step: report success
I0709 00:27:33.293366   12564 postexecutorstep.go:398] Successfully built test/sti-incremental-app-scripts-no-save-artifacts
I0709 00:27:33.293403   12564 postexecutorstep.go:93] Skipping step: remove previous image
I0709 00:27:33.293497   12564 docker.go:980] Removing container "57b6ffeb1d16b02f123547a0937368175936dd8afe162eee257124d33ba6777c" ...
I0709 00:27:33.307080   12564 docker.go:990] Removed container "57b6ffeb1d16b02f123547a0937368175936dd8afe162eee257124d33ba6777c"
I0709 00:27:33.307209   12564 cleanup.go:33] Removing temporary directory /tmp/s2i122918305
I0709 00:27:33.307250   12564 fs.go:314] Removing directory '/tmp/s2i122918305'
I0709 00:27:33.311819   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts-no-save-artifacts:latest"
I0709 00:27:33.317470   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts-no-save-artifacts:latest"
I0709 00:27:33.317543   12564 docker.go:730] Image sha256:b65e909f150bc489f216239dd3e38a460fac29156d09b6c9123ffcf4289d7311 contains io.openshift.s2i.scripts-url set to "image:///tmp/scripts/"
I0709 00:27:33.317601   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:33.317716   12564 sti.go:204] Preparing to build test/sti-incremental-app-scripts-no-save-artifacts
I0709 00:27:33.318113   12564 clone.go:36] Downloading "https://github.com/openshift/ruby-hello-world" ...
I0709 00:27:33.318166   12564 clone.go:40] Cloning sources into "/tmp/s2i903146619/upload/src"
I0709 00:27:33.538824   12564 clone.go:56] Checked out "HEAD"
I0709 00:27:33.562239   12564 clone.go:62] Updated submodules for "HEAD"
I0709 00:27:33.573315   12564 install.go:261] Using "assemble" installed from "image:///tmp/scripts//assemble"
I0709 00:27:33.573431   12564 install.go:261] Using "run" installed from "image:///tmp/scripts//run"
I0709 00:27:33.573570   12564 install.go:261] Using "save-artifacts" installed from "image:///tmp/scripts//save-artifacts"
I0709 00:27:33.573648   12564 ignore.go:66] .s2iignore file does not exist
I0709 00:27:33.576403   12564 docker.go:490] Using locally available image "test/sti-incremental-app-scripts-no-save-artifacts:latest"
I0709 00:27:33.578720   12564 sti.go:211] Existing image for tag test/sti-incremental-app-scripts-no-save-artifacts detected for incremental build
I0709 00:27:33.578777   12564 sti.go:216] Performing source build from https://github.com/openshift/ruby-hello-world
I0709 00:27:33.578904   12564 sti.go:522] Saving build artifacts from image test/sti-incremental-app-scripts-no-save-artifacts to path /tmp/s2i903146619/upload/artifacts
I0709 00:27:33.581234   12564 sti.go:546] The assemble user is not set, defaulting to "" user
I0709 00:27:33.585929   12564 docker.go:730] Image sha256:8de6eb82dd0505028995a5d3c4354e7cf438b2bc537e9e86d6c3033d79e8d614 contains io.openshift.s2i.scripts-url set to "image:///tmp/scripts/"
I0709 00:27:33.585975   12564 docker.go:804] Base directory for S2I scripts is '/tmp/scripts/'. Untarring destination is '/tmp'.
I0709 00:27:33.586026   12564 docker.go:961] Setting "/tmp/scripts/save-artifacts" command for container ...
I0709 00:27:33.586278   12564 docker.go:970] Creating container with options {Name:"s2i_test_sti_incremental_app_scripts_no_save_artifacts_aa83b63e" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[] Cmd:[/tmp/scripts/save-artifacts] Healthcheck:<nil> ArgsEscaped:false Image:test/sti-incremental-app-scripts-no-save-artifacts:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:33.941069   12564 docker.go:1002] Attaching to container "f6034f726b44675ca880be7e2dfec749b7f6626c85057a4d75f10f0d25be4a46" ...
I0709 00:27:33.942441   12564 docker.go:1013] Starting container "f6034f726b44675ca880be7e2dfec749b7f6626c85057a4d75f10f0d25be4a46" ...
I0709 00:27:34.395294   12564 docker.go:980] Removing container "f6034f726b44675ca880be7e2dfec749b7f6626c85057a4d75f10f0d25be4a46" ...
I0709 00:27:34.408867   12564 docker.go:990] Removed container "f6034f726b44675ca880be7e2dfec749b7f6626c85057a4d75f10f0d25be4a46"
W0709 00:27:34.409037   12564 sti.go:219] Clean build will be performed because of error saving previous build artifacts
I0709 00:27:34.409101   12564 sti.go:220] error: Error response from daemon: invalid header field value "oci runtime error: container_linux.go:247: starting container process caused \"exec: \\\"/tmp/scripts/save-artifacts\\\": stat /tmp/scripts/save-artifacts: no such file or directory\"\n"
I0709 00:27:34.409156   12564 sti.go:227] Running "assemble" in "test/sti-incremental-app-scripts-no-save-artifacts"
I0709 00:27:34.409196   12564 sti.go:585] Using image name sti_test/sti-fake-scripts-no-save-artifacts
I0709 00:27:34.411242   12564 docker.go:490] Using locally available image "sti_test/sti-fake-scripts-no-save-artifacts:latest"
I0709 00:27:34.411365   12564 environment.go:41] Setting 1 environment variables provided by environment file in sources
I0709 00:27:34.411713   12564 sti.go:703] starting the source uploading ...
I0709 00:27:34.411804   12564 tar.go:239] Adding "/tmp/s2i903146619/upload" to tar ...
I0709 00:27:34.412155   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/artifacts as artifacts
I0709 00:27:34.415429   12564 docker.go:730] Image sha256:b65e909f150bc489f216239dd3e38a460fac29156d09b6c9123ffcf4289d7311 contains io.openshift.s2i.scripts-url set to "image:///tmp/scripts/"
I0709 00:27:34.415479   12564 docker.go:804] Base directory for S2I scripts is '/tmp/scripts/'. Untarring destination is '/tmp'.
I0709 00:27:34.415574   12564 docker.go:961] Setting "/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble" command for container ...
I0709 00:27:34.415864   12564 docker.go:970] Creating container with options {Name:"s2i_sti_test_sti_fake_scripts_no_save_artifacts_d24406a3" Config:{Hostname: Domainname: User: AttachStdin:false AttachStdout:true AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:true StdinOnce:true Env:[RACK_ENV=production] Cmd:[/bin/sh -c tar -C /tmp -xf - && /tmp/scripts/assemble] Healthcheck:<nil> ArgsEscaped:false Image:sti_test/sti-fake-scripts-no-save-artifacts:latest Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[] StopSignal: StopTimeout:<nil> Shell:[]} HostConfig:&{Binds:[] ContainerIDFile: LogConfig:{Type: Config:map[]} NetworkMode: PortBindings:map[] RestartPolicy:{Name: MaximumRetryCount:0} AutoRemove:false VolumeDriver: VolumesFrom:[] CapAdd:[] CapDrop:[] DNS:[] DNSOptions:[] DNSSearch:[] ExtraHosts:[] GroupAdd:[] IpcMode: Cgroup: Links:[] OomScoreAdj:0 PidMode: Privileged:false PublishAllPorts:false ReadonlyRootfs:false SecurityOpt:[] StorageOpt:map[] Tmpfs:map[] UTSMode: UsernsMode: ShmSize:67108864 Sysctls:map[] Runtime: ConsoleSize:[0 0] Isolation: Resources:{CPUShares:0 Memory:0 NanoCPUs:0 CgroupParent: BlkioWeight:0 BlkioWeightDevice:[] BlkioDeviceReadBps:[] BlkioDeviceWriteBps:[] BlkioDeviceReadIOps:[] BlkioDeviceWriteIOps:[] CPUPeriod:0 CPUQuota:0 CPURealtimePeriod:0 CPURealtimeRuntime:0 CpusetCpus: CpusetMems: Devices:[] DeviceCgroupRules:[] DiskQuota:0 KernelMemory:0 MemoryReservation:0 MemorySwap:0 MemorySwappiness:<nil> OomKillDisable:<nil> PidsLimit:0 Ulimits:[] CPUCount:0 CPUPercent:0 IOMaximumIOps:0 IOMaximumBandwidth:0} Mounts:[] Init:<nil>}} ...
I0709 00:27:34.789906   12564 docker.go:1002] Attaching to container "e84816429cbc5d58d6d3f88735d4c22e18544559da00000808859b6098fb336d" ...
I0709 00:27:34.791137   12564 docker.go:1013] Starting container "e84816429cbc5d58d6d3f88735d4c22e18544559da00000808859b6098fb336d" ...
I0709 00:27:35.063089   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/scripts as scripts
I0709 00:27:35.063651   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src as src
I0709 00:27:35.068225   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/.gitignore as src/.gitignore
I0709 00:27:35.068682   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/.s2i as src/.s2i
I0709 00:27:35.069096   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/.s2i/bin as src/.s2i/bin
I0709 00:27:35.069527   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/.s2i/bin/README as src/.s2i/bin/README
I0709 00:27:35.069934   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/.s2i/environment as src/.s2i/environment
I0709 00:27:35.070317   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/.travis.yml as src/.travis.yml
I0709 00:27:35.070810   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/Dockerfile as src/Dockerfile
I0709 00:27:35.071320   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/Gemfile as src/Gemfile
I0709 00:27:35.071816   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/Gemfile.lock as src/Gemfile.lock
I0709 00:27:35.072339   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/README.md as src/README.md
I0709 00:27:35.072815   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/Rakefile as src/Rakefile
I0709 00:27:35.073312   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/app.rb as src/app.rb
I0709 00:27:35.073823   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/config as src/config
I0709 00:27:35.074256   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/config/database.rb as src/config/database.rb
I0709 00:27:35.074751   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/config/database.yml as src/config/database.yml
I0709 00:27:35.075210   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/config.ru as src/config.ru
I0709 00:27:35.075724   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/db as src/db
I0709 00:27:35.076212   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/db/migrate as src/db/migrate
I0709 00:27:35.076719   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/db/migrate/20141102191902_create_key_pair.rb as src/db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:35.077254   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/models.rb as src/models.rb
I0709 00:27:35.077814   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/run.sh as src/run.sh
I0709 00:27:35.078302   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/test as src/test
I0709 00:27:35.078800   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/test/sample_test.rb as src/test/sample_test.rb
I0709 00:27:35.079298   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/views as src/views
I0709 00:27:35.079801   12564 tar.go:337] Adding to tar: /tmp/s2i903146619/upload/src/views/main.erb as src/views/main.erb
I0709 00:27:35.128664   12564 docker.go:1044] Waiting for container "e84816429cbc5d58d6d3f88735d4c22e18544559da00000808859b6098fb336d" to stop ...
I0709 00:27:35.283788   12564 docker.go:1069] Invoking PostExecute function
I0709 00:27:35.283842   12564 postexecutorstep.go:63] Executing step: store previous image
I0709 00:27:35.286470   12564 postexecutorstep.go:117] Executing step: commit image
I0709 00:27:35.288464   12564 postexecutorstep.go:523] Checking for new Labels to apply... 
I0709 00:27:35.288537   12564 postexecutorstep.go:531] Creating the download path '/tmp/s2i903146619/metadata'
I0709 00:27:35.288694   12564 postexecutorstep.go:465] Downloading file "/tmp/.s2i/image_metadata.json"
I0709 00:27:35.440534   12564 tar.go:401] Creating directory /tmp/s2i903146619/metadata
I0709 00:27:35.440624   12564 tar.go:469] Creating /tmp/s2i903146619/metadata/image_metadata.json
I0709 00:27:35.440753   12564 tar.go:479] Extracting/writing /tmp/s2i903146619/metadata/image_metadata.json
I0709 00:27:35.440893   12564 tar.go:425] Done extracting tar stream
I0709 00:27:35.441016   12564 postexecutorstep.go:556] new Labels File contents : 
{
  "labels": [
    {"testLabel": "testLabel_value"}
  ]
}

I0709 00:27:35.445140   12564 docker.go:1103] Committing container with dockerOpts: {Reference:test/sti-incremental-app-scripts-no-save-artifacts Comment: Author: Changes:[] Pause:false Config:0xc0004b3a40}, config: {Hostname: Domainname: User: AttachStdin:false AttachStdout:false AttachStderr:false ExposedPorts:map[] Tty:false OpenStdin:false StdinOnce:false Env:[RACK_ENV=production] Cmd:[/tmp/scripts//run] Healthcheck:<nil> ArgsEscaped:false Image: Volumes:map[] WorkingDir: Entrypoint:[] NetworkDisabled:false MacAddress: OnBuild:[] Labels:map[io.k8s.display-name:test/sti-incremental-app-scripts-no-save-artifacts io.openshift.s2i.build.commit.author:Ben Parees <bparees@users.noreply.github.com> io.openshift.s2i.build.commit.date:Thu Jan 17 17:21:03 2019 -0500 io.openshift.s2i.build.commit.id:787f1beae9956c959c6af62ee43bfdda73769cf7 io.openshift.s2i.build.commit.message:Merge pull request #78 from bparees/v22 io.openshift.s2i.build.commit.ref:master io.openshift.s2i.build.image:sti_test/sti-fake-scripts-no-save-artifacts io.openshift.s2i.build.source-location:https://github.com/openshift/ruby-hello-world io.openshift.s2i.scripts-url:image:///tmp/scripts/ testLabel:testLabel_value] StopSignal: StopTimeout:<nil> Shell:[]}
I0709 00:27:36.589314   12564 postexecutorstep.go:393] Executing step: report success
I0709 00:27:36.589366   12564 postexecutorstep.go:398] Successfully built test/sti-incremental-app-scripts-no-save-artifacts
I0709 00:27:36.589402   12564 postexecutorstep.go:88] Executing step: remove previous image
I0709 00:27:36.589430   12564 postexecutorstep.go:102] Removing previously-tagged image sha256:8de6eb82dd0505028995a5d3c4354e7cf438b2bc537e9e86d6c3033d79e8d614
I0709 00:27:36.596053   12564 docker.go:980] Removing container "e84816429cbc5d58d6d3f88735d4c22e18544559da00000808859b6098fb336d" ...
I0709 00:27:36.609059   12564 docker.go:990] Removed container "e84816429cbc5d58d6d3f88735d4c22e18544559da00000808859b6098fb336d"
I0709 00:27:36.609205   12564 cleanup.go:33] Removing temporary directory /tmp/s2i903146619
I0709 00:27:36.609248   12564 fs.go:314] Removing directory '/tmp/s2i903146619'
--- PASS: TestIncrementalBuildScriptsNoSaveArtifacts (6.73s)
=== RUN   TestIncrementalBuildOnBuild
I0709 00:27:38.056201   12564 docker.go:490] Using locally available image "sti_test/sti-fake-onbuild:latest"
I0709 00:27:38.061936   12564 docker.go:490] Using locally available image "sti_test/sti-fake-onbuild:latest"
I0709 00:27:38.061997   12564 docker.go:730] Image sha256:47cf19d94224f0f57f59e6fbe58b57e2fa6ce9f0d891b77530828bd89c3b9046 contains io.openshift.s2i.scripts-url set to "http://127.0.0.1:23456/.s2i/bin"
I0709 00:27:38.062063   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:38.062183   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:38.062221   12564 onbuild.go:87] Preparing the source code for build
I0709 00:27:38.062754   12564 clone.go:36] Downloading "https://github.com/openshift/ruby-hello-world" ...
I0709 00:27:38.062806   12564 clone.go:40] Cloning sources into "/tmp/s2i901276773/upload/src"
I0709 00:27:38.258281   12564 clone.go:56] Checked out "HEAD"
I0709 00:27:38.282104   12564 clone.go:62] Updated submodules for "HEAD"
I0709 00:27:38.294887   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/assemble'
I0709 00:27:38.294988   12564 install.go:261] Using "assemble" installed from "http://127.0.0.1:23456/.s2i/bin/assemble"
I0709 00:27:38.296461   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/run'
I0709 00:27:38.296586   12564 install.go:261] Using "run" installed from "http://127.0.0.1:23456/.s2i/bin/run"
I0709 00:27:38.296698   12564 ignore.go:66] .s2iignore file does not exist
I0709 00:27:38.296774   12564 onbuild.go:181] Found S2I 'run' script, copying to application source dir
I0709 00:27:38.296956   12564 fs.go:270] F "/tmp/s2i901276773/upload/scripts/run" -> "/tmp/s2i901276773/upload/src/run"
I0709 00:27:38.297091   12564 onbuild.go:185] Found S2I 'assemble' script, copying to application source dir
I0709 00:27:38.297266   12564 fs.go:270] F "/tmp/s2i901276773/upload/scripts/assemble" -> "/tmp/s2i901276773/upload/src/assemble"
I0709 00:27:38.297379   12564 onbuild.go:97] Creating application Dockerfile
I0709 00:27:38.297842   12564 entrypoint.go:33] Found valid ENTRYPOINT: run
I0709 00:27:38.297946   12564 environment.go:41] Setting 1 environment variables provided by environment file in sources
I0709 00:27:38.298109   12564 onbuild.go:106] Creating application source code image
I0709 00:27:38.298283   12564 tar.go:239] Adding "/tmp/s2i901276773/upload/src" to tar ...
I0709 00:27:38.298339   12564 onbuild.go:120] Building the application source
I0709 00:27:38.298483   12564 docker.go:1135] Building container using config: {Tags:[test/sti-incremental-app-onbuild] SuppressOutput:false RemoteContext: NoCache:true Remove:true ForceRemove:true PullParent:false Isolation: CPUSetCPUs: CPUSetMems: CPUShares:0 CPUQuota:0 CPUPeriod:0 Memory:0 MemorySwap:0 CgroupParent: NetworkMode: ShmSize:0 Dockerfile: Ulimits:[] BuildArgs:map[] AuthConfigs:map[] Context:<nil> Labels:map[] Squash:false CacheFrom:[] SecurityOpt:[] ExtraHosts:[] Target: SessionID:}
I0709 00:27:38.302294   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/.gitignore as .gitignore
I0709 00:27:38.302880   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/.s2i as .s2i
I0709 00:27:38.303328   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/.s2i/bin as .s2i/bin
I0709 00:27:38.303784   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/.s2i/bin/README as .s2i/bin/README
I0709 00:27:38.304301   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/.s2i/environment as .s2i/environment
I0709 00:27:38.304772   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/.travis.yml as .travis.yml
I0709 00:27:38.305195   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/Dockerfile as Dockerfile
I0709 00:27:38.305738   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/Gemfile as Gemfile
I0709 00:27:38.307166   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/Gemfile.lock as Gemfile.lock
I0709 00:27:38.308251   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/README.md as README.md
I0709 00:27:38.309356   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/Rakefile as Rakefile
I0709 00:27:38.309981   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/app.rb as app.rb
I0709 00:27:38.310640   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/assemble as assemble
I0709 00:27:38.311737   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/config as config
I0709 00:27:38.312309   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/config/database.rb as config/database.rb
I0709 00:27:38.313561   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/config/database.yml as config/database.yml
I0709 00:27:38.314227   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/config.ru as config.ru
I0709 00:27:38.315591   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/db as db
I0709 00:27:38.316182   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/db/migrate as db/migrate
I0709 00:27:38.316968   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/db/migrate/20141102191902_create_key_pair.rb as db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:38.317799   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/models.rb as models.rb
I0709 00:27:38.318438   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/run as run
I0709 00:27:38.319088   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/run.sh as run.sh
I0709 00:27:38.319719   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/test as test
I0709 00:27:38.320278   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/test/sample_test.rb as test/sample_test.rb
I0709 00:27:38.320956   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/views as views
I0709 00:27:38.321564   12564 tar.go:337] Adding to tar: /tmp/s2i901276773/upload/src/views/main.erb as views/main.erb
{"stream":"Step 1 : FROM sti_test/sti-fake-onbuild\n"}
{"stream":"\u001b[91m# Executing 2 build triggers...\n\u001b[0m"}
{"stream":"Step 1 : RUN touch /sti-fake/src/onbuild\n"}
{"stream":" ---\u003e Running in 7eca91514dc0\n"}
{"stream":"Step 1 : COPY . /tmp/src/\n"}
{"stream":" ---\u003e c3767715539d\n"}
{"stream":"Removing intermediate container 7eca91514dc0\n"}
{"stream":"Removing intermediate container 5c3b39866c1b\n"}
{"stream":"Step 2 : ENV RACK_ENV \"production\"\n"}
{"stream":" ---\u003e Running in 060a2d420330\n"}
{"stream":" ---\u003e e92b0e1faf31\n"}
{"stream":"Removing intermediate container 060a2d420330\n"}
{"stream":"Step 3 : RUN sh assemble\n"}
{"stream":" ---\u003e Running in 907fc2ddd35e\n"}
{"stream":" ---\u003e e1eefa71f3e9\n"}
{"stream":"Removing intermediate container 907fc2ddd35e\n"}
{"stream":"Step 4 : ENTRYPOINT ./run\n"}
{"stream":" ---\u003e Running in c8dff9c21db1\n"}
{"stream":" ---\u003e e58f1d85b934\n"}
{"stream":"Removing intermediate container c8dff9c21db1\n"}
{"stream":"Successfully built e58f1d85b934\n"}
I0709 00:27:45.611854   12564 onbuild.go:129] Cleaning up temporary containers
I0709 00:27:45.611903   12564 cleanup.go:33] Removing temporary directory /tmp/s2i901276773
I0709 00:27:45.611946   12564 fs.go:314] Removing directory '/tmp/s2i901276773'
I0709 00:27:45.618741   12564 docker.go:490] Using locally available image "sti_test/sti-fake-onbuild:latest"
I0709 00:27:45.624511   12564 docker.go:490] Using locally available image "sti_test/sti-fake-onbuild:latest"
I0709 00:27:45.624597   12564 docker.go:730] Image sha256:47cf19d94224f0f57f59e6fbe58b57e2fa6ce9f0d891b77530828bd89c3b9046 contains io.openshift.s2i.scripts-url set to "http://127.0.0.1:23456/.s2i/bin"
I0709 00:27:45.624661   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:45.624789   12564 scm.go:20] DownloadForSource https://github.com/openshift/ruby-hello-world
I0709 00:27:45.624827   12564 onbuild.go:87] Preparing the source code for build
I0709 00:27:45.625402   12564 clone.go:36] Downloading "https://github.com/openshift/ruby-hello-world" ...
I0709 00:27:45.625453   12564 clone.go:40] Cloning sources into "/tmp/s2i852228224/upload/src"
I0709 00:27:45.968826   12564 clone.go:56] Checked out "HEAD"
I0709 00:27:45.992673   12564 clone.go:62] Updated submodules for "HEAD"
I0709 00:27:46.005507   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/assemble'
I0709 00:27:46.005642   12564 install.go:261] Using "assemble" installed from "http://127.0.0.1:23456/.s2i/bin/assemble"
I0709 00:27:46.007082   12564 download.go:77] Downloaded 'http://127.0.0.1:23456/.s2i/bin/run'
I0709 00:27:46.007176   12564 install.go:261] Using "run" installed from "http://127.0.0.1:23456/.s2i/bin/run"
I0709 00:27:46.007261   12564 ignore.go:66] .s2iignore file does not exist
I0709 00:27:46.007333   12564 onbuild.go:181] Found S2I 'run' script, copying to application source dir
I0709 00:27:46.007555   12564 fs.go:270] F "/tmp/s2i852228224/upload/scripts/run" -> "/tmp/s2i852228224/upload/src/run"
I0709 00:27:46.007714   12564 onbuild.go:185] Found S2I 'assemble' script, copying to application source dir
I0709 00:27:46.007915   12564 fs.go:270] F "/tmp/s2i852228224/upload/scripts/assemble" -> "/tmp/s2i852228224/upload/src/assemble"
I0709 00:27:46.008050   12564 onbuild.go:97] Creating application Dockerfile
I0709 00:27:46.008513   12564 entrypoint.go:33] Found valid ENTRYPOINT: run
I0709 00:27:46.008641   12564 environment.go:41] Setting 1 environment variables provided by environment file in sources
I0709 00:27:46.008857   12564 onbuild.go:106] Creating application source code image
I0709 00:27:46.009065   12564 onbuild.go:120] Building the application source
I0709 00:27:46.009193   12564 docker.go:1135] Building container using config: {Tags:[test/sti-incremental-app-onbuild] SuppressOutput:false RemoteContext: NoCache:true Remove:true ForceRemove:true PullParent:false Isolation: CPUSetCPUs: CPUSetMems: CPUShares:0 CPUQuota:0 CPUPeriod:0 Memory:0 MemorySwap:0 CgroupParent: NetworkMode: ShmSize:0 Dockerfile: Ulimits:[] BuildArgs:map[] AuthConfigs:map[] Context:<nil> Labels:map[] Squash:false CacheFrom:[] SecurityOpt:[] ExtraHosts:[] Target: SessionID:}
I0709 00:27:46.009534   12564 tar.go:239] Adding "/tmp/s2i852228224/upload/src" to tar ...
I0709 00:27:46.014808   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/.gitignore as .gitignore
I0709 00:27:46.016353   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/.s2i as .s2i
I0709 00:27:46.017358   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/.s2i/bin as .s2i/bin
I0709 00:27:46.017904   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/.s2i/bin/README as .s2i/bin/README
I0709 00:27:46.019029   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/.s2i/environment as .s2i/environment
I0709 00:27:46.019696   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/.travis.yml as .travis.yml
I0709 00:27:46.020320   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/Dockerfile as Dockerfile
I0709 00:27:46.021243   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/Gemfile as Gemfile
I0709 00:27:46.021851   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/Gemfile.lock as Gemfile.lock
I0709 00:27:46.022461   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/README.md as README.md
I0709 00:27:46.023086   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/Rakefile as Rakefile
I0709 00:27:46.023713   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/app.rb as app.rb
I0709 00:27:46.024311   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/assemble as assemble
I0709 00:27:46.024965   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/config as config
I0709 00:27:46.025534   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/config/database.rb as config/database.rb
I0709 00:27:46.026196   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/config/database.yml as config/database.yml
I0709 00:27:46.026846   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/config.ru as config.ru
I0709 00:27:46.027926   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/db as db
I0709 00:27:46.028536   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/db/migrate as db/migrate
I0709 00:27:46.029177   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/db/migrate/20141102191902_create_key_pair.rb as db/migrate/20141102191902_create_key_pair.rb
I0709 00:27:46.029807   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/models.rb as models.rb
I0709 00:27:46.030419   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/run as run
I0709 00:27:46.031084   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/run.sh as run.sh
I0709 00:27:46.031741   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/test as test
I0709 00:27:46.032345   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/test/sample_test.rb as test/sample_test.rb
I0709 00:27:46.032965   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/views as views
I0709 00:27:46.033471   12564 tar.go:337] Adding to tar: /tmp/s2i852228224/upload/src/views/main.erb as views/main.erb
{"stream":"Step 1 : FROM sti_test/sti-fake-onbuild\n"}
{"stream":"\u001b[91m# Executing 2 build triggers...\n\u001b[0m"}
{"stream":"Step 1 : RUN touch /sti-fake/src/onbuild\n"}
{"stream":" ---\u003e Running in d8f0fc25fbc2\n"}
{"stream":"Step 1 : COPY . /tmp/src/\n"}
{"stream":" ---\u003e 832f1cbb5d32\n"}
{"stream":"Removing intermediate container d8f0fc25fbc2\n"}
{"stream":"Removing intermediate container 651e27aa9d28\n"}
{"stream":"Step 2 : ENV RACK_ENV \"production\"\n"}
{"stream":" ---\u003e Running in 5da1cdc48f91\n"}
{"stream":" ---\u003e 011173a4170f\n"}
{"stream":"Removing intermediate container 5da1cdc48f91\n"}
{"stream":"Step 3 : RUN sh assemble\n"}
{"stream":" ---\u003e Running in b2f7d5e78e6b\n"}
{"stream":" ---\u003e b63f798b51a8\n"}
{"stream":"Removing intermediate container b2f7d5e78e6b\n"}
{"stream":"Step 4 : ENTRYPOINT ./run\n"}
{"stream":" ---\u003e Running in 9965ef48368c\n"}
{"stream":" ---\u003e 248a6b284392\n"}
{"stream":"Removing intermediate container 9965ef48368c\n"}
{"stream":"Successfully built 248a6b284392\n"}
I0709 00:27:53.155872   12564 onbuild.go:129] Cleaning up temporary containers
I0709 00:27:53.155929   12564 cleanup.go:33] Removing temporary directory /tmp/s2i852228224
I0709 00:27:53.155967   12564 fs.go:314] Removing directory '/tmp/s2i852228224'
--- PASS: TestIncrementalBuildOnBuild (16.91s)
PASS
coverage: 0.0% of statements
ok  	github.com/openshift/source-to-image/test/integration/docker	120.205s	coverage: 0.0% of statements

Complete

Running dockerfile integration tests ...

=== RUN   TestDockerfileBuild
--- PASS: TestDockerfileBuild (0.31s)
=== RUN   TestDockerfileBuildDefaultDockerfile
--- PASS: TestDockerfileBuildDefaultDockerfile (0.27s)
=== RUN   TestDockerfileBuildEnv
--- PASS: TestDockerfileBuildEnv (0.32s)
=== RUN   TestDockerfileBuildLabels
--- PASS: TestDockerfileBuildLabels (0.25s)
=== RUN   TestDockerfileBuildInjections
--- PASS: TestDockerfileBuildInjections (0.31s)
=== RUN   TestDockerfileBuildScriptsURLAssemble
--- PASS: TestDockerfileBuildScriptsURLAssemble (0.26s)
=== RUN   TestDockerfileBuildScriptsURLRun
--- PASS: TestDockerfileBuildScriptsURLRun (0.31s)
=== RUN   TestDockerfileBuildScriptsURLNone
--- PASS: TestDockerfileBuildScriptsURLNone (0.27s)
=== RUN   TestDockerfileBuildSourceScriptsAssemble
--- PASS: TestDockerfileBuildSourceScriptsAssemble (0.00s)
=== RUN   TestDockerfileBuildSourceScriptsRun
--- PASS: TestDockerfileBuildSourceScriptsRun (0.00s)
=== RUN   TestDockerfileBuildScriptsURLImage
--- PASS: TestDockerfileBuildScriptsURLImage (0.01s)
=== RUN   TestDockerfileBuildImageScriptsURLAssemble
--- PASS: TestDockerfileBuildImageScriptsURLAssemble (0.25s)
=== RUN   TestDockerfileBuildImageScriptsURLRun
--- PASS: TestDockerfileBuildImageScriptsURLRun (0.26s)
=== RUN   TestDockerfileBuildImageScriptsURLImage
--- PASS: TestDockerfileBuildImageScriptsURLImage (0.00s)
=== RUN   TestDockerfileBuildScriptsAndImageURL
--- PASS: TestDockerfileBuildScriptsAndImageURL (0.28s)
=== RUN   TestDockerfileBuildScriptsAndImageURLConflicts
--- PASS: TestDockerfileBuildScriptsAndImageURLConflicts (0.29s)
=== RUN   TestDockerfileIncrementalBuild
--- PASS: TestDockerfileIncrementalBuild (0.57s)
=== RUN   TestDockerfileIncrementalSourceSave
--- PASS: TestDockerfileIncrementalSourceSave (0.01s)
=== RUN   TestDockerfileIncrementalSaveURL
--- PASS: TestDockerfileIncrementalSaveURL (0.71s)
=== RUN   TestDockerfileIncrementalTag
--- PASS: TestDockerfileIncrementalTag (0.67s)
=== RUN   TestDockerfileIncrementalAssembleUser
--- PASS: TestDockerfileIncrementalAssembleUser (0.83s)
=== RUN   TestDockerfileLocalSource
--- PASS: TestDockerfileLocalSource (0.01s)
PASS
coverage: 0.0% of statements
ok  	github.com/openshift/source-to-image/test/integration/dockerfile	7.200s	coverage: 0.0% of statements

Complete

real	2m10.231s
user	0m9.483s
sys	0m4.230s
Finished hack/test-integration.sh
***************************************************
***************************************************
Running hack/test-stirunimage.sh...
working dir:  /tmp/sti/test-work.QQGn
s2i working dir:  /tmp/sti/test-work.QQGn
/tmp/sti/test-work.QQGn /data/src/github.com/openshift/source-to-image

cloning source into working dir


TEST PASSED


s2i build with relative path without file://


TEST PASSED


s2i build with volume options


TEST PASSED

/data/src/github.com/openshift/source-to-image

s2i build with absolute path with file://


TEST PASSED


s2i build with absolute path without file://


TEST PASSED


s2i build with non-git repo file location


TEST PASSED

I0709 00:30:17.265780   24663 download.go:38] Copying sources from "/tmp/sti/test-work.QQGn/cakephp-ex" to "/tmp/s2i646953872/upload/src"

TEST PASSED


s2i rebuild


TEST PASSED


TEST PASSED


s2i usage


TEST PASSED

I0709 00:31:31.273427   26216 sti.go:711] Sample invocation:

TEST PASSED


s2i build with overriding assemble/run scripts

Running custom assemble

TEST PASSED

Running custom run

TEST PASSED


s2i build with add-host option

Gem::RemoteFetcher::FetchError: Errno::ECONNREFUSED: Failed to open TCP connection to rubygems.org:443 (Connection refused - connect(2) for "rubygems.org" port 443) (https://rubygems.org/gems/rake-12.3.0.gem)

TEST PASSED


s2i build with remote git repo


TEST PASSED


s2i build with runtime image


TEST PASSED


s2i build with Dockerfile output


TEST PASSED


s2i build with --run==true option

Waiting up to 15*TIME_MIN for the build to finish ...
The image test-jee-app:latest has been started in container 3b63de470a4189683fd6f8f790b5bd1920b367842b19ab6d0e7e5966915ac16f as a result of the --run=true option.  The container's stdout/stderr will be redirected to this command's glog output to help you validate its behavior.  You can also inspect the container with docker commands if you like.  If the container is set up to stay running, you will have to Ctrl-C to exit this command, which should also stop the container 3b63de470a4189683fd6f8f790b5bd1920b367842b19ab6d0e7e5966915ac16f.  This particular invocation attempts to run with the port mappings 
[INFO] Success running command s2i --run=true
[INFO] Success terminating associated docker container
Cleaning up working dir /tmp/sti/test-work.QQGn

Complete

real	6m5.962s
user	0m9.749s
sys	0m5.008s
Finished hack/test-stirunimage.sh
***************************************************
==> openshiftdev: Downloading logs
==> openshiftdev: Downloading artifacts from '/tmp/sti/' to '/var/lib/jenkins/jobs/test_pull_requests_s2i/workspace/origin/artifacts/sti/'
==> openshiftdev: Downloading artifacts from '/var/log/yum.log' to '/var/lib/jenkins/jobs/test_pull_requests_s2i/workspace/origin/artifacts/yum.log'
==> openshiftdev: Downloading artifacts from '/var/log/secure' to '/var/lib/jenkins/jobs/test_pull_requests_s2i/workspace/origin/artifacts/secure'
==> openshiftdev: Downloading artifacts from '/var/log/audit/audit.log' to '/var/lib/jenkins/jobs/test_pull_requests_s2i/workspace/origin/artifacts/audit.log'
+ popd
~/jobs/test_pull_requests_s2i/workspace
[description-setter] Description set: <a href="https://github.com/openshift/source-to-image/pull/980">https://github.com/openshift/source-to-image/pull/980</a>
[PostBuildScript] - Executing post build scripts.
[PostBuildScript] - Build does not have any of the results []. Did not execute build step #0.
Finished: SUCCESS