Skip to content

Console Output

23:40:04 [2019-11-13T23:40:04.018Z] + docker run --rm -t --privileged -v /home/jenkins/workspace/moby_PR-40178/bundles:/go/src/github.com/docker/docker/bundles --name docker-pr4 -e DOCKER_EXPERIMENTAL -e DOCKER_GITCOMMIT=a9fd06e232e26cbda56cd5e5fc22b1fa6e7e255c -e DOCKER_GRAPHDRIVER -e TESTDEBUG -e TEST_SKIP_INTEGRATION_CLI -e TIMEOUT -e VALIDATE_REPO=https://github.com/moby/moby.git -e VALIDATE_BRANCH=master docker:a9fd06e232e26cbda56cd5e5fc22b1fa6e7e255c hack/make.sh dynbinary test-integration
23:40:04 [2019-11-13T23:40:04.395Z] 
23:40:04 [2019-11-13T23:40:04.395Z] Removing bundles/
23:40:04 [2019-11-13T23:40:04.395Z] 
23:40:04 [2019-11-13T23:40:04.395Z] ---> Making bundle: dynbinary (in bundles/dynbinary)
23:40:04 [2019-11-13T23:40:04.395Z] Building: bundles/dynbinary-daemon/dockerd-dev
23:40:04 [2019-11-13T23:40:04.395Z] GOOS="" GOARCH="" GOARM=""
23:41:03 [2019-11-13T23:41:03.159Z] Created binary: bundles/dynbinary-daemon/dockerd-dev
23:41:03 [2019-11-13T23:41:03.622Z] 
23:41:03 [2019-11-13T23:41:03.622Z] ---> Making bundle: test-integration (in bundles/test-integration)
23:41:04 [2019-11-13T23:41:04.170Z] PKG_CONFIG=pkg-config
23:41:04 [2019-11-13T23:41:04.170Z] GOLANG_VERSION=1.13.3
23:41:04 [2019-11-13T23:41:04.170Z] HOSTNAME=166c2a386b8b
23:41:04 [2019-11-13T23:41:04.170Z] DOCKER_EXPERIMENTAL=1
23:41:04 [2019-11-13T23:41:04.170Z] container=docker
23:41:04 [2019-11-13T23:41:04.170Z] TEST_SKIP_INTEGRATION_CLI=1
23:41:04 [2019-11-13T23:41:04.170Z] GO111MODULE=off
23:41:04 [2019-11-13T23:41:04.170Z] GOPATH=/go
23:41:04 [2019-11-13T23:41:04.170Z] PWD=/go/src/github.com/docker/docker
23:41:04 [2019-11-13T23:41:04.170Z] HOME=/root
23:41:04 [2019-11-13T23:41:04.170Z] VALIDATE_REPO=https://github.com/moby/moby.git
23:41:04 [2019-11-13T23:41:04.170Z] SCRIPTDIR=/go/src/github.com/docker/docker/hack
23:41:04 [2019-11-13T23:41:04.170Z] MAKEDIR=/go/src/github.com/docker/docker/hack/make
23:41:04 [2019-11-13T23:41:04.170Z] DOCKER_GITCOMMIT=a9fd06e232e26cbda56cd5e5fc22b1fa6e7e255c
23:41:04 [2019-11-13T23:41:04.170Z] DOCKER_BUILDTAGS=apparmor seccomp selinux journald
23:41:04 [2019-11-13T23:41:04.170Z] DOCKER_GRAPHDRIVER=overlay2
23:41:04 [2019-11-13T23:41:04.170Z] TERM=xterm
23:41:04 [2019-11-13T23:41:04.170Z] VALIDATE_BRANCH=master
23:41:04 [2019-11-13T23:41:04.170Z] DEST=bundles/test-integration
23:41:04 [2019-11-13T23:41:04.170Z] SHLVL=1
23:41:04 [2019-11-13T23:41:04.170Z] TIMEOUT=120m
23:41:04 [2019-11-13T23:41:04.170Z] PATH=/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin
23:41:04 [2019-11-13T23:41:04.170Z] DOCKER_PKG=github.com/docker/docker
23:41:04 [2019-11-13T23:41:04.170Z] TESTDEBUG=0
23:41:04 [2019-11-13T23:41:04.170Z] _=/usr/bin/env
23:41:04 [2019-11-13T23:41:04.170Z] Building test suite binary /go/src/github.com/docker/docker/integration/build/test.main
23:41:33 [2019-11-13T23:41:33.213Z] Building test suite binary /go/src/github.com/docker/docker/integration/config/test.main
23:41:34 [2019-11-13T23:41:34.008Z] Building test suite binary /go/src/github.com/docker/docker/integration/container/test.main
23:41:36 [2019-11-13T23:41:36.726Z] Building test suite binary /go/src/github.com/docker/docker/integration/image/test.main
23:41:56 [2019-11-13T23:41:56.997Z] Building test suite binary /go/src/github.com/docker/docker/integration/network/test.main
23:41:56 [2019-11-13T23:41:56.997Z] Building test suite binary /go/src/github.com/docker/docker/integration/network/ipvlan/test.main
23:41:58 [2019-11-13T23:41:58.304Z] Building test suite binary /go/src/github.com/docker/docker/integration/network/macvlan/test.main
23:41:59 [2019-11-13T23:41:59.594Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/test.main
23:41:59 [2019-11-13T23:41:59.971Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/authz/test.main
23:42:01 [2019-11-13T23:42:01.803Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/common/test.main
23:42:03 [2019-11-13T23:42:03.109Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/graphdriver/test.main
23:42:04 [2019-11-13T23:42:04.577Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/logging/test.main
23:42:07 [2019-11-13T23:42:07.108Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/volumes/test.main
23:42:08 [2019-11-13T23:42:08.448Z] Building test suite binary /go/src/github.com/docker/docker/integration/secret/test.main
23:42:09 [2019-11-13T23:42:09.816Z] Building test suite binary /go/src/github.com/docker/docker/integration/service/test.main
23:42:12 [2019-11-13T23:42:12.314Z] Building test suite binary /go/src/github.com/docker/docker/integration/session/test.main
23:42:13 [2019-11-13T23:42:13.139Z] Building test suite binary /go/src/github.com/docker/docker/integration/system/test.main
23:42:14 [2019-11-13T23:42:14.403Z] Building test suite binary /go/src/github.com/docker/docker/integration/volume/test.main
23:42:15 [2019-11-13T23:42:15.692Z] ---> Making bundle: .integration-daemon-start (in bundles/test-integration)
23:42:15 [2019-11-13T23:42:15.692Z] Using test binary docker
23:42:15 [2019-11-13T23:42:15.692Z] # DOCKER_EXPERIMENTAL is set: starting daemon with experimental features enabled! 
23:42:15 [2019-11-13T23:42:15.692Z] +++ /etc/init.d/apparmor start
23:42:15 [2019-11-13T23:42:15.692Z] /etc/init.d/apparmor: 130: /etc/init.d/apparmor: systemd-detect-virt: not found
23:42:15 [2019-11-13T23:42:15.692Z] Starting AppArmor profiles:Warning from stdin (line 1): /sbin/apparmor_parser: cannot use or update cache, disable, or force-complain via stdin
23:42:15 [2019-11-13T23:42:15.692Z] Warning failed to create cache: (null)
23:42:15 [2019-11-13T23:42:15.692Z] .
23:42:15 [2019-11-13T23:42:15.692Z] Starting dockerd
23:42:15 [2019-11-13T23:42:15.692Z] INFO: Waiting for daemon to start...
23:42:15 [2019-11-13T23:42:15.692Z] +++ exec dockerd --debug --host unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock --storage-driver overlay2 --pidfile bundles/test-integration/docker.pid --userland-proxy=true --experimental
23:42:17 [2019-11-13T23:42:17.864Z] .
23:42:17 [2019-11-13T23:42:17.864Z] ---> Making bundle: .integration-daemon-setup (in bundles/test-integration)
23:42:17 [2019-11-13T23:42:17.864Z] ---> Making bundle: .ensure-emptyfs (in bundles/test-integration)
23:42:17 [2019-11-13T23:42:17.864Z] Error: No such image: emptyfs
23:42:17 [2019-11-13T23:42:17.864Z] ++++ docker load
23:42:17 [2019-11-13T23:42:17.864Z] ++++ tar -cC bundles/test-integration/emptyfs .
23:42:17 [2019-11-13T23:42:17.864Z] Running integration-test (iteration 1)
23:42:17 [2019-11-13T23:42:17.864Z] Running /go/src/github.com/docker/docker/integration/build (s390x.integration.build) flags=-test.v -test.timeout=120m 
23:42:17 [2019-11-13T23:42:17.864Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-build-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-build-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.build -t ./test.main -test.v -test.timeout=120m
23:42:17 [2019-11-13T23:42:17.864Z] ++ set -e
23:42:17 [2019-11-13T23:42:17.864Z] ++ '[' -n 0 ']'
23:42:17 [2019-11-13T23:42:17.864Z] ++ set -x
23:42:17 [2019-11-13T23:42:17.864Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-build-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-build-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.build -t ./test.main -test.v -test.timeout=120m
23:42:27 [2019-11-13T23:42:27.410Z] Loaded image: buildpack-deps:jessie
23:42:27 [2019-11-13T23:42:27.411Z] Loaded image: busybox:latest
23:42:27 [2019-11-13T23:42:27.411Z] Loaded image: busybox:glibc
23:42:27 [2019-11-13T23:42:27.411Z] Loaded image: debian:jessie
23:42:27 [2019-11-13T23:42:27.411Z] Loaded image: hello-world:latest
23:42:27 [2019-11-13T23:42:27.411Z] INFO: Testing against a local daemon
23:42:27 [2019-11-13T23:42:27.411Z] === RUN   TestCgroupNamespacesBuild
23:42:28 [2019-11-13T23:42:28.816Z] --- PASS: TestCgroupNamespacesBuild (1.92s)
23:42:28 [2019-11-13T23:42:28.816Z] === RUN   TestCgroupNamespacesBuildDaemonHostMode
23:42:31 [2019-11-13T23:42:31.244Z] --- PASS: TestCgroupNamespacesBuildDaemonHostMode (2.00s)
23:42:31 [2019-11-13T23:42:31.244Z] === RUN   TestBuildWithSession
23:42:31 [2019-11-13T23:42:31.244Z] --- SKIP: TestBuildWithSession (0.00s)
23:42:31 [2019-11-13T23:42:31.244Z]     build_session_test.go:25: TODO: BuildKit
23:42:31 [2019-11-13T23:42:31.244Z] === RUN   TestBuildSquashParent
23:42:38 [2019-11-13T23:42:38.901Z] --- PASS: TestBuildSquashParent (6.83s)
23:42:38 [2019-11-13T23:42:38.901Z] === RUN   TestBuildWithRemoveAndForceRemove
23:42:38 [2019-11-13T23:42:38.901Z] === RUN   TestBuildWithRemoveAndForceRemove/successful_build_with_no_removal
23:42:38 [2019-11-13T23:42:38.901Z] === PAUSE TestBuildWithRemoveAndForceRemove/successful_build_with_no_removal
23:42:38 [2019-11-13T23:42:38.901Z] === RUN   TestBuildWithRemoveAndForceRemove/successful_build_with_remove
23:42:38 [2019-11-13T23:42:38.901Z] === PAUSE TestBuildWithRemoveAndForceRemove/successful_build_with_remove
23:42:38 [2019-11-13T23:42:38.901Z] === RUN   TestBuildWithRemoveAndForceRemove/successful_build_with_remove_and_force_remove
23:42:38 [2019-11-13T23:42:38.901Z] === PAUSE TestBuildWithRemoveAndForceRemove/successful_build_with_remove_and_force_remove
23:42:38 [2019-11-13T23:42:38.901Z] === RUN   TestBuildWithRemoveAndForceRemove/failed_build_with_no_removal
23:42:38 [2019-11-13T23:42:38.901Z] === PAUSE TestBuildWithRemoveAndForceRemove/failed_build_with_no_removal
23:42:38 [2019-11-13T23:42:38.901Z] === RUN   TestBuildWithRemoveAndForceRemove/failed_build_with_remove
23:42:38 [2019-11-13T23:42:38.901Z] === PAUSE TestBuildWithRemoveAndForceRemove/failed_build_with_remove
23:42:38 [2019-11-13T23:42:38.902Z] === RUN   TestBuildWithRemoveAndForceRemove/failed_build_with_remove_and_force_remove
23:42:38 [2019-11-13T23:42:38.902Z] === PAUSE TestBuildWithRemoveAndForceRemove/failed_build_with_remove_and_force_remove
23:42:38 [2019-11-13T23:42:38.902Z] === CONT  TestBuildWithRemoveAndForceRemove/successful_build_with_no_removal
23:42:38 [2019-11-13T23:42:38.902Z] === CONT  TestBuildWithRemoveAndForceRemove/failed_build_with_remove_and_force_remove
23:42:40 [2019-11-13T23:42:40.829Z] === CONT  TestBuildWithRemoveAndForceRemove/failed_build_with_remove
23:42:40 [2019-11-13T23:42:40.829Z] === CONT  TestBuildWithRemoveAndForceRemove/failed_build_with_no_removal
23:42:43 [2019-11-13T23:42:43.299Z] === CONT  TestBuildWithRemoveAndForceRemove/successful_build_with_remove_and_force_remove
23:42:43 [2019-11-13T23:42:43.299Z] === CONT  TestBuildWithRemoveAndForceRemove/successful_build_with_remove
23:42:45 [2019-11-13T23:42:45.780Z] --- PASS: TestBuildWithRemoveAndForceRemove (0.01s)
23:42:45 [2019-11-13T23:42:45.780Z]     --- PASS: TestBuildWithRemoveAndForceRemove/successful_build_with_no_removal (2.72s)
23:42:45 [2019-11-13T23:42:45.781Z]     --- PASS: TestBuildWithRemoveAndForceRemove/failed_build_with_remove_and_force_remove (2.81s)
23:42:45 [2019-11-13T23:42:45.781Z]     --- PASS: TestBuildWithRemoveAndForceRemove/failed_build_with_remove (2.59s)
23:42:45 [2019-11-13T23:42:45.781Z]     --- PASS: TestBuildWithRemoveAndForceRemove/failed_build_with_no_removal (2.58s)
23:42:45 [2019-11-13T23:42:45.781Z]     --- PASS: TestBuildWithRemoveAndForceRemove/successful_build_with_remove_and_force_remove (2.62s)
23:42:45 [2019-11-13T23:42:45.781Z]     --- PASS: TestBuildWithRemoveAndForceRemove/successful_build_with_remove (2.59s)
23:42:45 [2019-11-13T23:42:45.781Z] === RUN   TestBuildMultiStageCopy
23:42:45 [2019-11-13T23:42:45.781Z] === RUN   TestBuildMultiStageCopy/copy_to_root
23:42:48 [2019-11-13T23:42:48.227Z] === RUN   TestBuildMultiStageCopy/copy_to_newdir
23:42:48 [2019-11-13T23:42:48.588Z] === RUN   TestBuildMultiStageCopy/copy_to_newdir_nested
23:42:48 [2019-11-13T23:42:48.965Z] === RUN   TestBuildMultiStageCopy/copy_to_existingdir
23:42:49 [2019-11-13T23:42:49.764Z] === RUN   TestBuildMultiStageCopy/copy_to_newsubdir
23:42:50 [2019-11-13T23:42:50.136Z] --- PASS: TestBuildMultiStageCopy (4.53s)
23:42:50 [2019-11-13T23:42:50.136Z]     --- PASS: TestBuildMultiStageCopy/copy_to_root (2.45s)
23:42:50 [2019-11-13T23:42:50.136Z]     --- PASS: TestBuildMultiStageCopy/copy_to_newdir (0.47s)
23:42:50 [2019-11-13T23:42:50.136Z]     --- PASS: TestBuildMultiStageCopy/copy_to_newdir_nested (0.49s)
23:42:50 [2019-11-13T23:42:50.136Z]     --- PASS: TestBuildMultiStageCopy/copy_to_existingdir (0.57s)
23:42:50 [2019-11-13T23:42:50.136Z]     --- PASS: TestBuildMultiStageCopy/copy_to_newsubdir (0.55s)
23:42:50 [2019-11-13T23:42:50.136Z] === RUN   TestBuildMultiStageParentConfig
23:42:51 [2019-11-13T23:42:51.927Z] --- PASS: TestBuildMultiStageParentConfig (1.66s)
23:42:51 [2019-11-13T23:42:51.927Z] === RUN   TestBuildLabelWithTargets
23:42:54 [2019-11-13T23:42:54.525Z] --- PASS: TestBuildLabelWithTargets (2.53s)
23:42:54 [2019-11-13T23:42:54.525Z] === RUN   TestBuildWithEmptyLayers
23:42:55 [2019-11-13T23:42:55.304Z] --- PASS: TestBuildWithEmptyLayers (0.97s)
23:42:55 [2019-11-13T23:42:55.304Z] === RUN   TestBuildMultiStageOnBuild
23:42:59 [2019-11-13T23:42:59.350Z] --- PASS: TestBuildMultiStageOnBuild (3.29s)
23:42:59 [2019-11-13T23:42:59.350Z] === RUN   TestBuildUncleanTarFilenames
23:42:59 [2019-11-13T23:42:59.739Z] --- PASS: TestBuildUncleanTarFilenames (1.22s)
23:42:59 [2019-11-13T23:42:59.739Z] === RUN   TestBuildMultiStageLayerLeak
23:43:02 [2019-11-13T23:43:02.999Z] --- PASS: TestBuildMultiStageLayerLeak (2.86s)
23:43:02 [2019-11-13T23:43:02.999Z] === RUN   TestBuildWithHugeFile
23:43:37 [2019-11-13T23:43:37.279Z] --- PASS: TestBuildWithHugeFile (30.85s)
23:43:37 [2019-11-13T23:43:37.279Z] === RUN   TestBuildWithEmptyDockerfile
23:43:37 [2019-11-13T23:43:37.279Z] === RUN   TestBuildWithEmptyDockerfile/empty-dockerfile
23:43:37 [2019-11-13T23:43:37.279Z] === PAUSE TestBuildWithEmptyDockerfile/empty-dockerfile
23:43:37 [2019-11-13T23:43:37.279Z] === RUN   TestBuildWithEmptyDockerfile/empty-lines-dockerfile
23:43:37 [2019-11-13T23:43:37.279Z] === PAUSE TestBuildWithEmptyDockerfile/empty-lines-dockerfile
23:43:37 [2019-11-13T23:43:37.279Z] === RUN   TestBuildWithEmptyDockerfile/comment-only-dockerfile
23:43:37 [2019-11-13T23:43:37.279Z] === PAUSE TestBuildWithEmptyDockerfile/comment-only-dockerfile
23:43:37 [2019-11-13T23:43:37.279Z] === CONT  TestBuildWithEmptyDockerfile/empty-dockerfile
23:43:37 [2019-11-13T23:43:37.279Z] === CONT  TestBuildWithEmptyDockerfile/comment-only-dockerfile
23:43:37 [2019-11-13T23:43:37.279Z] === CONT  TestBuildWithEmptyDockerfile/empty-lines-dockerfile
23:43:37 [2019-11-13T23:43:37.279Z] --- PASS: TestBuildWithEmptyDockerfile (0.11s)
23:43:37 [2019-11-13T23:43:37.279Z]     --- PASS: TestBuildWithEmptyDockerfile/empty-dockerfile (0.15s)
23:43:37 [2019-11-13T23:43:37.279Z]     --- PASS: TestBuildWithEmptyDockerfile/comment-only-dockerfile (0.15s)
23:43:37 [2019-11-13T23:43:37.279Z]     --- PASS: TestBuildWithEmptyDockerfile/empty-lines-dockerfile (0.10s)
23:43:37 [2019-11-13T23:43:37.279Z] === RUN   TestBuildPreserveOwnership
23:43:37 [2019-11-13T23:43:37.279Z] === RUN   TestBuildPreserveOwnership/copy_from
23:43:37 [2019-11-13T23:43:37.652Z] === RUN   TestBuildPreserveOwnership/copy_from_chowned
23:43:40 [2019-11-13T23:43:40.171Z] --- PASS: TestBuildPreserveOwnership (5.97s)
23:43:40 [2019-11-13T23:43:40.171Z]     --- PASS: TestBuildPreserveOwnership/copy_from (3.85s)
23:43:40 [2019-11-13T23:43:40.171Z]     --- PASS: TestBuildPreserveOwnership/copy_from_chowned (2.10s)
23:43:40 [2019-11-13T23:43:40.171Z] === RUN   TestBuildPlatformInvalid
23:43:40 [2019-11-13T23:43:40.171Z] --- PASS: TestBuildPlatformInvalid (0.14s)
23:43:40 [2019-11-13T23:43:40.171Z] PASS
23:43:40 [2019-11-13T23:43:40.171Z] 
23:43:40 [2019-11-13T23:43:40.171Z] === Skipped
23:43:40 [2019-11-13T23:43:40.171Z] === SKIP: s390x.integration.build TestBuildWithSession (0.00s)
23:43:40 [2019-11-13T23:43:40.171Z]     build_session_test.go:25: TODO: BuildKit
23:43:40 [2019-11-13T23:43:40.171Z] 
23:43:40 [2019-11-13T23:43:40.171Z] 
23:43:40 [2019-11-13T23:43:40.171Z] DONE 32 tests, 1 skipped in 82.264s
23:43:40 [2019-11-13T23:43:40.171Z] Running /go/src/github.com/docker/docker/integration/config (s390x.integration.config) flags=-test.v -test.timeout=120m 
23:43:40 [2019-11-13T23:43:40.172Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-config-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-config-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.config -t ./test.main -test.v -test.timeout=120m
23:43:40 [2019-11-13T23:43:40.172Z] ++ set -e
23:43:40 [2019-11-13T23:43:40.172Z] ++ '[' -n 0 ']'
23:43:40 [2019-11-13T23:43:40.172Z] ++ set -x
23:43:40 [2019-11-13T23:43:40.172Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-config-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-config-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.config -t ./test.main -test.v -test.timeout=120m
23:43:40 [2019-11-13T23:43:40.573Z] INFO: Testing against a local daemon
23:43:40 [2019-11-13T23:43:40.573Z] === RUN   TestConfigList
23:43:43 [2019-11-13T23:43:43.764Z] --- PASS: TestConfigList (2.98s)
23:43:43 [2019-11-13T23:43:43.764Z] === RUN   TestConfigsCreateAndDelete
23:43:46 [2019-11-13T23:43:46.207Z] --- PASS: TestConfigsCreateAndDelete (2.52s)
23:43:46 [2019-11-13T23:43:46.207Z] === RUN   TestConfigsUpdate
23:43:49 [2019-11-13T23:43:49.413Z] --- PASS: TestConfigsUpdate (3.06s)
23:43:49 [2019-11-13T23:43:49.413Z] === RUN   TestTemplatedConfig
23:43:52 [2019-11-13T23:43:52.601Z] --- PASS: TestTemplatedConfig (3.16s)
23:43:52 [2019-11-13T23:43:52.601Z] === RUN   TestConfigInspect
23:43:55 [2019-11-13T23:43:55.050Z] --- PASS: TestConfigInspect (3.07s)
23:43:55 [2019-11-13T23:43:55.050Z] === RUN   TestConfigCreateWithLabels
23:43:58 [2019-11-13T23:43:58.334Z] --- PASS: TestConfigCreateWithLabels (3.00s)
23:43:58 [2019-11-13T23:43:58.334Z] === RUN   TestConfigCreateResolve
23:44:01 [2019-11-13T23:44:01.516Z] --- PASS: TestConfigCreateResolve (2.92s)
23:44:01 [2019-11-13T23:44:01.516Z] === RUN   TestConfigDaemonLibtrustID
23:44:01 [2019-11-13T23:44:01.516Z] --- PASS: TestConfigDaemonLibtrustID (0.54s)
23:44:01 [2019-11-13T23:44:01.516Z] PASS
23:44:01 [2019-11-13T23:44:01.516Z] 
23:44:01 [2019-11-13T23:44:01.516Z] DONE 8 tests in 21.432s
23:44:01 [2019-11-13T23:44:01.516Z] Running /go/src/github.com/docker/docker/integration/container (s390x.integration.container) flags=-test.v -test.timeout=120m 
23:44:01 [2019-11-13T23:44:01.516Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-container-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-container-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.container -t ./test.main -test.v -test.timeout=120m
23:44:01 [2019-11-13T23:44:01.516Z] ++ set -e
23:44:01 [2019-11-13T23:44:01.516Z] ++ '[' -n 0 ']'
23:44:01 [2019-11-13T23:44:01.516Z] ++ set -x
23:44:01 [2019-11-13T23:44:01.516Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-container-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-container-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.container -t ./test.main -test.v -test.timeout=120m
23:44:01 [2019-11-13T23:44:01.894Z] INFO: Testing against a local daemon
23:44:01 [2019-11-13T23:44:01.894Z] === RUN   TestCheckpoint
23:44:01 [2019-11-13T23:44:01.894Z] --- SKIP: TestCheckpoint (0.00s)
23:44:01 [2019-11-13T23:44:01.894Z]     checkpoint_test.go:33: TestCheckpoint is broken; see https://github.com/moby/moby/issues/38963
23:44:01 [2019-11-13T23:44:01.894Z] === RUN   TestContainerInvalidJSON
23:44:01 [2019-11-13T23:44:01.894Z] === RUN   TestContainerInvalidJSON//containers/foobar/copy
23:44:01 [2019-11-13T23:44:01.894Z] === PAUSE TestContainerInvalidJSON//containers/foobar/copy
23:44:01 [2019-11-13T23:44:01.894Z] === RUN   TestContainerInvalidJSON//containers/foobar/exec
23:44:01 [2019-11-13T23:44:01.894Z] === PAUSE TestContainerInvalidJSON//containers/foobar/exec
23:44:01 [2019-11-13T23:44:01.894Z] === RUN   TestContainerInvalidJSON//exec/foobar/start
23:44:01 [2019-11-13T23:44:01.894Z] === PAUSE TestContainerInvalidJSON//exec/foobar/start
23:44:01 [2019-11-13T23:44:01.894Z] === CONT  TestContainerInvalidJSON//containers/foobar/copy
23:44:01 [2019-11-13T23:44:01.894Z] === CONT  TestContainerInvalidJSON//exec/foobar/start
23:44:01 [2019-11-13T23:44:01.894Z] === CONT  TestContainerInvalidJSON//containers/foobar/exec
23:44:01 [2019-11-13T23:44:01.894Z] --- PASS: TestContainerInvalidJSON (0.01s)
23:44:01 [2019-11-13T23:44:01.894Z]     --- PASS: TestContainerInvalidJSON//containers/foobar/copy (0.00s)
23:44:01 [2019-11-13T23:44:01.894Z]     --- PASS: TestContainerInvalidJSON//exec/foobar/start (0.00s)
23:44:01 [2019-11-13T23:44:01.894Z]     --- PASS: TestContainerInvalidJSON//containers/foobar/exec (0.00s)
23:44:01 [2019-11-13T23:44:01.894Z] === RUN   TestCopyFromContainerPathDoesNotExist
23:44:01 [2019-11-13T23:44:01.894Z] --- PASS: TestCopyFromContainerPathDoesNotExist (0.14s)
23:44:01 [2019-11-13T23:44:01.894Z] === RUN   TestCopyFromContainerPathIsNotDir
23:44:02 [2019-11-13T23:44:02.278Z] --- PASS: TestCopyFromContainerPathIsNotDir (0.14s)
23:44:02 [2019-11-13T23:44:02.278Z] === RUN   TestCopyToContainerPathDoesNotExist
23:44:02 [2019-11-13T23:44:02.278Z] --- PASS: TestCopyToContainerPathDoesNotExist (0.11s)
23:44:02 [2019-11-13T23:44:02.278Z] === RUN   TestCopyToContainerPathIsNotDir
23:44:02 [2019-11-13T23:44:02.278Z] --- PASS: TestCopyToContainerPathIsNotDir (0.11s)
23:44:02 [2019-11-13T23:44:02.278Z] === RUN   TestCopyFromContainer
23:44:04 [2019-11-13T23:44:04.805Z] === RUN   TestCopyFromContainer//
23:44:04 [2019-11-13T23:44:04.805Z] === RUN   TestCopyFromContainer//bar/root
23:44:04 [2019-11-13T23:44:04.805Z] === RUN   TestCopyFromContainer//bar/root/
23:44:04 [2019-11-13T23:44:04.805Z] === RUN   TestCopyFromContainer/bar/quux
23:44:04 [2019-11-13T23:44:04.805Z] === RUN   TestCopyFromContainer/bar/quux/
23:44:04 [2019-11-13T23:44:04.805Z] === RUN   TestCopyFromContainer/bar/quux/baz
23:44:05 [2019-11-13T23:44:05.263Z] === RUN   TestCopyFromContainer/bar/filesymlink
23:44:05 [2019-11-13T23:44:05.263Z] === RUN   TestCopyFromContainer/bar/dirsymlink
23:44:05 [2019-11-13T23:44:05.263Z] === RUN   TestCopyFromContainer/bar/dirsymlink/
23:44:05 [2019-11-13T23:44:05.263Z] === RUN   TestCopyFromContainer/bar/notarget
23:44:05 [2019-11-13T23:44:05.263Z] --- PASS: TestCopyFromContainer (2.97s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCopyFromContainer// (0.10s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCopyFromContainer//bar/root (0.14s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCopyFromContainer//bar/root/ (0.06s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCopyFromContainer/bar/quux (0.13s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCopyFromContainer/bar/quux/ (0.10s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCopyFromContainer/bar/quux/baz (0.10s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCopyFromContainer/bar/filesymlink (0.09s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCopyFromContainer/bar/dirsymlink (0.09s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCopyFromContainer/bar/dirsymlink/ (0.09s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCopyFromContainer/bar/notarget (0.10s)
23:44:05 [2019-11-13T23:44:05.263Z] === RUN   TestCreateFailsWhenIdentifierDoesNotExist
23:44:05 [2019-11-13T23:44:05.263Z] === RUN   TestCreateFailsWhenIdentifierDoesNotExist/image_and_tag
23:44:05 [2019-11-13T23:44:05.263Z] === PAUSE TestCreateFailsWhenIdentifierDoesNotExist/image_and_tag
23:44:05 [2019-11-13T23:44:05.263Z] === RUN   TestCreateFailsWhenIdentifierDoesNotExist/image_no_tag
23:44:05 [2019-11-13T23:44:05.263Z] === PAUSE TestCreateFailsWhenIdentifierDoesNotExist/image_no_tag
23:44:05 [2019-11-13T23:44:05.263Z] === RUN   TestCreateFailsWhenIdentifierDoesNotExist/digest
23:44:05 [2019-11-13T23:44:05.263Z] === PAUSE TestCreateFailsWhenIdentifierDoesNotExist/digest
23:44:05 [2019-11-13T23:44:05.263Z] === CONT  TestCreateFailsWhenIdentifierDoesNotExist/image_and_tag
23:44:05 [2019-11-13T23:44:05.263Z] === CONT  TestCreateFailsWhenIdentifierDoesNotExist/digest
23:44:05 [2019-11-13T23:44:05.263Z] === CONT  TestCreateFailsWhenIdentifierDoesNotExist/image_no_tag
23:44:05 [2019-11-13T23:44:05.263Z] --- PASS: TestCreateFailsWhenIdentifierDoesNotExist (0.01s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCreateFailsWhenIdentifierDoesNotExist/digest (0.00s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCreateFailsWhenIdentifierDoesNotExist/image_no_tag (0.00s)
23:44:05 [2019-11-13T23:44:05.263Z]     --- PASS: TestCreateFailsWhenIdentifierDoesNotExist/image_and_tag (0.00s)
23:44:05 [2019-11-13T23:44:05.263Z] === RUN   TestCreateLinkToNonExistingContainer
23:44:05 [2019-11-13T23:44:05.263Z] --- PASS: TestCreateLinkToNonExistingContainer (0.04s)
23:44:05 [2019-11-13T23:44:05.263Z] === RUN   TestCreateWithInvalidEnv
23:44:05 [2019-11-13T23:44:05.264Z] === RUN   TestCreateWithInvalidEnv/0
23:44:05 [2019-11-13T23:44:05.264Z] === PAUSE TestCreateWithInvalidEnv/0
23:44:05 [2019-11-13T23:44:05.264Z] === RUN   TestCreateWithInvalidEnv/1
23:44:05 [2019-11-13T23:44:05.264Z] === PAUSE TestCreateWithInvalidEnv/1
23:44:05 [2019-11-13T23:44:05.264Z] === RUN   TestCreateWithInvalidEnv/2
23:44:05 [2019-11-13T23:44:05.264Z] === PAUSE TestCreateWithInvalidEnv/2
23:44:05 [2019-11-13T23:44:05.264Z] === CONT  TestCreateWithInvalidEnv/0
23:44:05 [2019-11-13T23:44:05.264Z] === CONT  TestCreateWithInvalidEnv/2
23:44:05 [2019-11-13T23:44:05.264Z] === CONT  TestCreateWithInvalidEnv/1
23:44:05 [2019-11-13T23:44:05.264Z] --- PASS: TestCreateWithInvalidEnv (0.01s)
23:44:05 [2019-11-13T23:44:05.264Z]     --- PASS: TestCreateWithInvalidEnv/0 (0.00s)
23:44:05 [2019-11-13T23:44:05.264Z]     --- PASS: TestCreateWithInvalidEnv/1 (0.00s)
23:44:05 [2019-11-13T23:44:05.264Z]     --- PASS: TestCreateWithInvalidEnv/2 (0.00s)
23:44:05 [2019-11-13T23:44:05.264Z] === RUN   TestCreateTmpfsMountsTarget
23:44:05 [2019-11-13T23:44:05.264Z] --- PASS: TestCreateTmpfsMountsTarget (0.02s)
23:44:05 [2019-11-13T23:44:05.264Z] === RUN   TestCreateWithCustomMaskedPaths
23:44:07 [2019-11-13T23:44:07.740Z] --- PASS: TestCreateWithCustomMaskedPaths (2.40s)
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/no_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/no_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/empty_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/empty_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/valid_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/valid_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/invalid_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/invalid_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/duplicate_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/duplicate_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/capabilities_API_v1.39
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/capabilities_API_v1.39
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/empty_capadd
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/empty_capadd
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/empty_capdrop
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/empty_capdrop
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/capadd_capdrop
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/capadd_capdrop
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/conflict_with_capadd
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/conflict_with_capadd
23:44:07 [2019-11-13T23:44:07.740Z] === RUN   TestCreateWithCapabilities/conflict_with_capdrop
23:44:07 [2019-11-13T23:44:07.740Z] === PAUSE TestCreateWithCapabilities/conflict_with_capdrop
23:44:07 [2019-11-13T23:44:07.740Z] === CONT  TestCreateWithCapabilities/no_capabilities
23:44:07 [2019-11-13T23:44:07.740Z] === CONT  TestCreateWithCapabilities/conflict_with_capdrop
23:44:07 [2019-11-13T23:44:07.740Z] === CONT  TestCreateWithCapabilities/conflict_with_capadd
23:44:07 [2019-11-13T23:44:07.740Z] === CONT  TestCreateWithCapabilities/capadd_capdrop
23:44:08 [2019-11-13T23:44:08.110Z] === CONT  TestCreateWithCapabilities/empty_capdrop
23:44:08 [2019-11-13T23:44:08.110Z] === CONT  TestCreateWithCapabilities/empty_capadd
23:44:08 [2019-11-13T23:44:08.110Z] === CONT  TestCreateWithCapabilities/capabilities_API_v1.39
23:44:08 [2019-11-13T23:44:08.110Z] === CONT  TestCreateWithCapabilities/duplicate_capabilities
23:44:08 [2019-11-13T23:44:08.110Z] === CONT  TestCreateWithCapabilities/invalid_capabilities
23:44:08 [2019-11-13T23:44:08.110Z] === CONT  TestCreateWithCapabilities/valid_capabilities
23:44:08 [2019-11-13T23:44:08.110Z] === CONT  TestCreateWithCapabilities/empty_capabilities
23:44:08 [2019-11-13T23:44:08.110Z] --- PASS: TestCreateWithCapabilities (0.02s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/conflict_with_capdrop (0.00s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/conflict_with_capadd (0.00s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/no_capabilities (0.07s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/capadd_capdrop (0.06s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/empty_capdrop (0.08s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/empty_capadd (0.08s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/duplicate_capabilities (0.06s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/capabilities_API_v1.39 (0.06s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/invalid_capabilities (0.00s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/valid_capabilities (0.09s)
23:44:08 [2019-11-13T23:44:08.110Z]     --- PASS: TestCreateWithCapabilities/empty_capabilities (0.09s)
23:44:08 [2019-11-13T23:44:08.110Z] === RUN   TestCreateWithCustomReadonlyPaths
23:44:10 [2019-11-13T23:44:10.605Z] --- PASS: TestCreateWithCustomReadonlyPaths (2.61s)
23:44:10 [2019-11-13T23:44:10.605Z] === RUN   TestCreateWithInvalidHealthcheckParams
23:44:11 [2019-11-13T23:44:11.216Z] === RUN   TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_less_than_0s
23:44:11 [2019-11-13T23:44:11.216Z] === PAUSE TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_less_than_0s
23:44:11 [2019-11-13T23:44:11.216Z] === RUN   TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_larger_than_0s_but_less_than_1ms
23:44:11 [2019-11-13T23:44:11.216Z] === PAUSE TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_larger_than_0s_but_less_than_1ms
23:44:11 [2019-11-13T23:44:11.216Z] === RUN   TestCreateWithInvalidHealthcheckParams/test_invalid_Timeout_in_Healthcheck:_less_than_1ms
23:44:11 [2019-11-13T23:44:11.216Z] === PAUSE TestCreateWithInvalidHealthcheckParams/test_invalid_Timeout_in_Healthcheck:_less_than_1ms
23:44:11 [2019-11-13T23:44:11.216Z] === RUN   TestCreateWithInvalidHealthcheckParams/test_invalid_Retries_in_Healthcheck:_less_than_0
23:44:11 [2019-11-13T23:44:11.216Z] === PAUSE TestCreateWithInvalidHealthcheckParams/test_invalid_Retries_in_Healthcheck:_less_than_0
23:44:11 [2019-11-13T23:44:11.216Z] === RUN   TestCreateWithInvalidHealthcheckParams/test_invalid_StartPeriod_in_Healthcheck:_not_0_and_less_than_1ms
23:44:11 [2019-11-13T23:44:11.216Z] === PAUSE TestCreateWithInvalidHealthcheckParams/test_invalid_StartPeriod_in_Healthcheck:_not_0_and_less_than_1ms
23:44:11 [2019-11-13T23:44:11.216Z] === CONT  TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_less_than_0s
23:44:11 [2019-11-13T23:44:11.216Z] === CONT  TestCreateWithInvalidHealthcheckParams/test_invalid_StartPeriod_in_Healthcheck:_not_0_and_less_than_1ms
23:44:11 [2019-11-13T23:44:11.216Z] === CONT  TestCreateWithInvalidHealthcheckParams/test_invalid_Retries_in_Healthcheck:_less_than_0
23:44:11 [2019-11-13T23:44:11.216Z] === CONT  TestCreateWithInvalidHealthcheckParams/test_invalid_Timeout_in_Healthcheck:_less_than_1ms
23:44:11 [2019-11-13T23:44:11.216Z] === CONT  TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_larger_than_0s_but_less_than_1ms
23:44:11 [2019-11-13T23:44:11.216Z] --- PASS: TestCreateWithInvalidHealthcheckParams (0.01s)
23:44:11 [2019-11-13T23:44:11.216Z]     --- PASS: TestCreateWithInvalidHealthcheckParams/test_invalid_StartPeriod_in_Healthcheck:_not_0_and_less_than_1ms (0.02s)
23:44:11 [2019-11-13T23:44:11.216Z]     --- PASS: TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_less_than_0s (0.02s)
23:44:11 [2019-11-13T23:44:11.216Z]     --- PASS: TestCreateWithInvalidHealthcheckParams/test_invalid_Timeout_in_Healthcheck:_less_than_1ms (0.00s)
23:44:11 [2019-11-13T23:44:11.216Z]     --- PASS: TestCreateWithInvalidHealthcheckParams/test_invalid_Retries_in_Healthcheck:_less_than_0 (0.01s)
23:44:11 [2019-11-13T23:44:11.216Z]     --- PASS: TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_larger_than_0s_but_less_than_1ms (0.02s)
23:44:11 [2019-11-13T23:44:11.216Z] === RUN   TestContainerStartOnDaemonRestart
23:44:11 [2019-11-13T23:44:11.216Z] === PAUSE TestContainerStartOnDaemonRestart
23:44:11 [2019-11-13T23:44:11.216Z] === RUN   TestDaemonRestartIpcMode
23:44:11 [2019-11-13T23:44:11.216Z] === PAUSE TestDaemonRestartIpcMode
23:44:11 [2019-11-13T23:44:11.216Z] === RUN   TestDiff
23:44:11 [2019-11-13T23:44:11.611Z] --- PASS: TestDiff (0.96s)
23:44:11 [2019-11-13T23:44:11.611Z] === RUN   TestExecWithCloseStdin
23:44:12 [2019-11-13T23:44:12.873Z] --- PASS: TestExecWithCloseStdin (1.13s)
23:44:12 [2019-11-13T23:44:12.873Z] === RUN   TestExec
23:44:14 [2019-11-13T23:44:14.131Z] --- PASS: TestExec (1.09s)
23:44:14 [2019-11-13T23:44:14.132Z] === RUN   TestExecUser
23:44:14 [2019-11-13T23:44:14.914Z] --- PASS: TestExecUser (1.09s)
23:44:14 [2019-11-13T23:44:14.914Z] === RUN   TestExportContainerAndImportImage
23:44:16 [2019-11-13T23:44:16.195Z] --- PASS: TestExportContainerAndImportImage (1.22s)
23:44:16 [2019-11-13T23:44:16.195Z] === RUN   TestExportContainerAfterDaemonRestart
23:44:18 [2019-11-13T23:44:18.022Z] --- PASS: TestExportContainerAfterDaemonRestart (1.49s)
23:44:18 [2019-11-13T23:44:18.022Z] === RUN   TestHealthCheckWorkdir
23:44:18 [2019-11-13T23:44:18.991Z] --- PASS: TestHealthCheckWorkdir (1.23s)
23:44:18 [2019-11-13T23:44:18.991Z] === RUN   TestHealthKillContainer
23:44:22 [2019-11-13T23:44:22.245Z] --- PASS: TestHealthKillContainer (3.16s)
23:44:22 [2019-11-13T23:44:22.245Z] === RUN   TestInspectCpusetInConfigPre120
23:44:23 [2019-11-13T23:44:23.043Z] --- PASS: TestInspectCpusetInConfigPre120 (0.91s)
23:44:23 [2019-11-13T23:44:23.043Z] === RUN   TestIpcModeNone
23:44:24 [2019-11-13T23:44:24.292Z] --- PASS: TestIpcModeNone (1.03s)
23:44:24 [2019-11-13T23:44:24.292Z] === RUN   TestIpcModePrivate
23:44:25 [2019-11-13T23:44:25.157Z] --- PASS: TestIpcModePrivate (1.15s)
23:44:25 [2019-11-13T23:44:25.157Z]     ipcmode_linux_test.go:90: [testIpcPrivateShareable] ipcmode: private, ipcdev: 0:64, shared: false, mustBeShared: false
23:44:25 [2019-11-13T23:44:25.157Z] === RUN   TestIpcModeShareable
23:44:26 [2019-11-13T23:44:26.468Z] --- PASS: TestIpcModeShareable (1.17s)
23:44:26 [2019-11-13T23:44:26.468Z]     ipcmode_linux_test.go:90: [testIpcPrivateShareable] ipcmode: shareable, ipcdev: 0:58, shared: true, mustBeShared: true
23:44:26 [2019-11-13T23:44:26.468Z] === RUN   TestAPIIpcModeShareableAndContainer
23:44:29 [2019-11-13T23:44:29.646Z] --- PASS: TestAPIIpcModeShareableAndContainer (2.88s)
23:44:29 [2019-11-13T23:44:29.646Z] === RUN   TestAPIIpcModeHost
23:44:30 [2019-11-13T23:44:30.019Z] --- PASS: TestAPIIpcModeHost (0.81s)
23:44:30 [2019-11-13T23:44:30.019Z] === RUN   TestDaemonIpcModeShareable
23:44:31 [2019-11-13T23:44:31.848Z] --- PASS: TestDaemonIpcModeShareable (1.80s)
23:44:31 [2019-11-13T23:44:31.848Z]     ipcmode_linux_test.go:258: [testDaemonIpcPrivateShareable] ipcdev: 0:66, shared: true, mustBeShared: true
23:44:31 [2019-11-13T23:44:31.848Z] === RUN   TestDaemonIpcModePrivate
23:44:33 [2019-11-13T23:44:33.766Z] --- PASS: TestDaemonIpcModePrivate (1.86s)
23:44:33 [2019-11-13T23:44:33.766Z]     ipcmode_linux_test.go:258: [testDaemonIpcPrivateShareable] ipcdev: 0:72, shared: false, mustBeShared: false
23:44:33 [2019-11-13T23:44:33.766Z] === RUN   TestDaemonIpcModePrivateFromConfig
23:44:35 [2019-11-13T23:44:35.572Z] --- PASS: TestDaemonIpcModePrivateFromConfig (1.81s)
23:44:35 [2019-11-13T23:44:35.572Z]     ipcmode_linux_test.go:258: [testDaemonIpcPrivateShareable] ipcdev: 0:72, shared: false, mustBeShared: false
23:44:35 [2019-11-13T23:44:35.572Z] === RUN   TestDaemonIpcModeShareableFromConfig
23:44:37 [2019-11-13T23:44:37.406Z] --- PASS: TestDaemonIpcModeShareableFromConfig (1.84s)
23:44:37 [2019-11-13T23:44:37.406Z]     ipcmode_linux_test.go:258: [testDaemonIpcPrivateShareable] ipcdev: 0:66, shared: true, mustBeShared: true
23:44:37 [2019-11-13T23:44:37.406Z] === RUN   TestIpcModeOlderClient
23:44:37 [2019-11-13T23:44:37.406Z] === PAUSE TestIpcModeOlderClient
23:44:37 [2019-11-13T23:44:37.406Z] === RUN   TestKillContainerInvalidSignal
23:44:38 [2019-11-13T23:44:38.183Z] --- PASS: TestKillContainerInvalidSignal (0.80s)
23:44:38 [2019-11-13T23:44:38.183Z] === RUN   TestKillContainer
23:44:38 [2019-11-13T23:44:38.183Z] === RUN   TestKillContainer/no_signal
23:44:39 [2019-11-13T23:44:39.178Z] === RUN   TestKillContainer/non_killing_signal
23:44:39 [2019-11-13T23:44:39.972Z] === RUN   TestKillContainer/killing_signal
23:44:41 [2019-11-13T23:44:41.235Z] --- PASS: TestKillContainer (2.69s)
23:44:41 [2019-11-13T23:44:41.235Z]     --- PASS: TestKillContainer/no_signal (0.95s)
23:44:41 [2019-11-13T23:44:41.235Z]     --- PASS: TestKillContainer/non_killing_signal (0.55s)
23:44:41 [2019-11-13T23:44:41.235Z]     --- PASS: TestKillContainer/killing_signal (0.79s)
23:44:41 [2019-11-13T23:44:41.235Z] === RUN   TestKillWithStopSignalAndRestartPolicies
23:44:41 [2019-11-13T23:44:41.235Z] === RUN   TestKillWithStopSignalAndRestartPolicies/same-signal-disables-restart-policy
23:44:41 [2019-11-13T23:44:41.601Z] === RUN   TestKillWithStopSignalAndRestartPolicies/different-signal-keep-restart-policy
23:44:42 [2019-11-13T23:44:42.866Z] --- PASS: TestKillWithStopSignalAndRestartPolicies (1.73s)
23:44:42 [2019-11-13T23:44:42.866Z]     --- PASS: TestKillWithStopSignalAndRestartPolicies/same-signal-disables-restart-policy (0.79s)
23:44:42 [2019-11-13T23:44:42.866Z]     --- PASS: TestKillWithStopSignalAndRestartPolicies/different-signal-keep-restart-policy (0.62s)
23:44:42 [2019-11-13T23:44:42.866Z] === RUN   TestKillStoppedContainer
23:44:42 [2019-11-13T23:44:42.866Z] --- PASS: TestKillStoppedContainer (0.08s)
23:44:42 [2019-11-13T23:44:42.866Z] === RUN   TestKillStoppedContainerAPIPre120
23:44:42 [2019-11-13T23:44:42.866Z] --- PASS: TestKillStoppedContainerAPIPre120 (0.11s)
23:44:42 [2019-11-13T23:44:42.866Z] === RUN   TestKillDifferentUserContainer
23:44:43 [2019-11-13T23:44:43.643Z] --- PASS: TestKillDifferentUserContainer (0.86s)
23:44:43 [2019-11-13T23:44:43.643Z] === RUN   TestInspectOomKilledTrue
23:44:43 [2019-11-13T23:44:43.643Z] --- SKIP: TestInspectOomKilledTrue (0.01s)
23:44:43 [2019-11-13T23:44:43.643Z]     kill_test.go:151: testEnv.DaemonInfo.OSType == "windows" || !testEnv.DaemonInfo.MemoryLimit || !testEnv.DaemonInfo.SwapLimit
23:44:43 [2019-11-13T23:44:43.643Z] === RUN   TestInspectOomKilledFalse
23:44:43 [2019-11-13T23:44:43.643Z] --- SKIP: TestInspectOomKilledFalse (0.00s)
23:44:43 [2019-11-13T23:44:43.643Z]     kill_test.go:169: testEnv.DaemonInfo.OSType == "windows" || !testEnv.DaemonInfo.MemoryLimit || !testEnv.DaemonInfo.SwapLimit
23:44:43 [2019-11-13T23:44:43.643Z] === RUN   TestLinksEtcHostsContentMatch
23:44:44 [2019-11-13T23:44:44.444Z] --- PASS: TestLinksEtcHostsContentMatch (0.66s)
23:44:44 [2019-11-13T23:44:44.444Z] === RUN   TestLinksContainerNames
23:44:46 [2019-11-13T23:44:46.322Z] --- PASS: TestLinksContainerNames (1.68s)
23:44:46 [2019-11-13T23:44:46.322Z] === RUN   TestLogsFollowTailEmpty
23:44:47 [2019-11-13T23:44:47.096Z] --- PASS: TestLogsFollowTailEmpty (0.95s)
23:44:47 [2019-11-13T23:44:47.096Z] === RUN   TestContainerNetworkMountsNoChown
23:44:47 [2019-11-13T23:44:47.910Z] --- PASS: TestContainerNetworkMountsNoChown (0.95s)
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/default
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/default
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/private
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/private
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rprivate
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rprivate
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/slave
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/slave
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rslave
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rslave
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/shared
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/shared
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rshared
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rshared
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/default
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/default/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/default/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/default/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/default/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/default/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/default/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/default/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/default/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/default/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/rshared
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rshared/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rshared/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rshared/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rshared/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rshared/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rshared/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rshared/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rshared/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/rshared/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/shared
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/shared/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/shared/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/shared/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/shared/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/shared/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/shared/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/shared/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/shared/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/rslave
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rslave/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rslave/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rslave/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rslave/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rslave/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rslave/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rslave/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rslave/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/slave
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/slave/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/slave/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/slave/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/slave/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/slave/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/slave/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/slave/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/slave/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/rprivate
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rprivate/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rprivate/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rprivate/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rprivate/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rprivate/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rprivate/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/rprivate/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/rprivate/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/private
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/private/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/private/bind_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/private/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/private/bind_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/private/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/private/mount_root
23:44:47 [2019-11-13T23:44:47.910Z] === RUN   TestMountDaemonRoot/private/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === PAUSE TestMountDaemonRoot/private/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/default/mount_subpath
23:44:47 [2019-11-13T23:44:47.910Z] === CONT  TestMountDaemonRoot/default/mount_root
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/default/bind_subpath
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/rshared/mount_subpath
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/rshared/mount_root
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/rshared/bind_subpath
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/shared/bind_root
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/rslave/bind_root
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/shared/mount_subpath
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/shared/mount_root
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/shared/bind_subpath
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/slave/bind_root
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/rslave/mount_subpath
23:44:48 [2019-11-13T23:44:48.283Z] === CONT  TestMountDaemonRoot/rslave/mount_root
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/rslave/bind_subpath
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/rprivate/bind_root
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/slave/mount_subpath
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/slave/mount_root
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/slave/bind_subpath
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/private/bind_root
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/rprivate/mount_subpath
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/rprivate/mount_root
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/rprivate/bind_subpath
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/private/mount_subpath
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/private/mount_root
23:44:48 [2019-11-13T23:44:48.668Z] === CONT  TestMountDaemonRoot/private/bind_subpath
23:44:48 [2019-11-13T23:44:48.668Z] --- PASS: TestMountDaemonRoot (0.02s)
23:44:48 [2019-11-13T23:44:48.668Z]     --- PASS: TestMountDaemonRoot/default (0.00s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/default/bind_root (0.07s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/default/mount_root (0.08s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/default/mount_subpath (0.08s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/default/bind_subpath (0.08s)
23:44:48 [2019-11-13T23:44:48.668Z]     --- PASS: TestMountDaemonRoot/rshared (0.00s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/rshared/bind_root (0.07s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/rshared/mount_subpath (0.08s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/rshared/mount_root (0.07s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/rshared/bind_subpath (0.07s)
23:44:48 [2019-11-13T23:44:48.668Z]     --- PASS: TestMountDaemonRoot/shared (0.00s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/shared/bind_root (0.03s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/shared/mount_subpath (0.03s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/shared/mount_root (0.05s)
23:44:48 [2019-11-13T23:44:48.668Z]         --- PASS: TestMountDaemonRoot/shared/bind_subpath (0.07s)
23:44:48 [2019-11-13T23:44:48.668Z]     --- PASS: TestMountDaemonRoot/rslave (0.00s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/rslave/bind_root (0.06s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/rslave/mount_subpath (0.07s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/rslave/mount_root (0.08s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/rslave/bind_subpath (0.06s)
23:44:48 [2019-11-13T23:44:48.669Z]     --- PASS: TestMountDaemonRoot/slave (0.00s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/slave/bind_root (0.04s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/slave/mount_subpath (0.04s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/slave/mount_root (0.04s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/slave/bind_subpath (0.04s)
23:44:48 [2019-11-13T23:44:48.669Z]     --- PASS: TestMountDaemonRoot/rprivate (0.00s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/rprivate/bind_root (0.04s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/rprivate/mount_subpath (0.05s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/rprivate/mount_root (0.04s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/rprivate/bind_subpath (0.03s)
23:44:48 [2019-11-13T23:44:48.669Z]     --- PASS: TestMountDaemonRoot/private (0.00s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/private/bind_root (0.03s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/private/mount_subpath (0.03s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/private/bind_subpath (0.03s)
23:44:48 [2019-11-13T23:44:48.669Z]         --- PASS: TestMountDaemonRoot/private/mount_root (0.04s)
23:44:48 [2019-11-13T23:44:48.669Z] === RUN   TestContainerBindMountNonRecursive
23:44:51 [2019-11-13T23:44:51.150Z] --- PASS: TestContainerBindMountNonRecursive (2.04s)
23:44:51 [2019-11-13T23:44:51.150Z] === RUN   TestNetworkNat
23:44:51 [2019-11-13T23:44:51.539Z] --- PASS: TestNetworkNat (0.78s)
23:44:51 [2019-11-13T23:44:51.540Z] === RUN   TestNetworkLocalhostTCPNat
23:44:52 [2019-11-13T23:44:52.414Z] --- PASS: TestNetworkLocalhostTCPNat (0.98s)
23:44:52 [2019-11-13T23:44:52.414Z] === RUN   TestNetworkLoopbackNat
23:44:53 [2019-11-13T23:44:53.697Z] --- PASS: TestNetworkLoopbackNat (1.24s)
23:44:53 [2019-11-13T23:44:53.697Z] === RUN   TestPause
23:44:54 [2019-11-13T23:44:54.944Z] --- PASS: TestPause (0.98s)
23:44:54 [2019-11-13T23:44:54.944Z] === RUN   TestPauseFailsOnWindowsServerContainers
23:44:54 [2019-11-13T23:44:54.944Z] --- SKIP: TestPauseFailsOnWindowsServerContainers (0.00s)
23:44:54 [2019-11-13T23:44:54.944Z]     pause_test.go:54: testEnv.DaemonInfo.OSType != "windows" || testEnv.DaemonInfo.Isolation != "process"
23:44:54 [2019-11-13T23:44:54.944Z] === RUN   TestPauseStopPausedContainer
23:44:55 [2019-11-13T23:44:55.739Z] --- PASS: TestPauseStopPausedContainer (0.98s)
23:44:55 [2019-11-13T23:44:55.739Z] === RUN   TestPsFilter
23:44:56 [2019-11-13T23:44:56.123Z] --- PASS: TestPsFilter (0.27s)
23:44:56 [2019-11-13T23:44:56.123Z] === RUN   TestRemoveContainerWithRemovedVolume
23:44:56 [2019-11-13T23:44:56.898Z] --- PASS: TestRemoveContainerWithRemovedVolume (0.83s)
23:44:56 [2019-11-13T23:44:56.898Z] === RUN   TestRemoveContainerWithVolume
23:44:57 [2019-11-13T23:44:57.692Z] --- PASS: TestRemoveContainerWithVolume (0.96s)
23:44:57 [2019-11-13T23:44:57.693Z] === RUN   TestRemoveContainerRunning
23:44:58 [2019-11-13T23:44:58.586Z] --- PASS: TestRemoveContainerRunning (0.86s)
23:44:58 [2019-11-13T23:44:58.586Z] === RUN   TestRemoveContainerForceRemoveRunning
23:44:59 [2019-11-13T23:44:59.854Z] --- PASS: TestRemoveContainerForceRemoveRunning (0.96s)
23:44:59 [2019-11-13T23:44:59.854Z] === RUN   TestRemoveInvalidContainer
23:44:59 [2019-11-13T23:44:59.854Z] --- PASS: TestRemoveInvalidContainer (0.01s)
23:44:59 [2019-11-13T23:44:59.854Z] === RUN   TestRenameLinkedContainer
23:45:03 [2019-11-13T23:45:03.034Z] --- PASS: TestRenameLinkedContainer (3.46s)
23:45:03 [2019-11-13T23:45:03.035Z] === RUN   TestRenameStoppedContainer
23:45:03 [2019-11-13T23:45:03.834Z] --- PASS: TestRenameStoppedContainer (0.86s)
23:45:03 [2019-11-13T23:45:03.834Z] === RUN   TestRenameRunningContainerAndReuse
23:45:05 [2019-11-13T23:45:05.705Z] --- PASS: TestRenameRunningContainerAndReuse (1.70s)
23:45:05 [2019-11-13T23:45:05.705Z] === RUN   TestRenameInvalidName
23:45:06 [2019-11-13T23:45:06.494Z] --- PASS: TestRenameInvalidName (1.01s)
23:45:06 [2019-11-13T23:45:06.494Z] === RUN   TestRenameAnonymousContainer
23:45:09 [2019-11-13T23:45:09.674Z] --- PASS: TestRenameAnonymousContainer (3.18s)
23:45:09 [2019-11-13T23:45:09.674Z] === RUN   TestRenameContainerWithSameName
23:45:10 [2019-11-13T23:45:10.922Z] --- PASS: TestRenameContainerWithSameName (0.85s)
23:45:10 [2019-11-13T23:45:10.923Z] === RUN   TestRenameContainerWithLinkedContainer
23:45:12 [2019-11-13T23:45:12.944Z] --- PASS: TestRenameContainerWithLinkedContainer (1.87s)
23:45:12 [2019-11-13T23:45:12.944Z] === RUN   TestResize
23:45:13 [2019-11-13T23:45:13.758Z] --- PASS: TestResize (1.03s)
23:45:13 [2019-11-13T23:45:13.758Z] === RUN   TestResizeWithInvalidSize
23:45:14 [2019-11-13T23:45:14.541Z] --- PASS: TestResizeWithInvalidSize (0.93s)
23:45:14 [2019-11-13T23:45:14.541Z] === RUN   TestResizeWhenContainerNotStarted
23:45:15 [2019-11-13T23:45:15.345Z] --- PASS: TestResizeWhenContainerNotStarted (0.88s)
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/stop-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/kill-daemon
23:45:15 [2019-11-13T23:45:15.345Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/kill-daemon
23:45:17 [2019-11-13T23:45:17.791Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/stop-daemon
23:45:18 [2019-11-13T23:45:18.596Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/kill-daemon
23:45:19 [2019-11-13T23:45:19.518Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/stop-daemon
23:45:19 [2019-11-13T23:45:19.936Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/kill-daemon
23:45:20 [2019-11-13T23:45:20.751Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/stop-daemon
23:45:21 [2019-11-13T23:45:21.539Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/stop-daemon
23:45:23 [2019-11-13T23:45:23.381Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/stop-daemon
23:45:23 [2019-11-13T23:45:23.765Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/kill-daemon
23:45:26 [2019-11-13T23:45:26.338Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/kill-daemon
23:45:26 [2019-11-13T23:45:26.338Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/stop-daemon
23:45:28 [2019-11-13T23:45:28.817Z] --- PASS: TestDaemonRestartKillContainers (0.00s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/kill-daemon (2.38s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/kill-daemon (3.08s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/stop-daemon (1.50s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/kill-daemon (1.57s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/stop-daemon (1.53s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/kill-daemon (1.41s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/stop-daemon (2.25s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/stop-daemon (2.23s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/kill-daemon (2.26s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/stop-daemon (3.05s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/kill-daemon (2.30s)
23:45:28 [2019-11-13T23:45:28.817Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/stop-daemon (2.41s)
23:45:28 [2019-11-13T23:45:28.817Z] === RUN   TestCgroupNamespacesRun
23:45:30 [2019-11-13T23:45:30.190Z] --- PASS: TestCgroupNamespacesRun (1.81s)
23:45:30 [2019-11-13T23:45:30.190Z] === RUN   TestCgroupNamespacesRunPrivileged
23:45:32 [2019-11-13T23:45:32.004Z] --- PASS: TestCgroupNamespacesRunPrivileged (1.69s)
23:45:32 [2019-11-13T23:45:32.004Z] === RUN   TestCgroupNamespacesRunDaemonHostMode
23:45:33 [2019-11-13T23:45:33.967Z] --- PASS: TestCgroupNamespacesRunDaemonHostMode (1.87s)
23:45:33 [2019-11-13T23:45:33.967Z] === RUN   TestCgroupNamespacesRunHostMode
23:45:35 [2019-11-13T23:45:35.783Z] --- PASS: TestCgroupNamespacesRunHostMode (1.87s)
23:45:35 [2019-11-13T23:45:35.783Z] === RUN   TestCgroupNamespacesRunPrivateMode
23:45:37 [2019-11-13T23:45:37.596Z] --- PASS: TestCgroupNamespacesRunPrivateMode (1.73s)
23:45:37 [2019-11-13T23:45:37.596Z] === RUN   TestCgroupNamespacesRunPrivilegedAndPrivate
23:45:38 [2019-11-13T23:45:38.379Z] --- PASS: TestCgroupNamespacesRunPrivilegedAndPrivate (0.86s)
23:45:38 [2019-11-13T23:45:38.379Z] === RUN   TestCgroupNamespacesRunInvalidMode
23:45:39 [2019-11-13T23:45:39.185Z] --- PASS: TestCgroupNamespacesRunInvalidMode (0.84s)
23:45:39 [2019-11-13T23:45:39.185Z] === RUN   TestCgroupNamespacesRunOlderClient
23:45:41 [2019-11-13T23:45:41.169Z] --- PASS: TestCgroupNamespacesRunOlderClient (1.88s)
23:45:41 [2019-11-13T23:45:41.169Z] === RUN   TestKernelTCPMemory
23:45:41 [2019-11-13T23:45:41.980Z] --- PASS: TestKernelTCPMemory (1.06s)
23:45:41 [2019-11-13T23:45:41.980Z] === RUN   TestNISDomainname
23:45:43 [2019-11-13T23:45:43.243Z] --- PASS: TestNISDomainname (1.23s)
23:45:43 [2019-11-13T23:45:43.243Z] === RUN   TestHostnameDnsResolution
23:45:44 [2019-11-13T23:45:44.512Z] --- PASS: TestHostnameDnsResolution (1.25s)
23:45:44 [2019-11-13T23:45:44.512Z] === RUN   TestStats
23:45:46 [2019-11-13T23:45:46.973Z] --- PASS: TestStats (2.45s)
23:45:46 [2019-11-13T23:45:46.973Z] === RUN   TestStopContainerWithTimeout
23:45:46 [2019-11-13T23:45:46.973Z] === RUN   TestStopContainerWithTimeout/0
23:45:46 [2019-11-13T23:45:46.973Z] === PAUSE TestStopContainerWithTimeout/0
23:45:46 [2019-11-13T23:45:46.973Z] === RUN   TestStopContainerWithTimeout/1
23:45:46 [2019-11-13T23:45:46.973Z] === PAUSE TestStopContainerWithTimeout/1
23:45:46 [2019-11-13T23:45:46.973Z] === RUN   TestStopContainerWithTimeout/3
23:45:46 [2019-11-13T23:45:46.973Z] === PAUSE TestStopContainerWithTimeout/3
23:45:46 [2019-11-13T23:45:46.973Z] === RUN   TestStopContainerWithTimeout/-1
23:45:46 [2019-11-13T23:45:46.974Z] === PAUSE TestStopContainerWithTimeout/-1
23:45:46 [2019-11-13T23:45:46.974Z] === CONT  TestStopContainerWithTimeout/0
23:45:46 [2019-11-13T23:45:46.974Z] === CONT  TestStopContainerWithTimeout/3
23:45:48 [2019-11-13T23:45:48.247Z] === CONT  TestStopContainerWithTimeout/-1
23:45:50 [2019-11-13T23:45:50.045Z] === CONT  TestStopContainerWithTimeout/1
23:45:51 [2019-11-13T23:45:51.849Z] --- PASS: TestStopContainerWithTimeout (0.06s)
23:45:51 [2019-11-13T23:45:51.849Z]     --- PASS: TestStopContainerWithTimeout/0 (1.00s)
23:45:51 [2019-11-13T23:45:51.849Z]     --- PASS: TestStopContainerWithTimeout/3 (2.90s)
23:45:51 [2019-11-13T23:45:51.849Z]     --- PASS: TestStopContainerWithTimeout/-1 (2.88s)
23:45:51 [2019-11-13T23:45:51.849Z]     --- PASS: TestStopContainerWithTimeout/1 (1.90s)
23:45:51 [2019-11-13T23:45:51.849Z] === RUN   TestDeleteDevicemapper
23:45:51 [2019-11-13T23:45:51.849Z] --- SKIP: TestDeleteDevicemapper (0.00s)
23:45:51 [2019-11-13T23:45:51.849Z]     stop_linux_test.go:74: testEnv.DaemonInfo.Driver != "devicemapper"
23:45:51 [2019-11-13T23:45:51.849Z] === RUN   TestStopContainerWithRestartPolicyAlways
23:45:55 [2019-11-13T23:45:55.954Z] --- PASS: TestStopContainerWithRestartPolicyAlways (3.59s)
23:45:55 [2019-11-13T23:45:55.954Z] === RUN   TestUpdateMemory
23:45:55 [2019-11-13T23:45:55.954Z] --- SKIP: TestUpdateMemory (0.01s)
23:45:55 [2019-11-13T23:45:55.954Z]     update_linux_test.go:23: !testEnv.DaemonInfo.SwapLimit
23:45:55 [2019-11-13T23:45:55.954Z] === RUN   TestUpdateCPUQuota
23:45:57 [2019-11-13T23:45:57.237Z] --- PASS: TestUpdateCPUQuota (1.78s)
23:45:57 [2019-11-13T23:45:57.237Z] === RUN   TestUpdatePidsLimit
23:45:57 [2019-11-13T23:45:57.237Z] === RUN   TestUpdatePidsLimit/update_from_none
23:45:57 [2019-11-13T23:45:57.603Z] === RUN   TestUpdatePidsLimit/no_change
23:45:57 [2019-11-13T23:45:57.964Z] === RUN   TestUpdatePidsLimit/update_lower
23:45:58 [2019-11-13T23:45:58.337Z] === RUN   TestUpdatePidsLimit/update_on_old_api_ignores_value
23:45:59 [2019-11-13T23:45:59.116Z] === RUN   TestUpdatePidsLimit/unset_limit_with_zero
23:45:59 [2019-11-13T23:45:59.497Z] === RUN   TestUpdatePidsLimit/unset_limit_with_minus_one
23:45:59 [2019-11-13T23:45:59.949Z] === RUN   TestUpdatePidsLimit/unset_limit_with_minus_two
23:46:01 [2019-11-13T23:46:01.446Z] --- PASS: TestUpdatePidsLimit (4.11s)
23:46:01 [2019-11-13T23:46:01.446Z]     --- PASS: TestUpdatePidsLimit/update_from_none (0.38s)
23:46:01 [2019-11-13T23:46:01.446Z]     --- PASS: TestUpdatePidsLimit/no_change (0.36s)
23:46:01 [2019-11-13T23:46:01.446Z]     --- PASS: TestUpdatePidsLimit/update_lower (0.44s)
23:46:01 [2019-11-13T23:46:01.446Z]     --- PASS: TestUpdatePidsLimit/update_on_old_api_ignores_value (0.43s)
23:46:01 [2019-11-13T23:46:01.446Z]     --- PASS: TestUpdatePidsLimit/unset_limit_with_zero (0.40s)
23:46:01 [2019-11-13T23:46:01.446Z]     --- PASS: TestUpdatePidsLimit/unset_limit_with_minus_one (0.47s)
23:46:01 [2019-11-13T23:46:01.446Z]     --- PASS: TestUpdatePidsLimit/unset_limit_with_minus_two (0.44s)
23:46:01 [2019-11-13T23:46:01.446Z] === RUN   TestUpdateRestartPolicy
23:46:14 [2019-11-13T23:46:14.967Z] --- PASS: TestUpdateRestartPolicy (12.82s)
23:46:14 [2019-11-13T23:46:14.968Z] === RUN   TestUpdateRestartWithAutoRemove
23:46:15 [2019-11-13T23:46:15.435Z] --- PASS: TestUpdateRestartWithAutoRemove (0.95s)
23:46:15 [2019-11-13T23:46:15.435Z] === RUN   TestWaitNonBlocked
23:46:15 [2019-11-13T23:46:15.435Z] === RUN   TestWaitNonBlocked/wait-nonblocking-exit-0
23:46:15 [2019-11-13T23:46:15.435Z] === PAUSE TestWaitNonBlocked/wait-nonblocking-exit-0
23:46:15 [2019-11-13T23:46:15.435Z] === RUN   TestWaitNonBlocked/wait-nonblocking-exit-random
23:46:15 [2019-11-13T23:46:15.435Z] === PAUSE TestWaitNonBlocked/wait-nonblocking-exit-random
23:46:15 [2019-11-13T23:46:15.435Z] === CONT  TestWaitNonBlocked/wait-nonblocking-exit-0
23:46:15 [2019-11-13T23:46:15.435Z] === CONT  TestWaitNonBlocked/wait-nonblocking-exit-random
23:46:16 [2019-11-13T23:46:16.290Z] --- PASS: TestWaitNonBlocked (0.02s)
23:46:16 [2019-11-13T23:46:16.290Z]     --- PASS: TestWaitNonBlocked/wait-nonblocking-exit-random (0.92s)
23:46:16 [2019-11-13T23:46:16.290Z]     --- PASS: TestWaitNonBlocked/wait-nonblocking-exit-0 (1.00s)
23:46:16 [2019-11-13T23:46:16.290Z] === RUN   TestWaitBlocked
23:46:16 [2019-11-13T23:46:16.290Z] === RUN   TestWaitBlocked/test-wait-blocked-exit-zero
23:46:16 [2019-11-13T23:46:16.290Z] === PAUSE TestWaitBlocked/test-wait-blocked-exit-zero
23:46:16 [2019-11-13T23:46:16.290Z] === RUN   TestWaitBlocked/test-wait-blocked-exit-random
23:46:16 [2019-11-13T23:46:16.290Z] === PAUSE TestWaitBlocked/test-wait-blocked-exit-random
23:46:16 [2019-11-13T23:46:16.290Z] === CONT  TestWaitBlocked/test-wait-blocked-exit-zero
23:46:16 [2019-11-13T23:46:16.290Z] === CONT  TestWaitBlocked/test-wait-blocked-exit-random
23:46:17 [2019-11-13T23:46:17.572Z] --- PASS: TestWaitBlocked (0.02s)
23:46:17 [2019-11-13T23:46:17.572Z]     --- PASS: TestWaitBlocked/test-wait-blocked-exit-random (1.02s)
23:46:17 [2019-11-13T23:46:17.572Z]     --- PASS: TestWaitBlocked/test-wait-blocked-exit-zero (1.14s)
23:46:17 [2019-11-13T23:46:17.572Z] === CONT  TestContainerStartOnDaemonRestart
23:46:17 [2019-11-13T23:46:17.572Z] === CONT  TestIpcModeOlderClient
23:46:17 [2019-11-13T23:46:17.572Z] --- PASS: TestIpcModeOlderClient (0.14s)
23:46:17 [2019-11-13T23:46:17.572Z] === CONT  TestDaemonRestartIpcMode
23:46:20 [2019-11-13T23:46:20.051Z] --- PASS: TestContainerStartOnDaemonRestart (2.85s)
23:46:21 [2019-11-13T23:46:21.894Z] --- PASS: TestDaemonRestartIpcMode (4.08s)
23:46:21 [2019-11-13T23:46:21.894Z] PASS
23:46:21 [2019-11-13T23:46:21.894Z] 
23:46:21 [2019-11-13T23:46:21.894Z] === Skipped
23:46:21 [2019-11-13T23:46:21.894Z] === SKIP: s390x.integration.container TestCheckpoint (0.00s)
23:46:21 [2019-11-13T23:46:21.894Z]     checkpoint_test.go:33: TestCheckpoint is broken; see https://github.com/moby/moby/issues/38963
23:46:21 [2019-11-13T23:46:21.894Z] 
23:46:21 [2019-11-13T23:46:21.894Z] === SKIP: s390x.integration.container TestInspectOomKilledTrue (0.01s)
23:46:21 [2019-11-13T23:46:21.894Z]     kill_test.go:151: testEnv.DaemonInfo.OSType == "windows" || !testEnv.DaemonInfo.MemoryLimit || !testEnv.DaemonInfo.SwapLimit
23:46:21 [2019-11-13T23:46:21.894Z] 
23:46:21 [2019-11-13T23:46:21.894Z] === SKIP: s390x.integration.container TestInspectOomKilledFalse (0.00s)
23:46:21 [2019-11-13T23:46:21.894Z]     kill_test.go:169: testEnv.DaemonInfo.OSType == "windows" || !testEnv.DaemonInfo.MemoryLimit || !testEnv.DaemonInfo.SwapLimit
23:46:21 [2019-11-13T23:46:21.894Z] 
23:46:21 [2019-11-13T23:46:21.894Z] === SKIP: s390x.integration.container TestPauseFailsOnWindowsServerContainers (0.00s)
23:46:21 [2019-11-13T23:46:21.894Z]     pause_test.go:54: testEnv.DaemonInfo.OSType != "windows" || testEnv.DaemonInfo.Isolation != "process"
23:46:21 [2019-11-13T23:46:21.894Z] 
23:46:21 [2019-11-13T23:46:21.894Z] === SKIP: s390x.integration.container TestDeleteDevicemapper (0.00s)
23:46:21 [2019-11-13T23:46:21.894Z]     stop_linux_test.go:74: testEnv.DaemonInfo.Driver != "devicemapper"
23:46:21 [2019-11-13T23:46:21.894Z] 
23:46:21 [2019-11-13T23:46:21.894Z] === SKIP: s390x.integration.container TestUpdateMemory (0.01s)
23:46:21 [2019-11-13T23:46:21.894Z]     update_linux_test.go:23: !testEnv.DaemonInfo.SwapLimit
23:46:21 [2019-11-13T23:46:21.894Z] 
23:46:21 [2019-11-13T23:46:21.894Z] 
23:46:21 [2019-11-13T23:46:21.894Z] DONE 197 tests, 6 skipped in 139.921s
23:46:21 [2019-11-13T23:46:21.894Z] Running /go/src/github.com/docker/docker/integration/image (s390x.integration.image) flags=-test.v -test.timeout=120m 
23:46:21 [2019-11-13T23:46:21.894Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-image-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-image-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.image -t ./test.main -test.v -test.timeout=120m
23:46:21 [2019-11-13T23:46:21.894Z] ++ set -e
23:46:21 [2019-11-13T23:46:21.894Z] ++ '[' -n 0 ']'
23:46:21 [2019-11-13T23:46:21.894Z] ++ set -x
23:46:21 [2019-11-13T23:46:21.894Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-image-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-image-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.image -t ./test.main -test.v -test.timeout=120m
23:46:21 [2019-11-13T23:46:21.894Z] INFO: Testing against a local daemon
23:46:21 [2019-11-13T23:46:21.894Z] === RUN   TestCommitInheritsEnv
23:46:22 [2019-11-13T23:46:22.729Z] --- PASS: TestCommitInheritsEnv (0.61s)
23:46:22 [2019-11-13T23:46:22.729Z] === RUN   TestImportExtremelyLargeImageWorks
23:46:22 [2019-11-13T23:46:22.729Z] === PAUSE TestImportExtremelyLargeImageWorks
23:46:22 [2019-11-13T23:46:22.729Z] === RUN   TestImagesFilterMultiReference
23:46:22 [2019-11-13T23:46:22.729Z] --- PASS: TestImagesFilterMultiReference (0.05s)
23:46:22 [2019-11-13T23:46:22.729Z] === RUN   TestImagePullPlatformInvalid
23:46:22 [2019-11-13T23:46:22.729Z] --- PASS: TestImagePullPlatformInvalid (0.02s)
23:46:22 [2019-11-13T23:46:22.729Z] === RUN   TestRemoveImageOrphaning
23:46:23 [2019-11-13T23:46:23.104Z] --- PASS: TestRemoveImageOrphaning (0.50s)
23:46:23 [2019-11-13T23:46:23.104Z] === RUN   TestRemoveImageGarbageCollector
23:46:23 [2019-11-13T23:46:23.104Z] --- SKIP: TestRemoveImageGarbageCollector (0.00s)
23:46:23 [2019-11-13T23:46:23.104Z]     remove_unix_test.go:36: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:46:23 [2019-11-13T23:46:23.104Z] === RUN   TestTagUnprefixedRepoByNameOrName
23:46:23 [2019-11-13T23:46:23.104Z] --- PASS: TestTagUnprefixedRepoByNameOrName (0.02s)
23:46:23 [2019-11-13T23:46:23.104Z] === RUN   TestTagInvalidReference
23:46:23 [2019-11-13T23:46:23.104Z] --- PASS: TestTagInvalidReference (0.01s)
23:46:23 [2019-11-13T23:46:23.104Z] === RUN   TestTagValidPrefixedRepo
23:46:23 [2019-11-13T23:46:23.104Z] --- PASS: TestTagValidPrefixedRepo (0.04s)
23:46:23 [2019-11-13T23:46:23.104Z] === RUN   TestTagExistedNameWithoutForce
23:46:23 [2019-11-13T23:46:23.104Z] --- PASS: TestTagExistedNameWithoutForce (0.03s)
23:46:23 [2019-11-13T23:46:23.104Z] === RUN   TestTagOfficialNames
23:46:23 [2019-11-13T23:46:23.104Z] --- PASS: TestTagOfficialNames (0.04s)
23:46:23 [2019-11-13T23:46:23.104Z] === RUN   TestTagMatchesDigest
23:46:23 [2019-11-13T23:46:23.104Z] --- PASS: TestTagMatchesDigest (0.01s)
23:46:23 [2019-11-13T23:46:23.104Z] === CONT  TestImportExtremelyLargeImageWorks
23:48:32 [2019-11-13T23:48:32.602Z] --- PASS: TestImportExtremelyLargeImageWorks (115.33s)
23:48:32 [2019-11-13T23:48:32.602Z] PASS
23:48:32 [2019-11-13T23:48:32.602Z] 
23:48:32 [2019-11-13T23:48:32.602Z] === Skipped
23:48:32 [2019-11-13T23:48:32.602Z] === SKIP: s390x.integration.image TestRemoveImageGarbageCollector (0.00s)
23:48:32 [2019-11-13T23:48:32.602Z]     remove_unix_test.go:36: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:48:32 [2019-11-13T23:48:32.602Z] 
23:48:32 [2019-11-13T23:48:32.602Z] 
23:48:32 [2019-11-13T23:48:32.602Z] DONE 12 tests, 1 skipped in 116.938s
23:48:32 [2019-11-13T23:48:32.602Z] Running /go/src/github.com/docker/docker/integration/network (s390x.integration.network) flags=-test.v -test.timeout=120m 
23:48:32 [2019-11-13T23:48:32.602Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.network -t ./test.main -test.v -test.timeout=120m
23:48:32 [2019-11-13T23:48:32.602Z] ++ set -e
23:48:32 [2019-11-13T23:48:32.602Z] ++ '[' -n 0 ']'
23:48:32 [2019-11-13T23:48:32.602Z] ++ set -x
23:48:32 [2019-11-13T23:48:32.602Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.network -t ./test.main -test.v -test.timeout=120m
23:48:32 [2019-11-13T23:48:32.602Z] INFO: Testing against a local daemon
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestNetworkCreateDelete
23:48:32 [2019-11-13T23:48:32.602Z] --- PASS: TestNetworkCreateDelete (0.14s)
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestDockerNetworkDeletePreferID
23:48:32 [2019-11-13T23:48:32.602Z] --- PASS: TestDockerNetworkDeletePreferID (0.36s)
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestInspectNetwork
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestInspectNetwork/full_network_id
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestInspectNetwork/partial_network_id
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestInspectNetwork/network_name
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestInspectNetwork/network_name_and_swarm_scope
23:48:32 [2019-11-13T23:48:32.602Z] --- PASS: TestInspectNetwork (8.57s)
23:48:32 [2019-11-13T23:48:32.602Z]     --- PASS: TestInspectNetwork/full_network_id (0.01s)
23:48:32 [2019-11-13T23:48:32.602Z]     --- PASS: TestInspectNetwork/partial_network_id (0.00s)
23:48:32 [2019-11-13T23:48:32.602Z]     --- PASS: TestInspectNetwork/network_name (0.00s)
23:48:32 [2019-11-13T23:48:32.602Z]     --- PASS: TestInspectNetwork/network_name_and_swarm_scope (0.00s)
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestRunContainerWithBridgeNone
23:48:32 [2019-11-13T23:48:32.602Z] --- PASS: TestRunContainerWithBridgeNone (2.59s)
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestNetworkInvalidJSON
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestNetworkInvalidJSON//networks/create
23:48:32 [2019-11-13T23:48:32.602Z] === PAUSE TestNetworkInvalidJSON//networks/create
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestNetworkInvalidJSON//networks/bridge/connect
23:48:32 [2019-11-13T23:48:32.602Z] === PAUSE TestNetworkInvalidJSON//networks/bridge/connect
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestNetworkInvalidJSON//networks/bridge/disconnect
23:48:32 [2019-11-13T23:48:32.602Z] === PAUSE TestNetworkInvalidJSON//networks/bridge/disconnect
23:48:32 [2019-11-13T23:48:32.602Z] === CONT  TestNetworkInvalidJSON//networks/create
23:48:32 [2019-11-13T23:48:32.602Z] === CONT  TestNetworkInvalidJSON//networks/bridge/disconnect
23:48:32 [2019-11-13T23:48:32.602Z] === CONT  TestNetworkInvalidJSON//networks/bridge/connect
23:48:32 [2019-11-13T23:48:32.602Z] --- PASS: TestNetworkInvalidJSON (0.02s)
23:48:32 [2019-11-13T23:48:32.602Z]     --- PASS: TestNetworkInvalidJSON//networks/create (0.00s)
23:48:32 [2019-11-13T23:48:32.602Z]     --- PASS: TestNetworkInvalidJSON//networks/bridge/disconnect (0.00s)
23:48:32 [2019-11-13T23:48:32.602Z]     --- PASS: TestNetworkInvalidJSON//networks/bridge/connect (0.00s)
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestDaemonRestartWithLiveRestore
23:48:32 [2019-11-13T23:48:32.602Z] --- PASS: TestDaemonRestartWithLiveRestore (1.04s)
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestDaemonDefaultNetworkPools
23:48:32 [2019-11-13T23:48:32.602Z] --- PASS: TestDaemonDefaultNetworkPools (0.75s)
23:48:32 [2019-11-13T23:48:32.602Z] === RUN   TestDaemonRestartWithExistingNetwork
23:48:33 [2019-11-13T23:48:33.390Z] --- PASS: TestDaemonRestartWithExistingNetwork (1.16s)
23:48:33 [2019-11-13T23:48:33.390Z] === RUN   TestDaemonRestartWithExistingNetworkWithDefaultPoolRange
23:48:34 [2019-11-13T23:48:34.662Z] --- PASS: TestDaemonRestartWithExistingNetworkWithDefaultPoolRange (1.23s)
23:48:34 [2019-11-13T23:48:34.662Z] === RUN   TestDaemonWithBipAndDefaultNetworkPool
23:48:35 [2019-11-13T23:48:35.445Z] --- PASS: TestDaemonWithBipAndDefaultNetworkPool (0.60s)
23:48:35 [2019-11-13T23:48:35.445Z] === RUN   TestServiceWithPredefinedNetwork
23:48:38 [2019-11-13T23:48:38.625Z] --- PASS: TestServiceWithPredefinedNetwork (3.03s)
23:48:38 [2019-11-13T23:48:38.625Z] === RUN   TestServiceRemoveKeepsIngressNetwork
23:48:38 [2019-11-13T23:48:38.625Z] --- SKIP: TestServiceRemoveKeepsIngressNetwork (0.00s)
23:48:38 [2019-11-13T23:48:38.625Z]     service_test.go:230: FLAKY_TEST
23:48:38 [2019-11-13T23:48:38.625Z] === RUN   TestServiceWithDataPathPortInit
23:48:55 [2019-11-13T23:48:55.097Z] --- PASS: TestServiceWithDataPathPortInit (16.46s)
23:48:55 [2019-11-13T23:48:55.097Z] === RUN   TestServiceWithDefaultAddressPoolInit
23:49:04 [2019-11-13T23:49:04.519Z] --- PASS: TestServiceWithDefaultAddressPoolInit (8.54s)
23:49:04 [2019-11-13T23:49:04.519Z]     service_test.go:418: TestServiceWithDefaultAddressPoolInit: NetworkInspect: {Name:sthiraTestServiceWithDefaultAddressPoolInit ID:dwz8p6j7u40ax37aaqxnkqh9b Created:2019-11-13 23:48:56.168412918 +0000 UTC Scope:swarm Driver:overlay EnableIPv6:false IPAM:{Driver:default Options:map[] Config:[{Subnet:20.20.0.0/24 IPRange: Gateway:20.20.0.1 AuxAddress:map[]}]} Internal:false Attachable:false Ingress:false ConfigFrom:{Network:} ConfigOnly:false Containers:map[087d770e04e41c3cc97cd4bb69d50a6f375cf6139a36c8e62a9a1b742a07b604:{Name:TestServiceTestServiceWithDefaultAddressPoolInit.1.lkbdqk507vnhfwz6a09n90ir1 EndpointID:1509bb17fd1b62dd2637aeb3e9a5976ae964f91b90988138a109be66d044a8d0 MacAddress:02:42:14:14:00:03 IPv4Address:20.20.0.3/24 IPv6Address:} lb-sthiraTestServiceWithDefaultAddressPoolInit:{Name:sthiraTestServiceWithDefaultAddressPoolInit-endpoint EndpointID:aa15e183f7b498e56ec4aa8709aa1d573a69c2fd87993b3883eb65d3586ed6f2 MacAddress:02:42:14:14:00:04 IPv4Address:20.20.0.4/24 IPv6Address:}] Options:map[com.docker.network.driver.overlay.vxlanid_list:4097] Labels:map[] Peers:[{Name:26d7d0d35ae5 IP:127.0.0.1}] Services:map[TestServiceTestServiceWithDefaultAddressPoolInit:{VIP:20.20.0.2 Ports:[] LocalLBIndex:256 Tasks:[{Name:TestServiceTestServiceWithDefaultAddressPoolInit.1.lkbdqk507vnhfwz6a09n90ir1 EndpointID:1509bb17fd1b62dd2637aeb3e9a5976ae964f91b90988138a109be66d044a8d0 EndpointIP:20.20.0.3 Info:map[Host IP:127.0.0.1]}]}]}
23:49:04 [2019-11-13T23:49:04.519Z] PASS
23:49:04 [2019-11-13T23:49:04.519Z] 
23:49:04 [2019-11-13T23:49:04.519Z] === Skipped
23:49:04 [2019-11-13T23:49:04.519Z] === SKIP: s390x.integration.network TestServiceRemoveKeepsIngressNetwork (0.00s)
23:49:04 [2019-11-13T23:49:04.519Z]     service_test.go:230: FLAKY_TEST
23:49:04 [2019-11-13T23:49:04.519Z] 
23:49:04 [2019-11-13T23:49:04.519Z] 
23:49:04 [2019-11-13T23:49:04.519Z] DONE 21 tests, 1 skipped in 44.703s
23:49:04 [2019-11-13T23:49:04.519Z] Running /go/src/github.com/docker/docker/integration/network/ipvlan (s390x.integration.network.ipvlan) flags=-test.v -test.timeout=120m 
23:49:04 [2019-11-13T23:49:04.519Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-ipvlan-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-ipvlan-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.network.ipvlan -t ./test.main -test.v -test.timeout=120m
23:49:04 [2019-11-13T23:49:04.519Z] ++ set -e
23:49:04 [2019-11-13T23:49:04.519Z] ++ '[' -n 0 ']'
23:49:04 [2019-11-13T23:49:04.519Z] ++ set -x
23:49:04 [2019-11-13T23:49:04.519Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-ipvlan-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-ipvlan-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.network.ipvlan -t ./test.main -test.v -test.timeout=120m
23:49:04 [2019-11-13T23:49:04.519Z] INFO: Testing against a local daemon
23:49:04 [2019-11-13T23:49:04.519Z] === RUN   TestDockerNetworkIpvlanPersistance
23:49:04 [2019-11-13T23:49:04.519Z] --- SKIP: TestDockerNetworkIpvlanPersistance (0.01s)
23:49:04 [2019-11-13T23:49:04.519Z]     ipvlan_test.go:26: !ipvlanKernelSupport(t): Kernel doesn't support ipvlan
23:49:04 [2019-11-13T23:49:04.519Z] === RUN   TestDockerNetworkIpvlan
23:49:04 [2019-11-13T23:49:04.519Z] --- SKIP: TestDockerNetworkIpvlan (0.00s)
23:49:04 [2019-11-13T23:49:04.519Z]     ipvlan_test.go:53: !ipvlanKernelSupport(t): Kernel doesn't support ipvlan
23:49:04 [2019-11-13T23:49:04.519Z] PASS
23:49:04 [2019-11-13T23:49:04.519Z] 
23:49:04 [2019-11-13T23:49:04.519Z] === Skipped
23:49:04 [2019-11-13T23:49:04.519Z] === SKIP: s390x.integration.network.ipvlan TestDockerNetworkIpvlanPersistance (0.01s)
23:49:04 [2019-11-13T23:49:04.519Z]     ipvlan_test.go:26: !ipvlanKernelSupport(t): Kernel doesn't support ipvlan
23:49:04 [2019-11-13T23:49:04.519Z] 
23:49:04 [2019-11-13T23:49:04.519Z] === SKIP: s390x.integration.network.ipvlan TestDockerNetworkIpvlan (0.00s)
23:49:04 [2019-11-13T23:49:04.519Z]     ipvlan_test.go:53: !ipvlanKernelSupport(t): Kernel doesn't support ipvlan
23:49:04 [2019-11-13T23:49:04.519Z] 
23:49:04 [2019-11-13T23:49:04.519Z] 
23:49:04 [2019-11-13T23:49:04.519Z] DONE 2 tests, 2 skipped in 0.227s
23:49:04 [2019-11-13T23:49:04.519Z] Running /go/src/github.com/docker/docker/integration/network/macvlan (s390x.integration.network.macvlan) flags=-test.v -test.timeout=120m 
23:49:04 [2019-11-13T23:49:04.519Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-macvlan-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-macvlan-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.network.macvlan -t ./test.main -test.v -test.timeout=120m
23:49:04 [2019-11-13T23:49:04.519Z] ++ set -e
23:49:04 [2019-11-13T23:49:04.519Z] ++ '[' -n 0 ']'
23:49:04 [2019-11-13T23:49:04.519Z] ++ set -x
23:49:04 [2019-11-13T23:49:04.519Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-macvlan-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-network-macvlan-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.network.macvlan -t ./test.main -test.v -test.timeout=120m
23:49:04 [2019-11-13T23:49:04.519Z] INFO: Testing against a local daemon
23:49:04 [2019-11-13T23:49:04.519Z] === RUN   TestDockerNetworkMacvlanPersistance
23:49:05 [2019-11-13T23:49:05.301Z] --- PASS: TestDockerNetworkMacvlanPersistance (1.43s)
23:49:05 [2019-11-13T23:49:05.301Z] === RUN   TestDockerNetworkMacvlan
23:49:06 [2019-11-13T23:49:06.085Z] === RUN   TestDockerNetworkMacvlan/Subinterface
23:49:06 [2019-11-13T23:49:06.969Z] === RUN   TestDockerNetworkMacvlan/OverlapParent
23:49:07 [2019-11-13T23:49:07.869Z] === RUN   TestDockerNetworkMacvlan/NilParent
23:49:10 [2019-11-13T23:49:10.298Z] === RUN   TestDockerNetworkMacvlan/InternalMode
23:49:14 [2019-11-13T23:49:14.313Z] === RUN   TestDockerNetworkMacvlan/MultiSubnet
23:49:19 [2019-11-13T23:49:19.662Z] === RUN   TestDockerNetworkMacvlan/Addressing
23:49:20 [2019-11-13T23:49:20.472Z] --- PASS: TestDockerNetworkMacvlan (15.26s)
23:49:20 [2019-11-13T23:49:20.473Z]     --- PASS: TestDockerNetworkMacvlan/Subinterface (0.07s)
23:49:20 [2019-11-13T23:49:20.473Z]     --- PASS: TestDockerNetworkMacvlan/OverlapParent (0.09s)
23:49:20 [2019-11-13T23:49:20.473Z]     --- PASS: TestDockerNetworkMacvlan/NilParent (1.26s)
23:49:20 [2019-11-13T23:49:20.473Z]     --- PASS: TestDockerNetworkMacvlan/InternalMode (2.28s)
23:49:20 [2019-11-13T23:49:20.473Z]     --- PASS: TestDockerNetworkMacvlan/MultiSubnet (3.31s)
23:49:20 [2019-11-13T23:49:20.473Z]     --- PASS: TestDockerNetworkMacvlan/Addressing (0.90s)
23:49:20 [2019-11-13T23:49:20.473Z] PASS
23:49:20 [2019-11-13T23:49:20.473Z] 
23:49:20 [2019-11-13T23:49:20.473Z] DONE 8 tests in 16.834s
23:49:20 [2019-11-13T23:49:20.473Z] Running /go/src/github.com/docker/docker/integration/plugin (s390x.integration.plugin) flags=-test.v -test.timeout=120m 
23:49:20 [2019-11-13T23:49:20.473Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin -t ./test.main -test.v -test.timeout=120m
23:49:20 [2019-11-13T23:49:20.473Z] ++ set -e
23:49:20 [2019-11-13T23:49:20.473Z] ++ '[' -n 0 ']'
23:49:20 [2019-11-13T23:49:20.473Z] ++ set -x
23:49:20 [2019-11-13T23:49:20.473Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin -t ./test.main -test.v -test.timeout=120m
23:49:20 [2019-11-13T23:49:20.473Z] testing: warning: no tests to run
23:49:20 [2019-11-13T23:49:20.473Z] PASS
23:49:20 [2019-11-13T23:49:20.473Z] 
23:49:20 [2019-11-13T23:49:20.473Z] DONE 0 tests in 0.059s
23:49:20 [2019-11-13T23:49:20.473Z] Running /go/src/github.com/docker/docker/integration/plugin/authz (s390x.integration.plugin.authz) flags=-test.v -test.timeout=120m 
23:49:20 [2019-11-13T23:49:20.473Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-authz-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-authz-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin.authz -t ./test.main -test.v -test.timeout=120m
23:49:20 [2019-11-13T23:49:20.473Z] ++ set -e
23:49:20 [2019-11-13T23:49:20.473Z] ++ '[' -n 0 ']'
23:49:20 [2019-11-13T23:49:20.473Z] ++ set -x
23:49:20 [2019-11-13T23:49:20.473Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-authz-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-authz-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin.authz -t ./test.main -test.v -test.timeout=120m
23:49:20 [2019-11-13T23:49:20.473Z] INFO: Testing against a local daemon
23:49:20 [2019-11-13T23:49:20.473Z] === RUN   TestAuthZPluginAllowRequest
23:49:22 [2019-11-13T23:49:22.285Z] --- PASS: TestAuthZPluginAllowRequest (1.62s)
23:49:22 [2019-11-13T23:49:22.285Z] === RUN   TestAuthZPluginTLS
23:49:22 [2019-11-13T23:49:22.657Z] --- PASS: TestAuthZPluginTLS (0.57s)
23:49:22 [2019-11-13T23:49:22.657Z] === RUN   TestAuthZPluginDenyRequest
23:49:23 [2019-11-13T23:49:23.561Z] --- PASS: TestAuthZPluginDenyRequest (0.53s)
23:49:23 [2019-11-13T23:49:23.561Z] === RUN   TestAuthZPluginAPIDenyResponse
23:49:23 [2019-11-13T23:49:23.953Z] --- PASS: TestAuthZPluginAPIDenyResponse (0.54s)
23:49:23 [2019-11-13T23:49:23.953Z] === RUN   TestAuthZPluginDenyResponse
23:49:24 [2019-11-13T23:49:24.318Z] --- PASS: TestAuthZPluginDenyResponse (0.53s)
23:49:24 [2019-11-13T23:49:24.318Z] === RUN   TestAuthZPluginAllowEventStream
23:49:26 [2019-11-13T23:49:26.136Z] --- PASS: TestAuthZPluginAllowEventStream (1.65s)
23:49:26 [2019-11-13T23:49:26.136Z] === RUN   TestAuthZPluginErrorResponse
23:49:26 [2019-11-13T23:49:26.516Z] --- PASS: TestAuthZPluginErrorResponse (0.55s)
23:49:26 [2019-11-13T23:49:26.516Z] === RUN   TestAuthZPluginErrorRequest
23:49:27 [2019-11-13T23:49:27.288Z] --- PASS: TestAuthZPluginErrorRequest (0.54s)
23:49:27 [2019-11-13T23:49:27.288Z] === RUN   TestAuthZPluginEnsureNoDuplicatePluginRegistration
23:49:27 [2019-11-13T23:49:27.660Z] --- PASS: TestAuthZPluginEnsureNoDuplicatePluginRegistration (0.54s)
23:49:27 [2019-11-13T23:49:27.660Z] === RUN   TestAuthZPluginEnsureLoadImportWorking
23:49:30 [2019-11-13T23:49:30.154Z] --- PASS: TestAuthZPluginEnsureLoadImportWorking (2.15s)
23:49:30 [2019-11-13T23:49:30.154Z] === RUN   TestAuthzPluginEnsureContainerCopyToFrom
23:49:31 [2019-11-13T23:49:31.997Z] --- PASS: TestAuthzPluginEnsureContainerCopyToFrom (2.12s)
23:49:31 [2019-11-13T23:49:31.997Z] === RUN   TestAuthZPluginHeader
23:49:32 [2019-11-13T23:49:32.809Z] --- PASS: TestAuthZPluginHeader (0.90s)
23:49:32 [2019-11-13T23:49:32.810Z] === RUN   TestAuthZPluginV2AllowNonVolumeRequest
23:49:32 [2019-11-13T23:49:32.810Z] --- SKIP: TestAuthZPluginV2AllowNonVolumeRequest (0.00s)
23:49:32 [2019-11-13T23:49:32.810Z]     authz_plugin_v2_test.go:43: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:49:32 [2019-11-13T23:49:32.810Z] === RUN   TestAuthZPluginV2Disable
23:49:32 [2019-11-13T23:49:32.810Z] --- SKIP: TestAuthZPluginV2Disable (0.00s)
23:49:32 [2019-11-13T23:49:32.810Z]     authz_plugin_v2_test.go:65: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:49:32 [2019-11-13T23:49:32.810Z] === RUN   TestAuthZPluginV2RejectVolumeRequests
23:49:32 [2019-11-13T23:49:32.810Z] --- SKIP: TestAuthZPluginV2RejectVolumeRequests (0.00s)
23:49:32 [2019-11-13T23:49:32.810Z]     authz_plugin_v2_test.go:91: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:49:32 [2019-11-13T23:49:32.810Z] === RUN   TestAuthZPluginV2BadManifestFailsDaemonStart
23:49:32 [2019-11-13T23:49:32.810Z] --- SKIP: TestAuthZPluginV2BadManifestFailsDaemonStart (0.00s)
23:49:32 [2019-11-13T23:49:32.810Z]     authz_plugin_v2_test.go:126: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:49:32 [2019-11-13T23:49:32.810Z] === RUN   TestAuthZPluginV2NonexistentFailsDaemonStart
23:49:52 [2019-11-13T23:49:52.516Z] --- PASS: TestAuthZPluginV2NonexistentFailsDaemonStart (16.86s)
23:49:52 [2019-11-13T23:49:52.516Z] PASS
23:49:52 [2019-11-13T23:49:52.516Z] 
23:49:52 [2019-11-13T23:49:52.516Z] === Skipped
23:49:52 [2019-11-13T23:49:52.516Z] === SKIP: s390x.integration.plugin.authz TestAuthZPluginV2AllowNonVolumeRequest (0.00s)
23:49:52 [2019-11-13T23:49:52.516Z]     authz_plugin_v2_test.go:43: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:49:52 [2019-11-13T23:49:52.516Z] 
23:49:52 [2019-11-13T23:49:52.516Z] === SKIP: s390x.integration.plugin.authz TestAuthZPluginV2Disable (0.00s)
23:49:52 [2019-11-13T23:49:52.516Z]     authz_plugin_v2_test.go:65: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:49:52 [2019-11-13T23:49:52.516Z] 
23:49:52 [2019-11-13T23:49:52.516Z] === SKIP: s390x.integration.plugin.authz TestAuthZPluginV2RejectVolumeRequests (0.00s)
23:49:52 [2019-11-13T23:49:52.516Z]     authz_plugin_v2_test.go:91: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:49:52 [2019-11-13T23:49:52.516Z] 
23:49:52 [2019-11-13T23:49:52.516Z] === SKIP: s390x.integration.plugin.authz TestAuthZPluginV2BadManifestFailsDaemonStart (0.00s)
23:49:52 [2019-11-13T23:49:52.516Z]     authz_plugin_v2_test.go:126: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:49:52 [2019-11-13T23:49:52.516Z] 
23:49:52 [2019-11-13T23:49:52.516Z] 
23:49:52 [2019-11-13T23:49:52.516Z] DONE 17 tests, 4 skipped in 29.298s
23:49:52 [2019-11-13T23:49:52.516Z] Running /go/src/github.com/docker/docker/integration/plugin/common (s390x.integration.plugin.common) flags=-test.v -test.timeout=120m 
23:49:52 [2019-11-13T23:49:52.516Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-common-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-common-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin.common -t ./test.main -test.v -test.timeout=120m
23:49:52 [2019-11-13T23:49:52.516Z] ++ set -e
23:49:52 [2019-11-13T23:49:52.516Z] ++ '[' -n 0 ']'
23:49:52 [2019-11-13T23:49:52.516Z] ++ set -x
23:49:52 [2019-11-13T23:49:52.516Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-common-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-common-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin.common -t ./test.main -test.v -test.timeout=120m
23:49:52 [2019-11-13T23:49:52.516Z] INFO: Testing against a local daemon
23:49:52 [2019-11-13T23:49:52.516Z] === RUN   TestPluginInvalidJSON
23:49:52 [2019-11-13T23:49:52.516Z] === RUN   TestPluginInvalidJSON//plugins/foobar/set
23:49:52 [2019-11-13T23:49:52.516Z] === PAUSE TestPluginInvalidJSON//plugins/foobar/set
23:49:52 [2019-11-13T23:49:52.516Z] === CONT  TestPluginInvalidJSON//plugins/foobar/set
23:49:52 [2019-11-13T23:49:52.516Z] --- PASS: TestPluginInvalidJSON (0.03s)
23:49:52 [2019-11-13T23:49:52.516Z]     --- PASS: TestPluginInvalidJSON//plugins/foobar/set (0.00s)
23:49:52 [2019-11-13T23:49:52.516Z] PASS
23:49:52 [2019-11-13T23:49:52.516Z] 
23:49:52 [2019-11-13T23:49:52.516Z] DONE 2 tests in 0.177s
23:49:52 [2019-11-13T23:49:52.516Z] Running /go/src/github.com/docker/docker/integration/plugin/graphdriver (s390x.integration.plugin.graphdriver) flags=-test.v -test.timeout=120m 
23:49:52 [2019-11-13T23:49:52.516Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-graphdriver-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-graphdriver-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin.graphdriver -t ./test.main -test.v -test.timeout=120m
23:49:52 [2019-11-13T23:49:52.516Z] ++ set -e
23:49:52 [2019-11-13T23:49:52.516Z] ++ '[' -n 0 ']'
23:49:52 [2019-11-13T23:49:52.516Z] ++ set -x
23:49:52 [2019-11-13T23:49:52.516Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-graphdriver-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-graphdriver-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin.graphdriver -t ./test.main -test.v -test.timeout=120m
23:49:52 [2019-11-13T23:49:52.516Z] INFO: Testing against a local daemon
23:49:52 [2019-11-13T23:49:52.516Z] === RUN   TestExternalGraphDriver
23:49:52 [2019-11-13T23:49:52.516Z] === RUN   TestExternalGraphDriver/json
23:49:52 [2019-11-13T23:49:52.516Z] === RUN   TestExternalGraphDriver/spec
23:49:54 [2019-11-13T23:49:54.358Z] === RUN   TestExternalGraphDriver/pull
23:49:56 [2019-11-13T23:49:56.996Z] --- PASS: TestExternalGraphDriver (6.44s)
23:49:56 [2019-11-13T23:49:56.996Z]     --- PASS: TestExternalGraphDriver/json (2.01s)
23:49:56 [2019-11-13T23:49:56.996Z]     --- PASS: TestExternalGraphDriver/spec (2.07s)
23:49:56 [2019-11-13T23:49:56.996Z]     --- PASS: TestExternalGraphDriver/pull (2.16s)
23:49:56 [2019-11-13T23:49:56.996Z] === RUN   TestGraphdriverPluginV2
23:49:56 [2019-11-13T23:49:56.996Z] --- SKIP: TestGraphdriverPluginV2 (0.06s)
23:49:56 [2019-11-13T23:49:56.996Z]     external_test.go:410: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:49:56 [2019-11-13T23:49:56.996Z] PASS
23:49:56 [2019-11-13T23:49:56.996Z] 
23:49:56 [2019-11-13T23:49:56.996Z] === Skipped
23:49:56 [2019-11-13T23:49:56.996Z] === SKIP: s390x.integration.plugin.graphdriver TestGraphdriverPluginV2 (0.06s)
23:49:56 [2019-11-13T23:49:56.996Z]     external_test.go:410: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:49:56 [2019-11-13T23:49:56.996Z] 
23:49:56 [2019-11-13T23:49:56.996Z] 
23:49:56 [2019-11-13T23:49:56.996Z] DONE 5 tests, 1 skipped in 6.635s
23:49:56 [2019-11-13T23:49:56.996Z] Running /go/src/github.com/docker/docker/integration/plugin/logging (s390x.integration.plugin.logging) flags=-test.v -test.timeout=120m 
23:49:56 [2019-11-13T23:49:56.996Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-logging-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-logging-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin.logging -t ./test.main -test.v -test.timeout=120m
23:49:56 [2019-11-13T23:49:56.996Z] ++ set -e
23:49:56 [2019-11-13T23:49:56.996Z] ++ '[' -n 0 ']'
23:49:56 [2019-11-13T23:49:56.996Z] ++ set -x
23:49:56 [2019-11-13T23:49:56.996Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-logging-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-logging-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin.logging -t ./test.main -test.v -test.timeout=120m
23:49:56 [2019-11-13T23:49:56.996Z] INFO: Testing against a local daemon
23:49:56 [2019-11-13T23:49:56.996Z] === RUN   TestContinueAfterPluginCrash
23:49:56 [2019-11-13T23:49:56.996Z] === PAUSE TestContinueAfterPluginCrash
23:49:56 [2019-11-13T23:49:56.996Z] === RUN   TestDaemonStartWithLogOpt
23:49:56 [2019-11-13T23:49:56.996Z] === PAUSE TestDaemonStartWithLogOpt
23:49:56 [2019-11-13T23:49:56.996Z] === CONT  TestContinueAfterPluginCrash
23:49:56 [2019-11-13T23:49:56.996Z] === CONT  TestDaemonStartWithLogOpt
23:50:08 [2019-11-13T23:50:08.430Z] --- PASS: TestDaemonStartWithLogOpt (10.83s)
23:50:12 [2019-11-13T23:50:12.573Z] --- PASS: TestContinueAfterPluginCrash (15.79s)
23:50:12 [2019-11-13T23:50:12.573Z] PASS
23:50:12 [2019-11-13T23:50:12.573Z] 
23:50:12 [2019-11-13T23:50:12.573Z] DONE 2 tests in 15.954s
23:50:12 [2019-11-13T23:50:12.573Z] Running /go/src/github.com/docker/docker/integration/plugin/volumes (s390x.integration.plugin.volumes) flags=-test.v -test.timeout=120m 
23:50:12 [2019-11-13T23:50:12.573Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-volumes-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-volumes-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin.volumes -t ./test.main -test.v -test.timeout=120m
23:50:12 [2019-11-13T23:50:12.573Z] ++ set -e
23:50:12 [2019-11-13T23:50:12.573Z] ++ '[' -n 0 ']'
23:50:12 [2019-11-13T23:50:12.573Z] ++ set -x
23:50:12 [2019-11-13T23:50:12.573Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-volumes-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-plugin-volumes-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.plugin.volumes -t ./test.main -test.v -test.timeout=120m
23:50:12 [2019-11-13T23:50:12.938Z] INFO: Testing against a local daemon
23:50:12 [2019-11-13T23:50:12.938Z] === RUN   TestPluginWithDevMounts
23:50:12 [2019-11-13T23:50:12.938Z] === PAUSE TestPluginWithDevMounts
23:50:12 [2019-11-13T23:50:12.938Z] === CONT  TestPluginWithDevMounts
23:50:14 [2019-11-13T23:50:14.748Z] --- PASS: TestPluginWithDevMounts (1.94s)
23:50:14 [2019-11-13T23:50:14.748Z] PASS
23:50:14 [2019-11-13T23:50:14.748Z] 
23:50:14 [2019-11-13T23:50:14.748Z] DONE 1 tests in 2.153s
23:50:14 [2019-11-13T23:50:14.748Z] Running /go/src/github.com/docker/docker/integration/secret (s390x.integration.secret) flags=-test.v -test.timeout=120m 
23:50:14 [2019-11-13T23:50:14.748Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-secret-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-secret-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.secret -t ./test.main -test.v -test.timeout=120m
23:50:14 [2019-11-13T23:50:14.748Z] ++ set -e
23:50:14 [2019-11-13T23:50:14.748Z] ++ '[' -n 0 ']'
23:50:14 [2019-11-13T23:50:14.748Z] ++ set -x
23:50:14 [2019-11-13T23:50:14.748Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-secret-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-secret-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.secret -t ./test.main -test.v -test.timeout=120m
23:50:14 [2019-11-13T23:50:14.748Z] INFO: Testing against a local daemon
23:50:14 [2019-11-13T23:50:14.748Z] === RUN   TestSecretInspect
23:50:18 [2019-11-13T23:50:18.042Z] --- PASS: TestSecretInspect (2.78s)
23:50:18 [2019-11-13T23:50:18.042Z] === RUN   TestSecretList
23:50:20 [2019-11-13T23:50:20.581Z] --- PASS: TestSecretList (2.96s)
23:50:20 [2019-11-13T23:50:20.581Z] === RUN   TestSecretsCreateAndDelete
23:50:23 [2019-11-13T23:50:23.805Z] --- PASS: TestSecretsCreateAndDelete (2.76s)
23:50:23 [2019-11-13T23:50:23.805Z] === RUN   TestSecretsUpdate
23:50:26 [2019-11-13T23:50:26.380Z] --- PASS: TestSecretsUpdate (2.86s)
23:50:26 [2019-11-13T23:50:26.380Z] === RUN   TestTemplatedSecret
23:50:29 [2019-11-13T23:50:29.627Z] --- PASS: TestTemplatedSecret (2.97s)
23:50:29 [2019-11-13T23:50:29.627Z] === RUN   TestSecretCreateResolve
23:50:32 [2019-11-13T23:50:32.095Z] --- PASS: TestSecretCreateResolve (2.92s)
23:50:32 [2019-11-13T23:50:32.095Z] PASS
23:50:32 [2019-11-13T23:50:32.096Z] 
23:50:32 [2019-11-13T23:50:32.096Z] DONE 6 tests in 17.351s
23:50:32 [2019-11-13T23:50:32.096Z] Running /go/src/github.com/docker/docker/integration/service (s390x.integration.service) flags=-test.v -test.timeout=120m 
23:50:32 [2019-11-13T23:50:32.096Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-service-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-service-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.service -t ./test.main -test.v -test.timeout=120m
23:50:32 [2019-11-13T23:50:32.096Z] ++ set -e
23:50:32 [2019-11-13T23:50:32.096Z] ++ '[' -n 0 ']'
23:50:32 [2019-11-13T23:50:32.096Z] ++ set -x
23:50:32 [2019-11-13T23:50:32.096Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-service-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-service-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.service -t ./test.main -test.v -test.timeout=120m
23:50:32 [2019-11-13T23:50:32.096Z] INFO: Testing against a local daemon
23:50:32 [2019-11-13T23:50:32.096Z] === RUN   TestServiceCreateInit
23:50:32 [2019-11-13T23:50:32.096Z] === RUN   TestServiceCreateInit/daemonInitDisabled
23:50:37 [2019-11-13T23:50:37.314Z] === RUN   TestServiceCreateInit/daemonInitEnabled
23:50:42 [2019-11-13T23:50:42.335Z] --- PASS: TestServiceCreateInit (9.89s)
23:50:42 [2019-11-13T23:50:42.335Z]     --- PASS: TestServiceCreateInit/daemonInitDisabled (5.04s)
23:50:42 [2019-11-13T23:50:42.335Z]     --- PASS: TestServiceCreateInit/daemonInitEnabled (4.84s)
23:50:42 [2019-11-13T23:50:42.335Z] === RUN   TestCreateServiceMultipleTimes
23:51:02 [2019-11-13T23:51:02.117Z] --- PASS: TestCreateServiceMultipleTimes (17.71s)
23:51:02 [2019-11-13T23:51:02.117Z] === RUN   TestCreateServiceConflict
23:51:02 [2019-11-13T23:51:02.885Z] --- PASS: TestCreateServiceConflict (2.92s)
23:51:02 [2019-11-13T23:51:02.885Z] === RUN   TestCreateServiceMaxReplicas
23:51:06 [2019-11-13T23:51:06.287Z] --- PASS: TestCreateServiceMaxReplicas (3.59s)
23:51:06 [2019-11-13T23:51:06.287Z] === RUN   TestCreateWithDuplicateNetworkNames
23:51:22 [2019-11-13T23:51:22.603Z] --- PASS: TestCreateWithDuplicateNetworkNames (14.79s)
23:51:22 [2019-11-13T23:51:22.603Z] === RUN   TestCreateServiceSecretFileMode
23:51:23 [2019-11-13T23:51:23.990Z] --- PASS: TestCreateServiceSecretFileMode (2.83s)
23:51:23 [2019-11-13T23:51:23.990Z] === RUN   TestCreateServiceConfigFileMode
23:51:27 [2019-11-13T23:51:27.175Z] --- PASS: TestCreateServiceConfigFileMode (3.28s)
23:51:27 [2019-11-13T23:51:27.175Z] === RUN   TestCreateServiceSysctls
23:51:31 [2019-11-13T23:51:31.393Z] --- PASS: TestCreateServiceSysctls (4.24s)
23:51:31 [2019-11-13T23:51:31.393Z] === RUN   TestCreateServiceCapabilities
23:51:34 [2019-11-13T23:51:34.569Z] --- PASS: TestCreateServiceCapabilities (3.02s)
23:51:34 [2019-11-13T23:51:34.569Z] === RUN   TestInspect
23:51:38 [2019-11-13T23:51:38.727Z] --- PASS: TestInspect (3.74s)
23:51:38 [2019-11-13T23:51:38.727Z] === RUN   TestServiceListWithStatuses
23:51:38 [2019-11-13T23:51:38.727Z] --- SKIP: TestServiceListWithStatuses (0.00s)
23:51:38 [2019-11-13T23:51:38.727Z]     list_test.go:34: versions.LessThan(testEnv.DaemonInfo.ServerVersion, "1.41")
23:51:38 [2019-11-13T23:51:38.727Z] === RUN   TestDockerNetworkConnectAlias
23:51:43 [2019-11-13T23:51:43.802Z] --- PASS: TestDockerNetworkConnectAlias (5.50s)
23:51:43 [2019-11-13T23:51:43.802Z] === RUN   TestDockerNetworkReConnect
23:51:48 [2019-11-13T23:51:48.969Z] --- PASS: TestDockerNetworkReConnect (4.80s)
23:51:48 [2019-11-13T23:51:48.969Z] === RUN   TestServicePlugin
23:51:48 [2019-11-13T23:51:48.969Z] --- SKIP: TestServicePlugin (0.00s)
23:51:48 [2019-11-13T23:51:48.969Z]     plugin_test.go:28: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:51:48 [2019-11-13T23:51:48.969Z] === RUN   TestServiceUpdateLabel
23:51:51 [2019-11-13T23:51:51.377Z] --- PASS: TestServiceUpdateLabel (2.90s)
23:51:51 [2019-11-13T23:51:51.377Z] === RUN   TestServiceUpdateSecrets
23:52:07 [2019-11-13T23:52:07.691Z] --- PASS: TestServiceUpdateSecrets (15.69s)
23:52:07 [2019-11-13T23:52:07.691Z] === RUN   TestServiceUpdateConfigs
23:52:24 [2019-11-13T23:52:24.048Z] --- PASS: TestServiceUpdateConfigs (15.66s)
23:52:24 [2019-11-13T23:52:24.048Z] === RUN   TestServiceUpdateNetwork
23:52:40 [2019-11-13T23:52:40.486Z] --- PASS: TestServiceUpdateNetwork (15.35s)
23:52:40 [2019-11-13T23:52:40.486Z] PASS
23:52:40 [2019-11-13T23:52:40.486Z] 
23:52:40 [2019-11-13T23:52:40.486Z] === Skipped
23:52:40 [2019-11-13T23:52:40.486Z] === SKIP: s390x.integration.service TestServiceListWithStatuses (0.00s)
23:52:40 [2019-11-13T23:52:40.486Z]     list_test.go:34: versions.LessThan(testEnv.DaemonInfo.ServerVersion, "1.41")
23:52:40 [2019-11-13T23:52:40.486Z] 
23:52:40 [2019-11-13T23:52:40.486Z] === SKIP: s390x.integration.service TestServicePlugin (0.00s)
23:52:40 [2019-11-13T23:52:40.486Z]     plugin_test.go:28: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
23:52:40 [2019-11-13T23:52:40.486Z] 
23:52:40 [2019-11-13T23:52:40.486Z] 
23:52:40 [2019-11-13T23:52:40.486Z] DONE 20 tests, 2 skipped in 126.050s
23:52:40 [2019-11-13T23:52:40.486Z] Running /go/src/github.com/docker/docker/integration/session (s390x.integration.session) flags=-test.v -test.timeout=120m 
23:52:40 [2019-11-13T23:52:40.486Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-session-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-session-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.session -t ./test.main -test.v -test.timeout=120m
23:52:40 [2019-11-13T23:52:40.486Z] ++ set -e
23:52:40 [2019-11-13T23:52:40.486Z] ++ '[' -n 0 ']'
23:52:40 [2019-11-13T23:52:40.486Z] ++ set -x
23:52:40 [2019-11-13T23:52:40.486Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-session-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-session-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.session -t ./test.main -test.v -test.timeout=120m
23:52:40 [2019-11-13T23:52:40.486Z] INFO: Testing against a local daemon
23:52:40 [2019-11-13T23:52:40.486Z] === RUN   TestSessionCreate
23:52:40 [2019-11-13T23:52:40.486Z] --- PASS: TestSessionCreate (0.03s)
23:52:40 [2019-11-13T23:52:40.486Z] === RUN   TestSessionCreateWithBadUpgrade
23:52:40 [2019-11-13T23:52:40.486Z] --- PASS: TestSessionCreateWithBadUpgrade (0.03s)
23:52:40 [2019-11-13T23:52:40.486Z] PASS
23:52:40 [2019-11-13T23:52:40.486Z] 
23:52:40 [2019-11-13T23:52:40.486Z] DONE 2 tests in 0.244s
23:52:40 [2019-11-13T23:52:40.486Z] Running /go/src/github.com/docker/docker/integration/system (s390x.integration.system) flags=-test.v -test.timeout=120m 
23:52:40 [2019-11-13T23:52:40.486Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-system-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-system-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.system -t ./test.main -test.v -test.timeout=120m
23:52:40 [2019-11-13T23:52:40.486Z] ++ set -e
23:52:40 [2019-11-13T23:52:40.486Z] ++ '[' -n 0 ']'
23:52:40 [2019-11-13T23:52:40.486Z] ++ set -x
23:52:40 [2019-11-13T23:52:40.486Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-system-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-system-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.system -t ./test.main -test.v -test.timeout=120m
23:52:40 [2019-11-13T23:52:40.486Z] INFO: Testing against a local daemon
23:52:40 [2019-11-13T23:52:40.486Z] === RUN   TestCgroupDriverSystemdMemoryLimit
23:52:40 [2019-11-13T23:52:40.486Z] --- SKIP: TestCgroupDriverSystemdMemoryLimit (0.00s)
23:52:40 [2019-11-13T23:52:40.486Z]     cgroupdriver_systemd_test.go:32: !hasSystemd()
23:52:40 [2019-11-13T23:52:40.486Z] === RUN   TestEventsExecDie
23:52:40 [2019-11-13T23:52:40.486Z] --- PASS: TestEventsExecDie (0.96s)
23:52:40 [2019-11-13T23:52:40.486Z] === RUN   TestEventsBackwardsCompatible
23:52:40 [2019-11-13T23:52:40.486Z] --- PASS: TestEventsBackwardsCompatible (0.09s)
23:52:40 [2019-11-13T23:52:40.486Z] === RUN   TestInfoBinaryCommits
23:52:40 [2019-11-13T23:52:40.486Z] --- PASS: TestInfoBinaryCommits (0.02s)
23:52:40 [2019-11-13T23:52:40.486Z] === RUN   TestInfoAPIVersioned
23:52:40 [2019-11-13T23:52:40.486Z] --- PASS: TestInfoAPIVersioned (0.01s)
23:52:40 [2019-11-13T23:52:40.486Z] === RUN   TestInfoDiscoveryBackend
23:52:40 [2019-11-13T23:52:40.486Z] --- PASS: TestInfoDiscoveryBackend (0.52s)
23:52:40 [2019-11-13T23:52:40.486Z] === RUN   TestInfoDiscoveryInvalidAdvertise
23:52:41 [2019-11-13T23:52:41.261Z] --- PASS: TestInfoDiscoveryInvalidAdvertise (1.00s)
23:52:41 [2019-11-13T23:52:41.261Z] === RUN   TestInfoDiscoveryAdvertiseInterfaceName
23:52:41 [2019-11-13T23:52:41.631Z] --- PASS: TestInfoDiscoveryAdvertiseInterfaceName (0.52s)
23:52:41 [2019-11-13T23:52:41.631Z] === RUN   TestInfoAPI
23:52:41 [2019-11-13T23:52:41.631Z] --- PASS: TestInfoAPI (0.02s)
23:52:41 [2019-11-13T23:52:41.631Z] === RUN   TestInfoAPIWarnings
23:52:42 [2019-11-13T23:52:42.405Z] --- PASS: TestInfoAPIWarnings (0.52s)
23:52:42 [2019-11-13T23:52:42.405Z] === RUN   TestInfoDebug
23:52:42 [2019-11-13T23:52:42.771Z] --- PASS: TestInfoDebug (0.53s)
23:52:42 [2019-11-13T23:52:42.771Z] === RUN   TestInfoInsecureRegistries
23:52:43 [2019-11-13T23:52:43.154Z] --- PASS: TestInfoInsecureRegistries (0.53s)
23:52:43 [2019-11-13T23:52:43.154Z] === RUN   TestInfoRegistryMirrors
23:52:43 [2019-11-13T23:52:43.937Z] --- PASS: TestInfoRegistryMirrors (0.52s)
23:52:43 [2019-11-13T23:52:43.937Z] === RUN   TestLoginFailsWithBadCredentials
23:52:44 [2019-11-13T23:52:44.308Z] --- PASS: TestLoginFailsWithBadCredentials (0.40s)
23:52:44 [2019-11-13T23:52:44.308Z] === RUN   TestPingCacheHeaders
23:52:44 [2019-11-13T23:52:44.308Z] --- PASS: TestPingCacheHeaders (0.02s)
23:52:44 [2019-11-13T23:52:44.308Z] === RUN   TestPingGet
23:52:44 [2019-11-13T23:52:44.308Z] --- PASS: TestPingGet (0.01s)
23:52:44 [2019-11-13T23:52:44.308Z] === RUN   TestPingHead
23:52:44 [2019-11-13T23:52:44.308Z] --- PASS: TestPingHead (0.02s)
23:52:44 [2019-11-13T23:52:44.308Z] === RUN   TestVersion
23:52:44 [2019-11-13T23:52:44.308Z] --- PASS: TestVersion (0.03s)
23:52:44 [2019-11-13T23:52:44.308Z] PASS
23:52:44 [2019-11-13T23:52:44.308Z] 
23:52:44 [2019-11-13T23:52:44.308Z] === Skipped
23:52:44 [2019-11-13T23:52:44.308Z] === SKIP: s390x.integration.system TestCgroupDriverSystemdMemoryLimit (0.00s)
23:52:44 [2019-11-13T23:52:44.308Z]     cgroupdriver_systemd_test.go:32: !hasSystemd()
23:52:44 [2019-11-13T23:52:44.308Z] 
23:52:44 [2019-11-13T23:52:44.308Z] 
23:52:44 [2019-11-13T23:52:44.308Z] DONE 18 tests, 1 skipped in 5.894s
23:52:44 [2019-11-13T23:52:44.308Z] Running /go/src/github.com/docker/docker/integration/volume (s390x.integration.volume) flags=-test.v -test.timeout=120m 
23:52:44 [2019-11-13T23:52:44.308Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-volume-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-volume-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.volume -t ./test.main -test.v -test.timeout=120m
23:52:44 [2019-11-13T23:52:44.308Z] ++ set -e
23:52:44 [2019-11-13T23:52:44.308Z] ++ '[' -n 0 ']'
23:52:44 [2019-11-13T23:52:44.308Z] ++ set -x
23:52:44 [2019-11-13T23:52:44.308Z] ++ env -i DEST=/go/src/github.com/docker/docker/bundles/test-integration DOCKER_API_VERSION= DOCKER_BUILDKIT= DOCKER_INTEGRATION_DAEMON_DEST= DOCKER_TLS_VERIFY= DOCKER_CERT_PATH= DOCKER_ENGINE_GOARCH=s390x DOCKER_GRAPHDRIVER=overlay2 DOCKER_USERLANDPROXY=true DOCKER_HOST=unix:///go/src/github.com/docker/docker/bundles/test-integration/docker.sock DOCKER_REMAP_ROOT= DOCKER_REMOTE_DAEMON= DOCKERFILE=Dockerfile GOPATH=/go GOTRACEBACK=all HOME=/go/src/github.com/docker/docker/bundles/test-integration/fake-HOME PATH=/go/src/github.com/docker/docker/bundles/test-integration/../dynbinary-daemon:/go/src/github.com/docker/docker/bundles/test-integration/../binary-daemon:/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin TEMP= TEST_CLIENT_BINARY=docker gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-volume-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/s390x-integration-volume-junit-report.xml --raw-command -- go tool test2json -p s390x.integration.volume -t ./test.main -test.v -test.timeout=120m
23:52:44 [2019-11-13T23:52:44.308Z] INFO: Testing against a local daemon
23:52:44 [2019-11-13T23:52:44.308Z] === RUN   TestVolumesCreateAndList
23:52:44 [2019-11-13T23:52:44.308Z] --- PASS: TestVolumesCreateAndList (0.02s)
23:52:44 [2019-11-13T23:52:44.308Z] === RUN   TestVolumesRemove
23:52:44 [2019-11-13T23:52:44.808Z] --- PASS: TestVolumesRemove (0.08s)
23:52:44 [2019-11-13T23:52:44.808Z] === RUN   TestVolumesInspect
23:52:44 [2019-11-13T23:52:44.808Z] --- PASS: TestVolumesInspect (0.03s)
23:52:44 [2019-11-13T23:52:44.808Z] === RUN   TestVolumesInvalidJSON
23:52:44 [2019-11-13T23:52:44.808Z] === RUN   TestVolumesInvalidJSON//volumes/create
23:52:44 [2019-11-13T23:52:44.808Z] === PAUSE TestVolumesInvalidJSON//volumes/create
23:52:44 [2019-11-13T23:52:44.808Z] === CONT  TestVolumesInvalidJSON//volumes/create
23:52:44 [2019-11-13T23:52:44.808Z] --- PASS: TestVolumesInvalidJSON (0.03s)
23:52:44 [2019-11-13T23:52:44.808Z]     --- PASS: TestVolumesInvalidJSON//volumes/create (0.00s)
23:52:44 [2019-11-13T23:52:44.808Z] PASS
23:52:44 [2019-11-13T23:52:44.808Z] 
23:52:44 [2019-11-13T23:52:44.808Z] DONE 5 tests in 0.280s
23:52:44 [2019-11-13T23:52:44.808Z] ---> Making bundle: .integration-daemon-stop (in bundles/test-integration)
23:52:44 [2019-11-13T23:52:44.808Z] ++++ cat bundles/test-integration/docker.pid
23:52:44 [2019-11-13T23:52:44.808Z] +++ kill 11450
23:52:46 [2019-11-13T23:52:46.163Z] +++ /etc/init.d/apparmor stop
23:52:46 [2019-11-13T23:52:46.163Z] Clearing AppArmor profiles cache:.
23:52:46 [2019-11-13T23:52:46.163Z] All profile caches have been cleared, but no profiles have been unloaded.
23:52:46 [2019-11-13T23:52:46.163Z] Unloading profiles will leave already running processes permanently
23:52:46 [2019-11-13T23:52:46.163Z] unconfined, which can lead to unexpected situations.
23:52:46 [2019-11-13T23:52:46.163Z] 
23:52:46 [2019-11-13T23:52:46.163Z] To set a process to complain mode, use the command line tool
23:52:46 [2019-11-13T23:52:46.163Z] 'aa-complain'. To really tear down all profiles, run the init script
23:52:46 [2019-11-13T23:52:46.163Z] with the 'teardown' option."
23:52:46 [2019-11-13T23:52:46.539Z]