Skip to content

Console Output

01:32:04 [2019-10-14T01:32:04.401Z] + docker run --rm -t --privileged -v /home/docker/workspace/moby_PR-39931/bundles:/go/src/github.com/docker/docker/bundles --name docker-pr5 -e DOCKER_EXPERIMENTAL -e DOCKER_GITCOMMIT=ccfcb987fd58410f14d849650256c13801a918f3 -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:ccfcb987fd58410f14d849650256c13801a918f3 hack/make.sh dynbinary test-integration
01:32:05 [2019-10-14T01:32:05.126Z] 
01:32:05 [2019-10-14T01:32:05.126Z] Removing bundles/
01:32:05 [2019-10-14T01:32:05.126Z] 
01:32:05 [2019-10-14T01:32:05.126Z] ---> Making bundle: dynbinary (in bundles/dynbinary)
01:32:05 [2019-10-14T01:32:05.126Z] Building: bundles/dynbinary-daemon/dockerd-dev
01:32:05 [2019-10-14T01:32:05.126Z] GOOS="" GOARCH="" GOARM=""
01:34:12 [2019-10-14T01:34:12.351Z] Created binary: bundles/dynbinary-daemon/dockerd-dev
01:34:12 [2019-10-14T01:34:12.351Z] 
01:34:12 [2019-10-14T01:34:12.351Z] ---> Making bundle: test-integration (in bundles/test-integration)
01:34:12 [2019-10-14T01:34:12.351Z] PKG_CONFIG=pkg-config
01:34:12 [2019-10-14T01:34:12.351Z] GOLANG_VERSION=1.13.1
01:34:12 [2019-10-14T01:34:12.351Z] HOSTNAME=e01979ac8d75
01:34:12 [2019-10-14T01:34:12.351Z] DOCKER_EXPERIMENTAL=1
01:34:12 [2019-10-14T01:34:12.351Z] container=docker
01:34:12 [2019-10-14T01:34:12.351Z] TEST_SKIP_INTEGRATION_CLI=1
01:34:12 [2019-10-14T01:34:12.351Z] GO111MODULE=off
01:34:12 [2019-10-14T01:34:12.351Z] GOPATH=/go
01:34:12 [2019-10-14T01:34:12.351Z] PWD=/go/src/github.com/docker/docker
01:34:12 [2019-10-14T01:34:12.351Z] HOME=/root
01:34:12 [2019-10-14T01:34:12.351Z] VALIDATE_REPO=https://github.com/moby/moby.git
01:34:12 [2019-10-14T01:34:12.351Z] SCRIPTDIR=/go/src/github.com/docker/docker/hack
01:34:12 [2019-10-14T01:34:12.351Z] MAKEDIR=/go/src/github.com/docker/docker/hack/make
01:34:12 [2019-10-14T01:34:12.351Z] DOCKER_GITCOMMIT=ccfcb987fd58410f14d849650256c13801a918f3
01:34:12 [2019-10-14T01:34:12.351Z] DOCKER_BUILDTAGS=apparmor seccomp selinux journald
01:34:12 [2019-10-14T01:34:12.351Z] DOCKER_GRAPHDRIVER=overlay2
01:34:12 [2019-10-14T01:34:12.351Z] TERM=xterm
01:34:12 [2019-10-14T01:34:12.351Z] VALIDATE_BRANCH=master
01:34:12 [2019-10-14T01:34:12.351Z] DEST=bundles/test-integration
01:34:12 [2019-10-14T01:34:12.351Z] SHLVL=1
01:34:12 [2019-10-14T01:34:12.351Z] TIMEOUT=120m
01:34:12 [2019-10-14T01:34:12.351Z] PATH=/usr/local/cli:/go/bin:/usr/local/go/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin
01:34:12 [2019-10-14T01:34:12.351Z] DOCKER_PKG=github.com/docker/docker
01:34:12 [2019-10-14T01:34:12.351Z] TESTDEBUG=0
01:34:12 [2019-10-14T01:34:12.351Z] _=/usr/bin/env
01:34:12 [2019-10-14T01:34:12.351Z] Building test suite binary /go/src/github.com/docker/docker/integration/build/test.main
01:34:59 [2019-10-14T01:34:59.632Z] Building test suite binary /go/src/github.com/docker/docker/integration/config/test.main
01:34:59 [2019-10-14T01:34:59.632Z] Building test suite binary /go/src/github.com/docker/docker/integration/container/test.main
01:35:01 [2019-10-14T01:35:01.112Z] Building test suite binary /go/src/github.com/docker/docker/integration/image/test.main
01:35:40 [2019-10-14T01:35:40.395Z] Building test suite binary /go/src/github.com/docker/docker/integration/network/test.main
01:35:40 [2019-10-14T01:35:40.395Z] Building test suite binary /go/src/github.com/docker/docker/integration/network/ipvlan/test.main
01:35:40 [2019-10-14T01:35:40.395Z] Building test suite binary /go/src/github.com/docker/docker/integration/network/macvlan/test.main
01:35:41 [2019-10-14T01:35:41.434Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/test.main
01:35:42 [2019-10-14T01:35:42.055Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/authz/test.main
01:35:45 [2019-10-14T01:35:45.539Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/common/test.main
01:35:47 [2019-10-14T01:35:47.126Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/graphdriver/test.main
01:35:50 [2019-10-14T01:35:50.616Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/logging/test.main
01:35:55 [2019-10-14T01:35:55.028Z] Building test suite binary /go/src/github.com/docker/docker/integration/plugin/volumes/test.main
01:35:57 [2019-10-14T01:35:57.714Z] Building test suite binary /go/src/github.com/docker/docker/integration/secret/test.main
01:35:59 [2019-10-14T01:35:59.764Z] Building test suite binary /go/src/github.com/docker/docker/integration/service/test.main
01:36:03 [2019-10-14T01:36:03.274Z] Building test suite binary /go/src/github.com/docker/docker/integration/session/test.main
01:36:04 [2019-10-14T01:36:04.764Z] Building test suite binary /go/src/github.com/docker/docker/integration/system/test.main
01:36:06 [2019-10-14T01:36:06.854Z] Building test suite binary /go/src/github.com/docker/docker/integration/volume/test.main
01:36:08 [2019-10-14T01:36:08.899Z] ---> Making bundle: .integration-daemon-start (in bundles/test-integration)
01:36:08 [2019-10-14T01:36:08.899Z] Using test binary docker
01:36:08 [2019-10-14T01:36:08.899Z] # DOCKER_EXPERIMENTAL is set: starting daemon with experimental features enabled! 
01:36:08 [2019-10-14T01:36:08.899Z] +++ /etc/init.d/apparmor start
01:36:08 [2019-10-14T01:36:08.899Z] /etc/init.d/apparmor: 130: /etc/init.d/apparmor: systemd-detect-virt: not found
01:36:08 [2019-10-14T01:36:08.899Z] Starting AppArmor profiles:Warning from stdin (line 1): /sbin/apparmor_parser: cannot use or update cache, disable, or force-complain via stdin
01:36:08 [2019-10-14T01:36:08.899Z] Warning failed to create cache: (null)
01:36:08 [2019-10-14T01:36:08.899Z] .
01:36:08 [2019-10-14T01:36:08.899Z] INFO: Waiting for daemon to start...
01:36:08 [2019-10-14T01:36:08.899Z] Starting dockerd
01:36:08 [2019-10-14T01:36:08.899Z] +++ 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
01:36:11 [2019-10-14T01:36:11.221Z] .
01:36:11 [2019-10-14T01:36:11.221Z] ---> Making bundle: .integration-daemon-setup (in bundles/test-integration)
01:36:11 [2019-10-14T01:36:11.221Z] ---> Making bundle: .ensure-emptyfs (in bundles/test-integration)
01:36:11 [2019-10-14T01:36:11.221Z] Error: No such image: emptyfs
01:36:11 [2019-10-14T01:36:11.221Z] ++++ tar -cC bundles/test-integration/emptyfs .
01:36:11 [2019-10-14T01:36:11.221Z] ++++ docker load
01:36:11 [2019-10-14T01:36:11.510Z] Running integration-test (iteration 1)
01:36:11 [2019-10-14T01:36:11.510Z] Running /go/src/github.com/docker/docker/integration/build (ppc64le.integration.build) flags=-test.v -test.timeout=120m 
01:36:11 [2019-10-14T01:36:11.510Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-build-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-build-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.build -t ./test.main -test.v -test.timeout=120m
01:36:11 [2019-10-14T01:36:11.510Z] ++ set -e
01:36:11 [2019-10-14T01:36:11.510Z] ++ '[' -n 0 ']'
01:36:11 [2019-10-14T01:36:11.510Z] ++ set -x
01:36:11 [2019-10-14T01:36:11.510Z] ++ 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=ppc64le 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/ppc64le-integration-build-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-build-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.build -t ./test.main -test.v -test.timeout=120m
01:36:26 [2019-10-14T01:36:26.895Z] Loaded image: buildpack-deps:jessie
01:36:26 [2019-10-14T01:36:26.895Z] Loaded image: busybox:latest
01:36:26 [2019-10-14T01:36:26.895Z] Loaded image: busybox:glibc
01:36:26 [2019-10-14T01:36:26.895Z] Loaded image: debian:jessie
01:36:26 [2019-10-14T01:36:26.895Z] Loaded image: hello-world:latest
01:36:26 [2019-10-14T01:36:26.895Z] INFO: Testing against a local daemon
01:36:26 [2019-10-14T01:36:26.895Z] === RUN   TestCgroupNamespacesBuild
01:36:27 [2019-10-14T01:36:27.919Z] --- PASS: TestCgroupNamespacesBuild (1.69s)
01:36:27 [2019-10-14T01:36:27.919Z]     build_cgroupns_linux_test.go:42: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCgroupNamespacesBuild"
01:36:27 [2019-10-14T01:36:27.919Z] === RUN   TestCgroupNamespacesBuildDaemonHostMode
01:36:29 [2019-10-14T01:36:29.406Z] --- PASS: TestCgroupNamespacesBuildDaemonHostMode (1.69s)
01:36:29 [2019-10-14T01:36:29.406Z]     build_cgroupns_linux_test.go:42: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCgroupNamespacesBuildDaemonHostMode"
01:36:29 [2019-10-14T01:36:29.406Z] === RUN   TestBuildWithSession
01:36:29 [2019-10-14T01:36:29.406Z] --- SKIP: TestBuildWithSession (0.00s)
01:36:29 [2019-10-14T01:36:29.406Z]     build_session_test.go:25: TODO: BuildKit
01:36:29 [2019-10-14T01:36:29.406Z] === RUN   TestBuildSquashParent
01:36:34 [2019-10-14T01:36:34.924Z] --- PASS: TestBuildSquashParent (4.96s)
01:36:34 [2019-10-14T01:36:34.924Z] === RUN   TestBuildWithRemoveAndForceRemove
01:36:34 [2019-10-14T01:36:34.924Z] === RUN   TestBuildWithRemoveAndForceRemove/successful_build_with_no_removal
01:36:34 [2019-10-14T01:36:34.924Z] === PAUSE TestBuildWithRemoveAndForceRemove/successful_build_with_no_removal
01:36:34 [2019-10-14T01:36:34.924Z] === RUN   TestBuildWithRemoveAndForceRemove/successful_build_with_remove
01:36:34 [2019-10-14T01:36:34.924Z] === PAUSE TestBuildWithRemoveAndForceRemove/successful_build_with_remove
01:36:34 [2019-10-14T01:36:34.924Z] === RUN   TestBuildWithRemoveAndForceRemove/successful_build_with_remove_and_force_remove
01:36:34 [2019-10-14T01:36:34.924Z] === PAUSE TestBuildWithRemoveAndForceRemove/successful_build_with_remove_and_force_remove
01:36:34 [2019-10-14T01:36:34.924Z] === RUN   TestBuildWithRemoveAndForceRemove/failed_build_with_no_removal
01:36:34 [2019-10-14T01:36:34.924Z] === PAUSE TestBuildWithRemoveAndForceRemove/failed_build_with_no_removal
01:36:34 [2019-10-14T01:36:34.924Z] === RUN   TestBuildWithRemoveAndForceRemove/failed_build_with_remove
01:36:34 [2019-10-14T01:36:34.924Z] === PAUSE TestBuildWithRemoveAndForceRemove/failed_build_with_remove
01:36:34 [2019-10-14T01:36:34.924Z] === RUN   TestBuildWithRemoveAndForceRemove/failed_build_with_remove_and_force_remove
01:36:34 [2019-10-14T01:36:34.924Z] === PAUSE TestBuildWithRemoveAndForceRemove/failed_build_with_remove_and_force_remove
01:36:34 [2019-10-14T01:36:34.924Z] === CONT  TestBuildWithRemoveAndForceRemove/successful_build_with_no_removal
01:36:34 [2019-10-14T01:36:34.924Z] === CONT  TestBuildWithRemoveAndForceRemove/failed_build_with_remove_and_force_remove
01:36:34 [2019-10-14T01:36:34.924Z] === CONT  TestBuildWithRemoveAndForceRemove/failed_build_with_remove
01:36:34 [2019-10-14T01:36:34.924Z] === CONT  TestBuildWithRemoveAndForceRemove/failed_build_with_no_removal
01:36:37 [2019-10-14T01:36:37.634Z] === CONT  TestBuildWithRemoveAndForceRemove/successful_build_with_remove_and_force_remove
01:36:37 [2019-10-14T01:36:37.634Z] === CONT  TestBuildWithRemoveAndForceRemove/successful_build_with_remove
01:36:39 [2019-10-14T01:36:39.669Z] --- PASS: TestBuildWithRemoveAndForceRemove (0.04s)
01:36:39 [2019-10-14T01:36:39.670Z]     --- PASS: TestBuildWithRemoveAndForceRemove/failed_build_with_remove_and_force_remove (2.66s)
01:36:39 [2019-10-14T01:36:39.670Z]     --- PASS: TestBuildWithRemoveAndForceRemove/failed_build_with_remove (2.98s)
01:36:39 [2019-10-14T01:36:39.670Z]     --- PASS: TestBuildWithRemoveAndForceRemove/failed_build_with_no_removal (3.07s)
01:36:39 [2019-10-14T01:36:39.670Z]     --- PASS: TestBuildWithRemoveAndForceRemove/successful_build_with_no_removal (3.26s)
01:36:39 [2019-10-14T01:36:39.670Z]     --- PASS: TestBuildWithRemoveAndForceRemove/successful_build_with_remove (2.02s)
01:36:39 [2019-10-14T01:36:39.670Z]     --- PASS: TestBuildWithRemoveAndForceRemove/successful_build_with_remove_and_force_remove (2.38s)
01:36:39 [2019-10-14T01:36:39.670Z] === RUN   TestBuildMultiStageCopy
01:36:39 [2019-10-14T01:36:39.670Z] === RUN   TestBuildMultiStageCopy/copy_to_root
01:36:41 [2019-10-14T01:36:41.702Z] === RUN   TestBuildMultiStageCopy/copy_to_newdir
01:36:41 [2019-10-14T01:36:41.702Z] === RUN   TestBuildMultiStageCopy/copy_to_newdir_nested
01:36:42 [2019-10-14T01:36:42.324Z] === RUN   TestBuildMultiStageCopy/copy_to_existingdir
01:36:42 [2019-10-14T01:36:42.609Z] === RUN   TestBuildMultiStageCopy/copy_to_newsubdir
01:36:43 [2019-10-14T01:36:43.227Z] --- PASS: TestBuildMultiStageCopy (3.47s)
01:36:43 [2019-10-14T01:36:43.227Z]     --- PASS: TestBuildMultiStageCopy/copy_to_root (1.90s)
01:36:43 [2019-10-14T01:36:43.227Z]     --- PASS: TestBuildMultiStageCopy/copy_to_newdir (0.37s)
01:36:43 [2019-10-14T01:36:43.227Z]     --- PASS: TestBuildMultiStageCopy/copy_to_newdir_nested (0.38s)
01:36:43 [2019-10-14T01:36:43.227Z]     --- PASS: TestBuildMultiStageCopy/copy_to_existingdir (0.40s)
01:36:43 [2019-10-14T01:36:43.227Z]     --- PASS: TestBuildMultiStageCopy/copy_to_newsubdir (0.42s)
01:36:43 [2019-10-14T01:36:43.227Z] === RUN   TestBuildMultiStageParentConfig
01:36:44 [2019-10-14T01:36:44.240Z] --- PASS: TestBuildMultiStageParentConfig (1.00s)
01:36:44 [2019-10-14T01:36:44.240Z] === RUN   TestBuildLabelWithTargets
01:36:45 [2019-10-14T01:36:45.728Z] --- PASS: TestBuildLabelWithTargets (1.54s)
01:36:45 [2019-10-14T01:36:45.728Z] === RUN   TestBuildWithEmptyLayers
01:36:46 [2019-10-14T01:36:46.348Z] --- PASS: TestBuildWithEmptyLayers (0.81s)
01:36:46 [2019-10-14T01:36:46.348Z] === RUN   TestBuildMultiStageOnBuild
01:36:49 [2019-10-14T01:36:49.045Z] --- PASS: TestBuildMultiStageOnBuild (2.26s)
01:36:49 [2019-10-14T01:36:49.045Z] === RUN   TestBuildUncleanTarFilenames
01:36:49 [2019-10-14T01:36:49.667Z] --- PASS: TestBuildUncleanTarFilenames (1.12s)
01:36:49 [2019-10-14T01:36:49.667Z] === RUN   TestBuildMultiStageLayerLeak
01:36:52 [2019-10-14T01:36:52.356Z] --- PASS: TestBuildMultiStageLayerLeak (2.22s)
01:36:52 [2019-10-14T01:36:52.356Z] === RUN   TestBuildWithHugeFile
01:38:14 [2019-10-14T01:38:14.405Z] --- PASS: TestBuildWithHugeFile (80.05s)
01:38:14 [2019-10-14T01:38:14.405Z] === RUN   TestBuildWithEmptyDockerfile
01:38:14 [2019-10-14T01:38:14.405Z] === RUN   TestBuildWithEmptyDockerfile/empty-dockerfile
01:38:14 [2019-10-14T01:38:14.405Z] === PAUSE TestBuildWithEmptyDockerfile/empty-dockerfile
01:38:14 [2019-10-14T01:38:14.405Z] === RUN   TestBuildWithEmptyDockerfile/empty-lines-dockerfile
01:38:14 [2019-10-14T01:38:14.405Z] === PAUSE TestBuildWithEmptyDockerfile/empty-lines-dockerfile
01:38:14 [2019-10-14T01:38:14.405Z] === RUN   TestBuildWithEmptyDockerfile/comment-only-dockerfile
01:38:14 [2019-10-14T01:38:14.405Z] === PAUSE TestBuildWithEmptyDockerfile/comment-only-dockerfile
01:38:14 [2019-10-14T01:38:14.405Z] === CONT  TestBuildWithEmptyDockerfile/empty-dockerfile
01:38:14 [2019-10-14T01:38:14.405Z] === CONT  TestBuildWithEmptyDockerfile/empty-lines-dockerfile
01:38:14 [2019-10-14T01:38:14.405Z] === CONT  TestBuildWithEmptyDockerfile/comment-only-dockerfile
01:38:14 [2019-10-14T01:38:14.405Z] --- PASS: TestBuildWithEmptyDockerfile (0.07s)
01:38:14 [2019-10-14T01:38:14.405Z]     --- PASS: TestBuildWithEmptyDockerfile/empty-lines-dockerfile (0.32s)
01:38:14 [2019-10-14T01:38:14.405Z]     --- PASS: TestBuildWithEmptyDockerfile/comment-only-dockerfile (0.32s)
01:38:14 [2019-10-14T01:38:14.405Z]     --- PASS: TestBuildWithEmptyDockerfile/empty-dockerfile (0.33s)
01:38:14 [2019-10-14T01:38:14.405Z] === RUN   TestBuildPreserveOwnership
01:38:14 [2019-10-14T01:38:14.405Z] === RUN   TestBuildPreserveOwnership/copy_from
01:38:15 [2019-10-14T01:38:15.902Z] === RUN   TestBuildPreserveOwnership/copy_from_chowned
01:38:17 [2019-10-14T01:38:17.385Z] --- PASS: TestBuildPreserveOwnership (4.76s)
01:38:17 [2019-10-14T01:38:17.385Z]     --- PASS: TestBuildPreserveOwnership/copy_from (3.15s)
01:38:17 [2019-10-14T01:38:17.385Z]     --- PASS: TestBuildPreserveOwnership/copy_from_chowned (1.60s)
01:38:17 [2019-10-14T01:38:17.385Z] === RUN   TestBuildPlatformInvalid
01:38:17 [2019-10-14T01:38:17.385Z] --- PASS: TestBuildPlatformInvalid (0.15s)
01:38:17 [2019-10-14T01:38:17.385Z] PASS
01:38:17 [2019-10-14T01:38:17.385Z] 
01:38:17 [2019-10-14T01:38:17.385Z] === Skipped
01:38:17 [2019-10-14T01:38:17.385Z] === SKIP: ppc64le.integration.build TestBuildWithSession (0.00s)
01:38:17 [2019-10-14T01:38:17.385Z]     build_session_test.go:25: TODO: BuildKit
01:38:17 [2019-10-14T01:38:17.385Z] 
01:38:17 [2019-10-14T01:38:17.385Z] 
01:38:17 [2019-10-14T01:38:17.385Z] DONE 32 tests, 1 skipped in 125.866s
01:38:17 [2019-10-14T01:38:17.385Z] Running /go/src/github.com/docker/docker/integration/config (ppc64le.integration.config) flags=-test.v -test.timeout=120m 
01:38:17 [2019-10-14T01:38:17.385Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-config-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-config-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.config -t ./test.main -test.v -test.timeout=120m
01:38:17 [2019-10-14T01:38:17.385Z] ++ set -e
01:38:17 [2019-10-14T01:38:17.385Z] ++ '[' -n 0 ']'
01:38:17 [2019-10-14T01:38:17.385Z] ++ set -x
01:38:17 [2019-10-14T01:38:17.385Z] ++ 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=ppc64le 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/ppc64le-integration-config-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-config-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.config -t ./test.main -test.v -test.timeout=120m
01:38:17 [2019-10-14T01:38:17.385Z] INFO: Testing against a local daemon
01:38:17 [2019-10-14T01:38:17.385Z] === RUN   TestConfigList
01:38:20 [2019-10-14T01:38:20.073Z] --- PASS: TestConfigList (2.18s)
01:38:20 [2019-10-14T01:38:20.073Z]     config_test.go:30: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestConfigList"
01:38:20 [2019-10-14T01:38:20.073Z] === RUN   TestConfigsCreateAndDelete
01:38:22 [2019-10-14T01:38:22.112Z] --- PASS: TestConfigsCreateAndDelete (2.18s)
01:38:22 [2019-10-14T01:38:22.112Z]     config_test.go:112: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestConfigsCreateAndDelete"
01:38:22 [2019-10-14T01:38:22.112Z] === RUN   TestConfigsUpdate
01:38:24 [2019-10-14T01:38:24.143Z] --- PASS: TestConfigsUpdate (2.17s)
01:38:24 [2019-10-14T01:38:24.143Z]     config_test.go:140: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestConfigsUpdate"
01:38:24 [2019-10-14T01:38:24.143Z] === RUN   TestTemplatedConfig
01:38:26 [2019-10-14T01:38:26.851Z] --- PASS: TestTemplatedConfig (2.77s)
01:38:26 [2019-10-14T01:38:26.851Z]     config_test.go:192: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestTemplatedConfig"
01:38:26 [2019-10-14T01:38:26.851Z] === RUN   TestConfigInspect
01:38:28 [2019-10-14T01:38:28.992Z] --- PASS: TestConfigInspect (2.19s)
01:38:28 [2019-10-14T01:38:28.992Z]     config_test.go:326: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestConfigInspect"
01:38:28 [2019-10-14T01:38:28.992Z] === RUN   TestConfigCreateWithLabels
01:38:31 [2019-10-14T01:38:31.686Z] --- PASS: TestConfigCreateWithLabels (2.22s)
01:38:31 [2019-10-14T01:38:31.686Z]     config_test.go:350: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestConfigCreateWithLabels"
01:38:31 [2019-10-14T01:38:31.686Z] === RUN   TestConfigCreateResolve
01:38:33 [2019-10-14T01:38:33.740Z] --- PASS: TestConfigCreateResolve (2.20s)
01:38:33 [2019-10-14T01:38:33.740Z]     config_test.go:377: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestConfigCreateResolve"
01:38:33 [2019-10-14T01:38:33.740Z] === RUN   TestConfigDaemonLibtrustID
01:38:34 [2019-10-14T01:38:34.026Z] --- PASS: TestConfigDaemonLibtrustID (0.56s)
01:38:34 [2019-10-14T01:38:34.026Z]     config_test.go:427: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestConfigDaemonLibtrustID"
01:38:34 [2019-10-14T01:38:34.026Z] PASS
01:38:34 [2019-10-14T01:38:34.026Z] 
01:38:34 [2019-10-14T01:38:34.026Z] DONE 8 tests in 16.578s
01:38:34 [2019-10-14T01:38:34.026Z] Running /go/src/github.com/docker/docker/integration/container (ppc64le.integration.container) flags=-test.v -test.timeout=120m 
01:38:34 [2019-10-14T01:38:34.026Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-container-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-container-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.container -t ./test.main -test.v -test.timeout=120m
01:38:34 [2019-10-14T01:38:34.026Z] ++ set -e
01:38:34 [2019-10-14T01:38:34.026Z] ++ '[' -n 0 ']'
01:38:34 [2019-10-14T01:38:34.026Z] ++ set -x
01:38:34 [2019-10-14T01:38:34.026Z] ++ 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=ppc64le 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/ppc64le-integration-container-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-container-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.container -t ./test.main -test.v -test.timeout=120m
01:38:34 [2019-10-14T01:38:34.026Z] INFO: Testing against a local daemon
01:38:34 [2019-10-14T01:38:34.026Z] === RUN   TestCheckpoint
01:38:34 [2019-10-14T01:38:34.026Z] --- SKIP: TestCheckpoint (0.00s)
01:38:34 [2019-10-14T01:38:34.026Z]     checkpoint_test.go:33: TestCheckpoint is broken; see https://github.com/moby/moby/issues/38963
01:38:34 [2019-10-14T01:38:34.026Z] === RUN   TestContainerInvalidJSON
01:38:34 [2019-10-14T01:38:34.026Z] === RUN   TestContainerInvalidJSON//containers/foobar/copy
01:38:34 [2019-10-14T01:38:34.026Z] === PAUSE TestContainerInvalidJSON//containers/foobar/copy
01:38:34 [2019-10-14T01:38:34.026Z] === RUN   TestContainerInvalidJSON//containers/foobar/exec
01:38:34 [2019-10-14T01:38:34.026Z] === PAUSE TestContainerInvalidJSON//containers/foobar/exec
01:38:34 [2019-10-14T01:38:34.026Z] === RUN   TestContainerInvalidJSON//exec/foobar/start
01:38:34 [2019-10-14T01:38:34.026Z] === PAUSE TestContainerInvalidJSON//exec/foobar/start
01:38:34 [2019-10-14T01:38:34.026Z] === CONT  TestContainerInvalidJSON//containers/foobar/copy
01:38:34 [2019-10-14T01:38:34.026Z] === CONT  TestContainerInvalidJSON//exec/foobar/start
01:38:34 [2019-10-14T01:38:34.026Z] === CONT  TestContainerInvalidJSON//containers/foobar/exec
01:38:34 [2019-10-14T01:38:34.309Z] --- PASS: TestContainerInvalidJSON (0.03s)
01:38:34 [2019-10-14T01:38:34.309Z]     --- PASS: TestContainerInvalidJSON//containers/foobar/copy (0.00s)
01:38:34 [2019-10-14T01:38:34.309Z]     --- PASS: TestContainerInvalidJSON//containers/foobar/exec (0.00s)
01:38:34 [2019-10-14T01:38:34.309Z]     --- PASS: TestContainerInvalidJSON//exec/foobar/start (0.00s)
01:38:34 [2019-10-14T01:38:34.309Z] === RUN   TestCopyFromContainerPathDoesNotExist
01:38:34 [2019-10-14T01:38:34.309Z] --- PASS: TestCopyFromContainerPathDoesNotExist (0.08s)
01:38:34 [2019-10-14T01:38:34.309Z] === RUN   TestCopyFromContainerPathIsNotDir
01:38:34 [2019-10-14T01:38:34.309Z] --- PASS: TestCopyFromContainerPathIsNotDir (0.08s)
01:38:34 [2019-10-14T01:38:34.309Z] === RUN   TestCopyToContainerPathDoesNotExist
01:38:34 [2019-10-14T01:38:34.309Z] --- PASS: TestCopyToContainerPathDoesNotExist (0.08s)
01:38:34 [2019-10-14T01:38:34.309Z] === RUN   TestCopyToContainerPathIsNotDir
01:38:34 [2019-10-14T01:38:34.595Z] --- PASS: TestCopyToContainerPathIsNotDir (0.08s)
01:38:34 [2019-10-14T01:38:34.595Z] === RUN   TestCopyFromContainer
01:38:36 [2019-10-14T01:38:36.076Z] === RUN   TestCopyFromContainer//
01:38:36 [2019-10-14T01:38:36.076Z] === RUN   TestCopyFromContainer//bar/root
01:38:36 [2019-10-14T01:38:36.359Z] === RUN   TestCopyFromContainer//bar/root/
01:38:36 [2019-10-14T01:38:36.359Z] === RUN   TestCopyFromContainer/bar/quux
01:38:36 [2019-10-14T01:38:36.359Z] === RUN   TestCopyFromContainer/bar/quux/
01:38:36 [2019-10-14T01:38:36.645Z] === RUN   TestCopyFromContainer/bar/quux/baz
01:38:36 [2019-10-14T01:38:36.645Z] === RUN   TestCopyFromContainer/bar/filesymlink
01:38:36 [2019-10-14T01:38:36.645Z] === RUN   TestCopyFromContainer/bar/dirsymlink
01:38:36 [2019-10-14T01:38:36.645Z] === RUN   TestCopyFromContainer/bar/dirsymlink/
01:38:36 [2019-10-14T01:38:36.928Z] === RUN   TestCopyFromContainer/bar/notarget
01:38:36 [2019-10-14T01:38:36.928Z] --- PASS: TestCopyFromContainer (2.50s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCopyFromContainer// (0.09s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCopyFromContainer//bar/root (0.10s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCopyFromContainer//bar/root/ (0.09s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCopyFromContainer/bar/quux (0.09s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCopyFromContainer/bar/quux/ (0.09s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCopyFromContainer/bar/quux/baz (0.08s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCopyFromContainer/bar/filesymlink (0.09s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCopyFromContainer/bar/dirsymlink (0.09s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCopyFromContainer/bar/dirsymlink/ (0.09s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCopyFromContainer/bar/notarget (0.10s)
01:38:36 [2019-10-14T01:38:36.928Z] === RUN   TestCreateFailsWhenIdentifierDoesNotExist
01:38:36 [2019-10-14T01:38:36.928Z] === RUN   TestCreateFailsWhenIdentifierDoesNotExist/image_and_tag
01:38:36 [2019-10-14T01:38:36.928Z] === PAUSE TestCreateFailsWhenIdentifierDoesNotExist/image_and_tag
01:38:36 [2019-10-14T01:38:36.928Z] === RUN   TestCreateFailsWhenIdentifierDoesNotExist/image_no_tag
01:38:36 [2019-10-14T01:38:36.928Z] === PAUSE TestCreateFailsWhenIdentifierDoesNotExist/image_no_tag
01:38:36 [2019-10-14T01:38:36.928Z] === RUN   TestCreateFailsWhenIdentifierDoesNotExist/digest
01:38:36 [2019-10-14T01:38:36.928Z] === PAUSE TestCreateFailsWhenIdentifierDoesNotExist/digest
01:38:36 [2019-10-14T01:38:36.928Z] === CONT  TestCreateFailsWhenIdentifierDoesNotExist/image_and_tag
01:38:36 [2019-10-14T01:38:36.928Z] === CONT  TestCreateFailsWhenIdentifierDoesNotExist/image_no_tag
01:38:36 [2019-10-14T01:38:36.928Z] === CONT  TestCreateFailsWhenIdentifierDoesNotExist/digest
01:38:36 [2019-10-14T01:38:36.928Z] --- PASS: TestCreateFailsWhenIdentifierDoesNotExist (0.02s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCreateFailsWhenIdentifierDoesNotExist/image_no_tag (0.00s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCreateFailsWhenIdentifierDoesNotExist/image_and_tag (0.01s)
01:38:36 [2019-10-14T01:38:36.928Z]     --- PASS: TestCreateFailsWhenIdentifierDoesNotExist/digest (0.01s)
01:38:36 [2019-10-14T01:38:36.928Z] === RUN   TestCreateLinkToNonExistingContainer
01:38:37 [2019-10-14T01:38:37.213Z] --- PASS: TestCreateLinkToNonExistingContainer (0.06s)
01:38:37 [2019-10-14T01:38:37.213Z] === RUN   TestCreateWithInvalidEnv
01:38:37 [2019-10-14T01:38:37.213Z] === RUN   TestCreateWithInvalidEnv/0
01:38:37 [2019-10-14T01:38:37.213Z] === PAUSE TestCreateWithInvalidEnv/0
01:38:37 [2019-10-14T01:38:37.213Z] === RUN   TestCreateWithInvalidEnv/1
01:38:37 [2019-10-14T01:38:37.213Z] === PAUSE TestCreateWithInvalidEnv/1
01:38:37 [2019-10-14T01:38:37.213Z] === RUN   TestCreateWithInvalidEnv/2
01:38:37 [2019-10-14T01:38:37.213Z] === PAUSE TestCreateWithInvalidEnv/2
01:38:37 [2019-10-14T01:38:37.213Z] === CONT  TestCreateWithInvalidEnv/0
01:38:37 [2019-10-14T01:38:37.213Z] === CONT  TestCreateWithInvalidEnv/2
01:38:37 [2019-10-14T01:38:37.213Z] === CONT  TestCreateWithInvalidEnv/1
01:38:37 [2019-10-14T01:38:37.213Z] --- PASS: TestCreateWithInvalidEnv (0.03s)
01:38:37 [2019-10-14T01:38:37.213Z]     --- PASS: TestCreateWithInvalidEnv/1 (0.00s)
01:38:37 [2019-10-14T01:38:37.213Z]     --- PASS: TestCreateWithInvalidEnv/0 (0.00s)
01:38:37 [2019-10-14T01:38:37.213Z]     --- PASS: TestCreateWithInvalidEnv/2 (0.00s)
01:38:37 [2019-10-14T01:38:37.213Z] === RUN   TestCreateTmpfsMountsTarget
01:38:37 [2019-10-14T01:38:37.213Z] --- PASS: TestCreateTmpfsMountsTarget (0.03s)
01:38:37 [2019-10-14T01:38:37.213Z] === RUN   TestCreateWithCustomMaskedPaths
01:38:39 [2019-10-14T01:38:39.254Z] --- PASS: TestCreateWithCustomMaskedPaths (1.91s)
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/no_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/no_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/empty_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/empty_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/valid_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/valid_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/invalid_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/invalid_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/duplicate_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/duplicate_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/capabilities_API_v1.39
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/capabilities_API_v1.39
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/empty_capadd
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/empty_capadd
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/empty_capdrop
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/empty_capdrop
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/capadd_capdrop
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/capadd_capdrop
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/conflict_with_capadd
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/conflict_with_capadd
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCapabilities/conflict_with_capdrop
01:38:39 [2019-10-14T01:38:39.254Z] === PAUSE TestCreateWithCapabilities/conflict_with_capdrop
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/no_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/empty_capadd
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/conflict_with_capadd
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/capadd_capdrop
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/conflict_with_capdrop
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/empty_capdrop
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/invalid_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/capabilities_API_v1.39
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/duplicate_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/valid_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] === CONT  TestCreateWithCapabilities/empty_capabilities
01:38:39 [2019-10-14T01:38:39.254Z] --- PASS: TestCreateWithCapabilities (0.04s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/conflict_with_capadd (0.00s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/conflict_with_capdrop (0.01s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/capadd_capdrop (0.06s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/no_capabilities (0.06s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/empty_capadd (0.06s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/empty_capdrop (0.05s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/invalid_capabilities (0.01s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/capabilities_API_v1.39 (0.06s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/duplicate_capabilities (0.06s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/valid_capabilities (0.05s)
01:38:39 [2019-10-14T01:38:39.254Z]     --- PASS: TestCreateWithCapabilities/empty_capabilities (0.05s)
01:38:39 [2019-10-14T01:38:39.254Z] === RUN   TestCreateWithCustomReadonlyPaths
01:38:41 [2019-10-14T01:38:41.285Z] --- PASS: TestCreateWithCustomReadonlyPaths (1.95s)
01:38:41 [2019-10-14T01:38:41.285Z] === RUN   TestCreateWithInvalidHealthcheckParams
01:38:41 [2019-10-14T01:38:41.285Z] === RUN   TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_less_than_0s
01:38:41 [2019-10-14T01:38:41.285Z] === PAUSE TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_less_than_0s
01:38:41 [2019-10-14T01:38:41.285Z] === RUN   TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_larger_than_0s_but_less_than_1ms
01:38:41 [2019-10-14T01:38:41.285Z] === PAUSE TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_larger_than_0s_but_less_than_1ms
01:38:41 [2019-10-14T01:38:41.285Z] === RUN   TestCreateWithInvalidHealthcheckParams/test_invalid_Timeout_in_Healthcheck:_less_than_1ms
01:38:41 [2019-10-14T01:38:41.285Z] === PAUSE TestCreateWithInvalidHealthcheckParams/test_invalid_Timeout_in_Healthcheck:_less_than_1ms
01:38:41 [2019-10-14T01:38:41.285Z] === RUN   TestCreateWithInvalidHealthcheckParams/test_invalid_Retries_in_Healthcheck:_less_than_0
01:38:41 [2019-10-14T01:38:41.285Z] === PAUSE TestCreateWithInvalidHealthcheckParams/test_invalid_Retries_in_Healthcheck:_less_than_0
01:38:41 [2019-10-14T01:38:41.285Z] === RUN   TestCreateWithInvalidHealthcheckParams/test_invalid_StartPeriod_in_Healthcheck:_not_0_and_less_than_1ms
01:38:41 [2019-10-14T01:38:41.285Z] === PAUSE TestCreateWithInvalidHealthcheckParams/test_invalid_StartPeriod_in_Healthcheck:_not_0_and_less_than_1ms
01:38:41 [2019-10-14T01:38:41.285Z] === CONT  TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_less_than_0s
01:38:41 [2019-10-14T01:38:41.285Z] === CONT  TestCreateWithInvalidHealthcheckParams/test_invalid_Retries_in_Healthcheck:_less_than_0
01:38:41 [2019-10-14T01:38:41.285Z] === CONT  TestCreateWithInvalidHealthcheckParams/test_invalid_StartPeriod_in_Healthcheck:_not_0_and_less_than_1ms
01:38:41 [2019-10-14T01:38:41.285Z] === CONT  TestCreateWithInvalidHealthcheckParams/test_invalid_Timeout_in_Healthcheck:_less_than_1ms
01:38:41 [2019-10-14T01:38:41.285Z] === CONT  TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_larger_than_0s_but_less_than_1ms
01:38:41 [2019-10-14T01:38:41.285Z] --- PASS: TestCreateWithInvalidHealthcheckParams (0.03s)
01:38:41 [2019-10-14T01:38:41.285Z]     --- PASS: TestCreateWithInvalidHealthcheckParams/test_invalid_Timeout_in_Healthcheck:_less_than_1ms (0.02s)
01:38:41 [2019-10-14T01:38:41.285Z]     --- PASS: TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_less_than_0s (0.04s)
01:38:41 [2019-10-14T01:38:41.285Z]     --- PASS: TestCreateWithInvalidHealthcheckParams/test_invalid_StartPeriod_in_Healthcheck:_not_0_and_less_than_1ms (0.05s)
01:38:41 [2019-10-14T01:38:41.285Z]     --- PASS: TestCreateWithInvalidHealthcheckParams/test_invalid_Retries_in_Healthcheck:_less_than_0 (0.05s)
01:38:41 [2019-10-14T01:38:41.285Z]     --- PASS: TestCreateWithInvalidHealthcheckParams/test_invalid_Interval_in_Healthcheck:_larger_than_0s_but_less_than_1ms (0.03s)
01:38:41 [2019-10-14T01:38:41.285Z] === RUN   TestContainerStartOnDaemonRestart
01:38:41 [2019-10-14T01:38:41.285Z] === PAUSE TestContainerStartOnDaemonRestart
01:38:41 [2019-10-14T01:38:41.285Z] === RUN   TestDaemonRestartIpcMode
01:38:41 [2019-10-14T01:38:41.285Z] === PAUSE TestDaemonRestartIpcMode
01:38:41 [2019-10-14T01:38:41.285Z] === RUN   TestDiff
01:38:41 [2019-10-14T01:38:41.905Z] --- PASS: TestDiff (0.69s)
01:38:41 [2019-10-14T01:38:41.905Z] === RUN   TestExecWithCloseStdin
01:38:42 [2019-10-14T01:38:42.923Z] --- PASS: TestExecWithCloseStdin (0.91s)
01:38:42 [2019-10-14T01:38:42.923Z] === RUN   TestExec
01:38:43 [2019-10-14T01:38:43.934Z] --- PASS: TestExec (0.84s)
01:38:43 [2019-10-14T01:38:43.934Z] === RUN   TestExecUser
01:38:44 [2019-10-14T01:38:44.552Z] --- PASS: TestExecUser (0.84s)
01:38:44 [2019-10-14T01:38:44.552Z] === RUN   TestExportContainerAndImportImage
01:38:45 [2019-10-14T01:38:45.569Z] --- PASS: TestExportContainerAndImportImage (0.95s)
01:38:45 [2019-10-14T01:38:45.569Z] === RUN   TestExportContainerAfterDaemonRestart
01:38:47 [2019-10-14T01:38:47.049Z] --- PASS: TestExportContainerAfterDaemonRestart (1.54s)
01:38:47 [2019-10-14T01:38:47.049Z]     export_test.go:63: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestExportContainerAfterDaemonRestart"
01:38:47 [2019-10-14T01:38:47.049Z] === RUN   TestHealthCheckWorkdir
01:38:48 [2019-10-14T01:38:48.069Z] --- PASS: TestHealthCheckWorkdir (1.06s)
01:38:48 [2019-10-14T01:38:48.069Z] === RUN   TestHealthKillContainer
01:38:51 [2019-10-14T01:38:51.527Z] --- PASS: TestHealthKillContainer (2.92s)
01:38:51 [2019-10-14T01:38:51.527Z] === RUN   TestInspectCpusetInConfigPre120
01:38:51 [2019-10-14T01:38:51.814Z] --- PASS: TestInspectCpusetInConfigPre120 (0.66s)
01:38:51 [2019-10-14T01:38:51.814Z] === RUN   TestIpcModeNone
01:38:52 [2019-10-14T01:38:52.435Z] --- PASS: TestIpcModeNone (0.86s)
01:38:52 [2019-10-14T01:38:52.435Z] === RUN   TestIpcModePrivate
01:38:53 [2019-10-14T01:38:53.459Z] --- PASS: TestIpcModePrivate (0.84s)
01:38:53 [2019-10-14T01:38:53.459Z]     ipcmode_linux_test.go:90: [testIpcPrivateShareable] ipcmode: private, ipcdev: 0:63, shared: false, mustBeShared: false
01:38:53 [2019-10-14T01:38:53.459Z] === RUN   TestIpcModeShareable
01:38:54 [2019-10-14T01:38:54.472Z] --- PASS: TestIpcModeShareable (0.85s)
01:38:54 [2019-10-14T01:38:54.472Z]     ipcmode_linux_test.go:90: [testIpcPrivateShareable] ipcmode: shareable, ipcdev: 0:57, shared: true, mustBeShared: true
01:38:54 [2019-10-14T01:38:54.472Z] === RUN   TestAPIIpcModeShareableAndContainer
01:38:57 [2019-10-14T01:38:57.164Z] --- PASS: TestAPIIpcModeShareableAndContainer (2.47s)
01:38:57 [2019-10-14T01:38:57.164Z] === RUN   TestAPIIpcModeHost
01:38:57 [2019-10-14T01:38:57.450Z] --- PASS: TestAPIIpcModeHost (0.71s)
01:38:57 [2019-10-14T01:38:57.450Z] === RUN   TestDaemonIpcModeShareable
01:38:59 [2019-10-14T01:38:59.477Z] --- PASS: TestDaemonIpcModeShareable (1.78s)
01:38:59 [2019-10-14T01:38:59.477Z]     ipcmode_linux_test.go:230: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonIpcModeShareable"
01:38:59 [2019-10-14T01:38:59.477Z]     ipcmode_linux_test.go:258: [testDaemonIpcPrivateShareable] ipcdev: 0:65, shared: true, mustBeShared: true
01:38:59 [2019-10-14T01:38:59.477Z] === RUN   TestDaemonIpcModePrivate
01:39:00 [2019-10-14T01:39:00.967Z] --- PASS: TestDaemonIpcModePrivate (1.69s)
01:39:00 [2019-10-14T01:39:00.967Z]     ipcmode_linux_test.go:230: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonIpcModePrivate"
01:39:00 [2019-10-14T01:39:00.967Z]     ipcmode_linux_test.go:258: [testDaemonIpcPrivateShareable] ipcdev: 0:71, shared: false, mustBeShared: false
01:39:00 [2019-10-14T01:39:00.967Z] === RUN   TestDaemonIpcModePrivateFromConfig
01:39:02 [2019-10-14T01:39:02.998Z] --- PASS: TestDaemonIpcModePrivateFromConfig (1.74s)
01:39:02 [2019-10-14T01:39:02.998Z]     ipcmode_linux_test.go:230: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonIpcModePrivateFromConfig"
01:39:02 [2019-10-14T01:39:02.998Z]     ipcmode_linux_test.go:258: [testDaemonIpcPrivateShareable] ipcdev: 0:71, shared: false, mustBeShared: false
01:39:02 [2019-10-14T01:39:02.998Z] === RUN   TestDaemonIpcModeShareableFromConfig
01:39:04 [2019-10-14T01:39:04.490Z] --- PASS: TestDaemonIpcModeShareableFromConfig (1.81s)
01:39:04 [2019-10-14T01:39:04.490Z]     ipcmode_linux_test.go:230: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonIpcModeShareableFromConfig"
01:39:04 [2019-10-14T01:39:04.490Z]     ipcmode_linux_test.go:258: [testDaemonIpcPrivateShareable] ipcdev: 0:65, shared: true, mustBeShared: true
01:39:04 [2019-10-14T01:39:04.490Z] === RUN   TestIpcModeOlderClient
01:39:04 [2019-10-14T01:39:04.490Z] === PAUSE TestIpcModeOlderClient
01:39:04 [2019-10-14T01:39:04.490Z] === RUN   TestKillContainerInvalidSignal
01:39:05 [2019-10-14T01:39:05.120Z] --- PASS: TestKillContainerInvalidSignal (0.73s)
01:39:05 [2019-10-14T01:39:05.120Z] === RUN   TestKillContainer
01:39:05 [2019-10-14T01:39:05.120Z] === RUN   TestKillContainer/no_signal
01:39:05 [2019-10-14T01:39:05.736Z] === RUN   TestKillContainer/non_killing_signal
01:39:06 [2019-10-14T01:39:06.354Z] === RUN   TestKillContainer/killing_signal
01:39:07 [2019-10-14T01:39:07.367Z] --- PASS: TestKillContainer (2.07s)
01:39:07 [2019-10-14T01:39:07.367Z]     --- PASS: TestKillContainer/no_signal (0.66s)
01:39:07 [2019-10-14T01:39:07.367Z]     --- PASS: TestKillContainer/non_killing_signal (0.47s)
01:39:07 [2019-10-14T01:39:07.367Z]     --- PASS: TestKillContainer/killing_signal (0.65s)
01:39:07 [2019-10-14T01:39:07.367Z] === RUN   TestKillWithStopSignalAndRestartPolicies
01:39:07 [2019-10-14T01:39:07.367Z] === RUN   TestKillWithStopSignalAndRestartPolicies/same-signal-disables-restart-policy
01:39:07 [2019-10-14T01:39:07.989Z] === RUN   TestKillWithStopSignalAndRestartPolicies/different-signal-keep-restart-policy
01:39:08 [2019-10-14T01:39:08.608Z] --- PASS: TestKillWithStopSignalAndRestartPolicies (1.39s)
01:39:08 [2019-10-14T01:39:08.608Z]     --- PASS: TestKillWithStopSignalAndRestartPolicies/same-signal-disables-restart-policy (0.64s)
01:39:08 [2019-10-14T01:39:08.608Z]     --- PASS: TestKillWithStopSignalAndRestartPolicies/different-signal-keep-restart-policy (0.48s)
01:39:08 [2019-10-14T01:39:08.608Z] === RUN   TestKillStoppedContainer
01:39:08 [2019-10-14T01:39:08.608Z] --- PASS: TestKillStoppedContainer (0.08s)
01:39:08 [2019-10-14T01:39:08.608Z] === RUN   TestKillStoppedContainerAPIPre120
01:39:08 [2019-10-14T01:39:08.897Z] --- PASS: TestKillStoppedContainerAPIPre120 (0.07s)
01:39:08 [2019-10-14T01:39:08.897Z] === RUN   TestKillDifferentUserContainer
01:39:09 [2019-10-14T01:39:09.530Z] --- PASS: TestKillDifferentUserContainer (0.72s)
01:39:09 [2019-10-14T01:39:09.530Z] === RUN   TestInspectOomKilledTrue
01:39:11 [2019-10-14T01:39:11.011Z] --- PASS: TestInspectOomKilledTrue (1.23s)
01:39:11 [2019-10-14T01:39:11.011Z] === RUN   TestInspectOomKilledFalse
01:39:11 [2019-10-14T01:39:11.629Z] --- PASS: TestInspectOomKilledFalse (0.75s)
01:39:11 [2019-10-14T01:39:11.629Z] === RUN   TestLinksEtcHostsContentMatch
01:39:12 [2019-10-14T01:39:12.248Z] --- PASS: TestLinksEtcHostsContentMatch (0.62s)
01:39:12 [2019-10-14T01:39:12.248Z] === RUN   TestLinksContainerNames
01:39:13 [2019-10-14T01:39:13.395Z] --- PASS: TestLinksContainerNames (1.34s)
01:39:13 [2019-10-14T01:39:13.395Z] === RUN   TestLogsFollowTailEmpty
01:39:14 [2019-10-14T01:39:14.408Z] --- PASS: TestLogsFollowTailEmpty (0.73s)
01:39:14 [2019-10-14T01:39:14.408Z] === RUN   TestContainerNetworkMountsNoChown
01:39:14 [2019-10-14T01:39:14.693Z] --- PASS: TestContainerNetworkMountsNoChown (0.66s)
01:39:14 [2019-10-14T01:39:14.693Z] === RUN   TestMountDaemonRoot
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/default
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/default
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/private
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/private
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rprivate
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rprivate
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/slave
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/slave
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rslave
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rslave
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/shared
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/shared
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rshared
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rshared
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/default
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/rslave
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/rprivate
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rslave/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rprivate/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rslave/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rslave/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rprivate/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rslave/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/default/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rprivate/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/default/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/private
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/default/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rslave/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/default/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rslave/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/default/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rslave/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rslave/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/private/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/private/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/private/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/private/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/private/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/private/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/private/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/private/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/slave
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/slave/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/slave/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/slave/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/slave/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/slave/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/slave/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/slave/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/slave/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/default/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/shared
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/default/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/default/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rprivate/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rprivate/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/shared/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rprivate/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/shared/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rprivate/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/shared/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/rshared
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/shared/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rshared/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/shared/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rshared/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/shared/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rshared/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/shared/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/shared/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rprivate/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/private/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rshared/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rshared/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rshared/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === RUN   TestMountDaemonRoot/rshared/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === PAUSE TestMountDaemonRoot/rshared/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/slave/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/rslave/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/rslave/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/rslave/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/rslave/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/private/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/private/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/private/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/default/bind_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/slave/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/slave/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/slave/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/default/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/default/mount_root
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/default/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/shared/mount_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/rprivate/bind_subpath
01:39:14 [2019-10-14T01:39:14.981Z] === CONT  TestMountDaemonRoot/rshared/bind_root
01:39:14 [2019-10-14T01:39:14.982Z] === CONT  TestMountDaemonRoot/shared/mount_root
01:39:14 [2019-10-14T01:39:14.982Z] === CONT  TestMountDaemonRoot/shared/bind_subpath
01:39:15 [2019-10-14T01:39:15.268Z] === CONT  TestMountDaemonRoot/shared/bind_root
01:39:15 [2019-10-14T01:39:15.268Z] === CONT  TestMountDaemonRoot/rprivate/mount_subpath
01:39:15 [2019-10-14T01:39:15.268Z] === CONT  TestMountDaemonRoot/rprivate/bind_root
01:39:15 [2019-10-14T01:39:15.268Z] === CONT  TestMountDaemonRoot/rprivate/mount_root
01:39:15 [2019-10-14T01:39:15.268Z] === CONT  TestMountDaemonRoot/rshared/mount_root
01:39:15 [2019-10-14T01:39:15.268Z] === CONT  TestMountDaemonRoot/rshared/mount_subpath
01:39:15 [2019-10-14T01:39:15.268Z] === CONT  TestMountDaemonRoot/rshared/bind_subpath
01:39:15 [2019-10-14T01:39:15.268Z] --- PASS: TestMountDaemonRoot (0.04s)
01:39:15 [2019-10-14T01:39:15.268Z]     --- PASS: TestMountDaemonRoot/rslave (0.00s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rslave/mount_subpath (0.07s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rslave/bind_root (0.09s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rslave/mount_root (0.07s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rslave/bind_subpath (0.06s)
01:39:15 [2019-10-14T01:39:15.268Z]     --- PASS: TestMountDaemonRoot/private (0.00s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/private/bind_root (0.05s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/private/mount_subpath (0.05s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/private/bind_subpath (0.03s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/private/mount_root (0.04s)
01:39:15 [2019-10-14T01:39:15.268Z]     --- PASS: TestMountDaemonRoot/slave (0.00s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/slave/bind_root (0.03s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/slave/mount_subpath (0.03s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/slave/bind_subpath (0.03s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/slave/mount_root (0.04s)
01:39:15 [2019-10-14T01:39:15.268Z]     --- PASS: TestMountDaemonRoot/default (0.00s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/default/bind_root (0.06s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/default/mount_root (0.06s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/default/mount_subpath (0.07s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/default/bind_subpath (0.07s)
01:39:15 [2019-10-14T01:39:15.268Z]     --- PASS: TestMountDaemonRoot/shared (0.00s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/shared/mount_subpath (0.03s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/shared/mount_root (0.04s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/shared/bind_subpath (0.04s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/shared/bind_root (0.04s)
01:39:15 [2019-10-14T01:39:15.268Z]     --- PASS: TestMountDaemonRoot/rprivate (0.00s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rprivate/bind_subpath (0.06s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rprivate/mount_subpath (0.03s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rprivate/bind_root (0.03s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rprivate/mount_root (0.03s)
01:39:15 [2019-10-14T01:39:15.268Z]     --- PASS: TestMountDaemonRoot/rshared (0.00s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rshared/bind_root (0.08s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rshared/mount_root (0.05s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rshared/mount_subpath (0.05s)
01:39:15 [2019-10-14T01:39:15.268Z]         --- PASS: TestMountDaemonRoot/rshared/bind_subpath (0.06s)
01:39:15 [2019-10-14T01:39:15.268Z] === RUN   TestContainerBindMountNonRecursive
01:39:16 [2019-10-14T01:39:16.746Z] --- PASS: TestContainerBindMountNonRecursive (1.59s)
01:39:16 [2019-10-14T01:39:16.746Z] === RUN   TestNetworkNat
01:39:17 [2019-10-14T01:39:17.755Z] --- PASS: TestNetworkNat (0.72s)
01:39:17 [2019-10-14T01:39:17.755Z] === RUN   TestNetworkLocalhostTCPNat
01:39:18 [2019-10-14T01:39:18.378Z] --- PASS: TestNetworkLocalhostTCPNat (0.76s)
01:39:18 [2019-10-14T01:39:18.378Z] === RUN   TestNetworkLoopbackNat
01:39:19 [2019-10-14T01:39:19.393Z] --- PASS: TestNetworkLoopbackNat (1.04s)
01:39:19 [2019-10-14T01:39:19.393Z] === RUN   TestPause
01:39:20 [2019-10-14T01:39:20.012Z] --- PASS: TestPause (0.76s)
01:39:20 [2019-10-14T01:39:20.012Z] === RUN   TestPauseFailsOnWindowsServerContainers
01:39:20 [2019-10-14T01:39:20.012Z] --- SKIP: TestPauseFailsOnWindowsServerContainers (0.00s)
01:39:20 [2019-10-14T01:39:20.012Z]     pause_test.go:54: testEnv.DaemonInfo.OSType != "windows" || testEnv.DaemonInfo.Isolation != "process"
01:39:20 [2019-10-14T01:39:20.012Z] === RUN   TestPauseStopPausedContainer
01:39:21 [2019-10-14T01:39:21.022Z] --- PASS: TestPauseStopPausedContainer (0.75s)
01:39:21 [2019-10-14T01:39:21.022Z] === RUN   TestPsFilter
01:39:21 [2019-10-14T01:39:21.022Z] --- PASS: TestPsFilter (0.16s)
01:39:21 [2019-10-14T01:39:21.022Z] === RUN   TestRemoveContainerWithRemovedVolume
01:39:21 [2019-10-14T01:39:21.641Z] --- PASS: TestRemoveContainerWithRemovedVolume (0.65s)
01:39:21 [2019-10-14T01:39:21.641Z] === RUN   TestRemoveContainerWithVolume
01:39:22 [2019-10-14T01:39:22.261Z] --- PASS: TestRemoveContainerWithVolume (0.67s)
01:39:22 [2019-10-14T01:39:22.261Z] === RUN   TestRemoveContainerRunning
01:39:22 [2019-10-14T01:39:22.882Z] --- PASS: TestRemoveContainerRunning (0.69s)
01:39:22 [2019-10-14T01:39:22.882Z] === RUN   TestRemoveContainerForceRemoveRunning
01:39:23 [2019-10-14T01:39:23.901Z] --- PASS: TestRemoveContainerForceRemoveRunning (0.69s)
01:39:23 [2019-10-14T01:39:23.901Z] === RUN   TestRemoveInvalidContainer
01:39:23 [2019-10-14T01:39:23.901Z] --- PASS: TestRemoveInvalidContainer (0.03s)
01:39:23 [2019-10-14T01:39:23.901Z] === RUN   TestRenameLinkedContainer
01:39:26 [2019-10-14T01:39:26.591Z] --- PASS: TestRenameLinkedContainer (2.79s)
01:39:26 [2019-10-14T01:39:26.592Z] === RUN   TestRenameStoppedContainer
01:39:27 [2019-10-14T01:39:27.211Z] --- PASS: TestRenameStoppedContainer (0.65s)
01:39:27 [2019-10-14T01:39:27.211Z] === RUN   TestRenameRunningContainerAndReuse
01:39:28 [2019-10-14T01:39:28.692Z] --- PASS: TestRenameRunningContainerAndReuse (1.36s)
01:39:28 [2019-10-14T01:39:28.692Z] === RUN   TestRenameInvalidName
01:39:29 [2019-10-14T01:39:29.308Z] --- PASS: TestRenameInvalidName (0.71s)
01:39:29 [2019-10-14T01:39:29.308Z] === RUN   TestRenameAnonymousContainer
01:39:31 [2019-10-14T01:39:31.995Z] --- PASS: TestRenameAnonymousContainer (2.59s)
01:39:31 [2019-10-14T01:39:31.995Z] === RUN   TestRenameContainerWithSameName
01:39:32 [2019-10-14T01:39:32.612Z] --- PASS: TestRenameContainerWithSameName (0.70s)
01:39:32 [2019-10-14T01:39:32.612Z] === RUN   TestRenameContainerWithLinkedContainer
01:39:34 [2019-10-14T01:39:34.118Z] --- PASS: TestRenameContainerWithLinkedContainer (1.48s)
01:39:34 [2019-10-14T01:39:34.118Z] === RUN   TestResize
01:39:34 [2019-10-14T01:39:34.736Z] --- PASS: TestResize (0.72s)
01:39:34 [2019-10-14T01:39:34.736Z] === RUN   TestResizeWithInvalidSize
01:39:35 [2019-10-14T01:39:35.359Z] --- PASS: TestResizeWithInvalidSize (0.72s)
01:39:35 [2019-10-14T01:39:35.359Z] === RUN   TestResizeWhenContainerNotStarted
01:39:35 [2019-10-14T01:39:35.979Z] --- PASS: TestResizeWhenContainerNotStarted (0.66s)
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === RUN   TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === PAUSE TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/kill-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/stop-daemon
01:39:35 [2019-10-14T01:39:35.979Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/kill-daemon
01:39:38 [2019-10-14T01:39:38.689Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/stop-daemon
01:39:38 [2019-10-14T01:39:38.689Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/stop-daemon
01:39:39 [2019-10-14T01:39:39.327Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/kill-daemon
01:39:39 [2019-10-14T01:39:39.624Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/stop-daemon
01:39:40 [2019-10-14T01:39:40.649Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/stop-daemon
01:39:41 [2019-10-14T01:39:41.676Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/kill-daemon
01:39:41 [2019-10-14T01:39:41.676Z] === CONT  TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/stop-daemon
01:39:43 [2019-10-14T01:39:43.722Z] === CONT  TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/kill-daemon
01:39:45 [2019-10-14T01:39:45.768Z] --- PASS: TestDaemonRestartKillContainers (0.00s)
01:39:45 [2019-10-14T01:39:45.768Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/stop-daemon (2.12s)
01:39:45 [2019-10-14T01:39:45.768Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/stop-daemon"
01:39:45 [2019-10-14T01:39:45.768Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/kill-daemon (2.12s)
01:39:45 [2019-10-14T01:39:45.768Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/kill-daemon"
01:39:45 [2019-10-14T01:39:45.768Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/kill-daemon (3.31s)
01:39:45 [2019-10-14T01:39:45.768Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/kill-daemon"
01:39:45 [2019-10-14T01:39:45.768Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/kill-daemon (3.38s)
01:39:45 [2019-10-14T01:39:45.768Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/kill-daemon"
01:39:45 [2019-10-14T01:39:45.768Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/stop-daemon (2.18s)
01:39:45 [2019-10-14T01:39:45.768Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=false/container_created_should_not_be_restarted/stop-daemon"
01:39:45 [2019-10-14T01:39:45.768Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/kill-daemon (2.09s)
01:39:45 [2019-10-14T01:39:45.768Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=true/container_created_should_not_be_restarted/kill-daemon"
01:39:45 [2019-10-14T01:39:45.768Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/stop-daemon (3.48s)
01:39:45 [2019-10-14T01:39:45.768Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=true/container_with_restart=always/stop-daemon"
01:39:45 [2019-10-14T01:39:45.768Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/stop-daemon (2.98s)
01:39:45 [2019-10-14T01:39:45.768Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/stop-daemon"
01:39:45 [2019-10-14T01:39:45.768Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/stop-daemon (4.36s)
01:39:45 [2019-10-14T01:39:45.768Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/stop-daemon"
01:39:45 [2019-10-14T01:39:45.768Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/stop-daemon (3.20s)
01:39:45 [2019-10-14T01:39:45.768Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=false/container_without_restart_policy/stop-daemon"
01:39:45 [2019-10-14T01:39:45.769Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/kill-daemon (3.86s)
01:39:45 [2019-10-14T01:39:45.769Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=false/container_with_restart=always/kill-daemon"
01:39:45 [2019-10-14T01:39:45.769Z]     --- PASS: TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/kill-daemon (2.40s)
01:39:45 [2019-10-14T01:39:45.769Z]         restart_test.go:67: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartKillContainers/live-restore=true/container_without_restart_policy/kill-daemon"
01:39:45 [2019-10-14T01:39:45.769Z] === RUN   TestCgroupNamespacesRun
01:39:47 [2019-10-14T01:39:47.800Z] --- PASS: TestCgroupNamespacesRun (1.72s)
01:39:47 [2019-10-14T01:39:47.800Z]     run_cgroupns_linux_test.go:30: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCgroupNamespacesRun"
01:39:47 [2019-10-14T01:39:47.800Z] === RUN   TestCgroupNamespacesRunPrivileged
01:39:49 [2019-10-14T01:39:49.288Z] --- PASS: TestCgroupNamespacesRunPrivileged (1.72s)
01:39:49 [2019-10-14T01:39:49.288Z]     run_cgroupns_linux_test.go:30: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCgroupNamespacesRunPrivileged"
01:39:49 [2019-10-14T01:39:49.288Z] === RUN   TestCgroupNamespacesRunDaemonHostMode
01:39:51 [2019-10-14T01:39:51.344Z] --- PASS: TestCgroupNamespacesRunDaemonHostMode (1.70s)
01:39:51 [2019-10-14T01:39:51.344Z]     run_cgroupns_linux_test.go:30: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCgroupNamespacesRunDaemonHostMode"
01:39:51 [2019-10-14T01:39:51.344Z] === RUN   TestCgroupNamespacesRunHostMode
01:39:52 [2019-10-14T01:39:52.827Z] --- PASS: TestCgroupNamespacesRunHostMode (1.72s)
01:39:52 [2019-10-14T01:39:52.827Z]     run_cgroupns_linux_test.go:30: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCgroupNamespacesRunHostMode"
01:39:52 [2019-10-14T01:39:52.827Z] === RUN   TestCgroupNamespacesRunPrivateMode
01:39:54 [2019-10-14T01:39:54.314Z] --- PASS: TestCgroupNamespacesRunPrivateMode (1.76s)
01:39:54 [2019-10-14T01:39:54.314Z]     run_cgroupns_linux_test.go:30: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCgroupNamespacesRunPrivateMode"
01:39:54 [2019-10-14T01:39:54.314Z] === RUN   TestCgroupNamespacesRunPrivilegedAndPrivate
01:39:55 [2019-10-14T01:39:55.341Z] --- PASS: TestCgroupNamespacesRunPrivilegedAndPrivate (0.92s)
01:39:55 [2019-10-14T01:39:55.341Z]     run_cgroupns_linux_test.go:48: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCgroupNamespacesRunPrivilegedAndPrivate"
01:39:55 [2019-10-14T01:39:55.341Z] === RUN   TestCgroupNamespacesRunInvalidMode
01:39:56 [2019-10-14T01:39:56.373Z] --- PASS: TestCgroupNamespacesRunInvalidMode (0.95s)
01:39:56 [2019-10-14T01:39:56.373Z]     run_cgroupns_linux_test.go:48: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCgroupNamespacesRunInvalidMode"
01:39:56 [2019-10-14T01:39:56.373Z] === RUN   TestCgroupNamespacesRunOlderClient
01:39:58 [2019-10-14T01:39:58.402Z] --- PASS: TestCgroupNamespacesRunOlderClient (1.74s)
01:39:58 [2019-10-14T01:39:58.402Z]     run_cgroupns_linux_test.go:139: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCgroupNamespacesRunOlderClient"
01:39:58 [2019-10-14T01:39:58.402Z] === RUN   TestKernelTCPMemory
01:39:59 [2019-10-14T01:39:59.024Z] --- PASS: TestKernelTCPMemory (0.98s)
01:39:59 [2019-10-14T01:39:59.024Z] === RUN   TestNISDomainname
01:40:00 [2019-10-14T01:40:00.038Z] --- PASS: TestNISDomainname (1.00s)
01:40:00 [2019-10-14T01:40:00.038Z] === RUN   TestHostnameDnsResolution
01:40:01 [2019-10-14T01:40:01.055Z] --- PASS: TestHostnameDnsResolution (1.16s)
01:40:01 [2019-10-14T01:40:01.055Z] === RUN   TestStats
01:40:03 [2019-10-14T01:40:03.738Z] --- PASS: TestStats (2.51s)
01:40:03 [2019-10-14T01:40:03.738Z] === RUN   TestStopContainerWithTimeout
01:40:03 [2019-10-14T01:40:03.738Z] === RUN   TestStopContainerWithTimeout/0
01:40:03 [2019-10-14T01:40:03.738Z] === PAUSE TestStopContainerWithTimeout/0
01:40:03 [2019-10-14T01:40:03.738Z] === RUN   TestStopContainerWithTimeout/1
01:40:03 [2019-10-14T01:40:03.738Z] === PAUSE TestStopContainerWithTimeout/1
01:40:03 [2019-10-14T01:40:03.738Z] === RUN   TestStopContainerWithTimeout/3
01:40:03 [2019-10-14T01:40:03.738Z] === PAUSE TestStopContainerWithTimeout/3
01:40:03 [2019-10-14T01:40:03.738Z] === RUN   TestStopContainerWithTimeout/-1
01:40:03 [2019-10-14T01:40:03.738Z] === PAUSE TestStopContainerWithTimeout/-1
01:40:03 [2019-10-14T01:40:03.738Z] === CONT  TestStopContainerWithTimeout/0
01:40:03 [2019-10-14T01:40:03.738Z] === CONT  TestStopContainerWithTimeout/1
01:40:03 [2019-10-14T01:40:03.738Z] === CONT  TestStopContainerWithTimeout/3
01:40:03 [2019-10-14T01:40:03.738Z] === CONT  TestStopContainerWithTimeout/-1
01:40:07 [2019-10-14T01:40:07.214Z] --- PASS: TestStopContainerWithTimeout (0.03s)
01:40:07 [2019-10-14T01:40:07.214Z]     --- PASS: TestStopContainerWithTimeout/0 (1.40s)
01:40:07 [2019-10-14T01:40:07.214Z]     --- PASS: TestStopContainerWithTimeout/1 (2.40s)
01:40:07 [2019-10-14T01:40:07.214Z]     --- PASS: TestStopContainerWithTimeout/-1 (2.91s)
01:40:07 [2019-10-14T01:40:07.214Z]     --- PASS: TestStopContainerWithTimeout/3 (3.24s)
01:40:07 [2019-10-14T01:40:07.214Z] === RUN   TestDeleteDevicemapper
01:40:07 [2019-10-14T01:40:07.214Z] --- SKIP: TestDeleteDevicemapper (0.00s)
01:40:07 [2019-10-14T01:40:07.214Z]     stop_linux_test.go:74: testEnv.DaemonInfo.Driver != "devicemapper"
01:40:07 [2019-10-14T01:40:07.214Z] === RUN   TestStopContainerWithRestartPolicyAlways
01:40:09 [2019-10-14T01:40:09.910Z] --- PASS: TestStopContainerWithRestartPolicyAlways (2.97s)
01:40:09 [2019-10-14T01:40:09.910Z] === RUN   TestUpdateMemory
01:40:10 [2019-10-14T01:40:10.925Z] --- PASS: TestUpdateMemory (1.07s)
01:40:10 [2019-10-14T01:40:10.925Z] === RUN   TestUpdateCPUQuota
01:40:12 [2019-10-14T01:40:12.960Z] --- PASS: TestUpdateCPUQuota (1.54s)
01:40:12 [2019-10-14T01:40:12.960Z] === RUN   TestUpdatePidsLimit
01:40:12 [2019-10-14T01:40:12.960Z] === RUN   TestUpdatePidsLimit/update_from_none
01:40:12 [2019-10-14T01:40:12.960Z] === RUN   TestUpdatePidsLimit/no_change
01:40:13 [2019-10-14T01:40:13.254Z] === RUN   TestUpdatePidsLimit/update_lower
01:40:13 [2019-10-14T01:40:13.878Z] === RUN   TestUpdatePidsLimit/update_on_old_api_ignores_value
01:40:14 [2019-10-14T01:40:14.163Z] === RUN   TestUpdatePidsLimit/unset_limit_with_zero
01:40:14 [2019-10-14T01:40:14.446Z] === RUN   TestUpdatePidsLimit/unset_limit_with_minus_one
01:40:14 [2019-10-14T01:40:14.731Z] === RUN   TestUpdatePidsLimit/unset_limit_with_minus_two
01:40:16 [2019-10-14T01:40:16.771Z] --- PASS: TestUpdatePidsLimit (3.89s)
01:40:16 [2019-10-14T01:40:16.771Z]     --- PASS: TestUpdatePidsLimit/update_from_none (0.38s)
01:40:16 [2019-10-14T01:40:16.771Z]     --- PASS: TestUpdatePidsLimit/no_change (0.39s)
01:40:16 [2019-10-14T01:40:16.771Z]     --- PASS: TestUpdatePidsLimit/update_lower (0.38s)
01:40:16 [2019-10-14T01:40:16.771Z]     --- PASS: TestUpdatePidsLimit/update_on_old_api_ignores_value (0.36s)
01:40:16 [2019-10-14T01:40:16.771Z]     --- PASS: TestUpdatePidsLimit/unset_limit_with_zero (0.38s)
01:40:16 [2019-10-14T01:40:16.771Z]     --- PASS: TestUpdatePidsLimit/unset_limit_with_minus_one (0.39s)
01:40:16 [2019-10-14T01:40:16.771Z]     --- PASS: TestUpdatePidsLimit/unset_limit_with_minus_two (0.38s)
01:40:16 [2019-10-14T01:40:16.771Z] === RUN   TestUpdateRestartPolicy
01:40:29 [2019-10-14T01:40:29.302Z] --- PASS: TestUpdateRestartPolicy (12.10s)
01:40:29 [2019-10-14T01:40:29.302Z] === RUN   TestUpdateRestartWithAutoRemove
01:40:29 [2019-10-14T01:40:29.302Z] --- PASS: TestUpdateRestartWithAutoRemove (0.74s)
01:40:29 [2019-10-14T01:40:29.302Z] === RUN   TestWaitNonBlocked
01:40:29 [2019-10-14T01:40:29.302Z] === RUN   TestWaitNonBlocked/wait-nonblocking-exit-0
01:40:29 [2019-10-14T01:40:29.302Z] === PAUSE TestWaitNonBlocked/wait-nonblocking-exit-0
01:40:29 [2019-10-14T01:40:29.302Z] === RUN   TestWaitNonBlocked/wait-nonblocking-exit-random
01:40:29 [2019-10-14T01:40:29.302Z] === PAUSE TestWaitNonBlocked/wait-nonblocking-exit-random
01:40:29 [2019-10-14T01:40:29.302Z] === CONT  TestWaitNonBlocked/wait-nonblocking-exit-0
01:40:29 [2019-10-14T01:40:29.302Z] === CONT  TestWaitNonBlocked/wait-nonblocking-exit-random
01:40:30 [2019-10-14T01:40:30.323Z] --- PASS: TestWaitNonBlocked (0.03s)
01:40:30 [2019-10-14T01:40:30.323Z]     --- PASS: TestWaitNonBlocked/wait-nonblocking-exit-random (0.94s)
01:40:30 [2019-10-14T01:40:30.323Z]     --- PASS: TestWaitNonBlocked/wait-nonblocking-exit-0 (0.99s)
01:40:30 [2019-10-14T01:40:30.323Z] === RUN   TestWaitBlocked
01:40:30 [2019-10-14T01:40:30.323Z] === RUN   TestWaitBlocked/test-wait-blocked-exit-zero
01:40:30 [2019-10-14T01:40:30.323Z] === PAUSE TestWaitBlocked/test-wait-blocked-exit-zero
01:40:30 [2019-10-14T01:40:30.323Z] === RUN   TestWaitBlocked/test-wait-blocked-exit-random
01:40:30 [2019-10-14T01:40:30.323Z] === PAUSE TestWaitBlocked/test-wait-blocked-exit-random
01:40:30 [2019-10-14T01:40:30.323Z] === CONT  TestWaitBlocked/test-wait-blocked-exit-zero
01:40:30 [2019-10-14T01:40:30.323Z] === CONT  TestWaitBlocked/test-wait-blocked-exit-random
01:40:31 [2019-10-14T01:40:31.345Z] --- PASS: TestWaitBlocked (0.03s)
01:40:31 [2019-10-14T01:40:31.345Z]     --- PASS: TestWaitBlocked/test-wait-blocked-exit-zero (1.00s)
01:40:31 [2019-10-14T01:40:31.345Z]     --- PASS: TestWaitBlocked/test-wait-blocked-exit-random (1.03s)
01:40:31 [2019-10-14T01:40:31.345Z] === CONT  TestContainerStartOnDaemonRestart
01:40:31 [2019-10-14T01:40:31.345Z] === CONT  TestIpcModeOlderClient
01:40:31 [2019-10-14T01:40:31.345Z] === CONT  TestDaemonRestartIpcMode
01:40:31 [2019-10-14T01:40:31.630Z] --- PASS: TestIpcModeOlderClient (0.14s)
01:40:35 [2019-10-14T01:40:35.104Z] --- PASS: TestContainerStartOnDaemonRestart (3.17s)
01:40:35 [2019-10-14T01:40:35.104Z]     daemon_linux_test.go:35: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestContainerStartOnDaemonRestart"
01:40:35 [2019-10-14T01:40:35.104Z] --- PASS: TestDaemonRestartIpcMode (3.77s)
01:40:35 [2019-10-14T01:40:35.104Z]     daemon_linux_test.go:89: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartIpcMode"
01:40:35 [2019-10-14T01:40:35.104Z] PASS
01:40:35 [2019-10-14T01:40:35.104Z] 
01:40:35 [2019-10-14T01:40:35.104Z] === Skipped
01:40:35 [2019-10-14T01:40:35.104Z] === SKIP: ppc64le.integration.container TestCheckpoint (0.00s)
01:40:35 [2019-10-14T01:40:35.104Z]     checkpoint_test.go:33: TestCheckpoint is broken; see https://github.com/moby/moby/issues/38963
01:40:35 [2019-10-14T01:40:35.104Z] 
01:40:35 [2019-10-14T01:40:35.104Z] === SKIP: ppc64le.integration.container TestPauseFailsOnWindowsServerContainers (0.00s)
01:40:35 [2019-10-14T01:40:35.104Z]     pause_test.go:54: testEnv.DaemonInfo.OSType != "windows" || testEnv.DaemonInfo.Isolation != "process"
01:40:35 [2019-10-14T01:40:35.104Z] 
01:40:35 [2019-10-14T01:40:35.104Z] === SKIP: ppc64le.integration.container TestDeleteDevicemapper (0.00s)
01:40:35 [2019-10-14T01:40:35.104Z]     stop_linux_test.go:74: testEnv.DaemonInfo.Driver != "devicemapper"
01:40:35 [2019-10-14T01:40:35.104Z] 
01:40:35 [2019-10-14T01:40:35.104Z] 
01:40:35 [2019-10-14T01:40:35.104Z] DONE 197 tests, 3 skipped in 121.131s
01:40:35 [2019-10-14T01:40:35.104Z] Running /go/src/github.com/docker/docker/integration/image (ppc64le.integration.image) flags=-test.v -test.timeout=120m 
01:40:35 [2019-10-14T01:40:35.104Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-image-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-image-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.image -t ./test.main -test.v -test.timeout=120m
01:40:35 [2019-10-14T01:40:35.104Z] ++ set -e
01:40:35 [2019-10-14T01:40:35.104Z] ++ '[' -n 0 ']'
01:40:35 [2019-10-14T01:40:35.104Z] ++ set -x
01:40:35 [2019-10-14T01:40:35.104Z] ++ 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=ppc64le 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/ppc64le-integration-image-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-image-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.image -t ./test.main -test.v -test.timeout=120m
01:40:35 [2019-10-14T01:40:35.387Z] INFO: Testing against a local daemon
01:40:35 [2019-10-14T01:40:35.387Z] === RUN   TestCommitInheritsEnv
01:40:35 [2019-10-14T01:40:35.671Z] --- PASS: TestCommitInheritsEnv (0.42s)
01:40:35 [2019-10-14T01:40:35.671Z] === RUN   TestImportExtremelyLargeImageWorks
01:40:35 [2019-10-14T01:40:35.671Z] === PAUSE TestImportExtremelyLargeImageWorks
01:40:35 [2019-10-14T01:40:35.671Z] === RUN   TestImagesFilterMultiReference
01:40:35 [2019-10-14T01:40:35.955Z] --- PASS: TestImagesFilterMultiReference (0.07s)
01:40:35 [2019-10-14T01:40:35.955Z] === RUN   TestImagePullPlatformInvalid
01:40:35 [2019-10-14T01:40:35.955Z] --- PASS: TestImagePullPlatformInvalid (0.06s)
01:40:35 [2019-10-14T01:40:35.955Z] === RUN   TestRemoveImageOrphaning
01:40:36 [2019-10-14T01:40:36.246Z] --- PASS: TestRemoveImageOrphaning (0.43s)
01:40:36 [2019-10-14T01:40:36.246Z] === RUN   TestRemoveImageGarbageCollector
01:40:36 [2019-10-14T01:40:36.246Z] --- SKIP: TestRemoveImageGarbageCollector (0.00s)
01:40:36 [2019-10-14T01:40:36.246Z]     remove_unix_test.go:36: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:40:36 [2019-10-14T01:40:36.246Z] === RUN   TestTagUnprefixedRepoByNameOrName
01:40:36 [2019-10-14T01:40:36.246Z] --- PASS: TestTagUnprefixedRepoByNameOrName (0.05s)
01:40:36 [2019-10-14T01:40:36.246Z] === RUN   TestTagInvalidReference
01:40:36 [2019-10-14T01:40:36.538Z] --- PASS: TestTagInvalidReference (0.05s)
01:40:36 [2019-10-14T01:40:36.538Z] === RUN   TestTagValidPrefixedRepo
01:40:36 [2019-10-14T01:40:36.538Z] --- PASS: TestTagValidPrefixedRepo (0.05s)
01:40:36 [2019-10-14T01:40:36.538Z] === RUN   TestTagExistedNameWithoutForce
01:40:36 [2019-10-14T01:40:36.538Z] --- PASS: TestTagExistedNameWithoutForce (0.05s)
01:40:36 [2019-10-14T01:40:36.538Z] === RUN   TestTagOfficialNames
01:40:36 [2019-10-14T01:40:36.538Z] --- PASS: TestTagOfficialNames (0.06s)
01:40:36 [2019-10-14T01:40:36.538Z] === RUN   TestTagMatchesDigest
01:40:36 [2019-10-14T01:40:36.538Z] --- PASS: TestTagMatchesDigest (0.05s)
01:40:36 [2019-10-14T01:40:36.538Z] === CONT  TestImportExtremelyLargeImageWorks
01:45:44 [2019-10-14T01:45:44.153Z] --- PASS: TestImportExtremelyLargeImageWorks (298.51s)
01:45:44 [2019-10-14T01:45:44.153Z]     import_test.go:26: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestImportExtremelyLargeImageWorks"
01:45:44 [2019-10-14T01:45:44.153Z] PASS
01:45:44 [2019-10-14T01:45:44.153Z] 
01:45:44 [2019-10-14T01:45:44.153Z] === Skipped
01:45:44 [2019-10-14T01:45:44.153Z] === SKIP: ppc64le.integration.image TestRemoveImageGarbageCollector (0.00s)
01:45:44 [2019-10-14T01:45:44.153Z]     remove_unix_test.go:36: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:45:44 [2019-10-14T01:45:44.153Z] 
01:45:44 [2019-10-14T01:45:44.153Z] 
01:45:44 [2019-10-14T01:45:44.153Z] DONE 12 tests, 1 skipped in 299.949s
01:45:44 [2019-10-14T01:45:44.153Z] Running /go/src/github.com/docker/docker/integration/network (ppc64le.integration.network) flags=-test.v -test.timeout=120m 
01:45:44 [2019-10-14T01:45:44.153Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-network-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-network-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.network -t ./test.main -test.v -test.timeout=120m
01:45:44 [2019-10-14T01:45:44.153Z] ++ set -e
01:45:44 [2019-10-14T01:45:44.153Z] ++ '[' -n 0 ']'
01:45:44 [2019-10-14T01:45:44.153Z] ++ set -x
01:45:44 [2019-10-14T01:45:44.153Z] ++ 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=ppc64le 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/ppc64le-integration-network-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-network-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.network -t ./test.main -test.v -test.timeout=120m
01:45:44 [2019-10-14T01:45:44.153Z] INFO: Testing against a local daemon
01:45:44 [2019-10-14T01:45:44.153Z] === RUN   TestNetworkCreateDelete
01:45:44 [2019-10-14T01:45:44.153Z] --- PASS: TestNetworkCreateDelete (0.26s)
01:45:44 [2019-10-14T01:45:44.153Z] === RUN   TestDockerNetworkDeletePreferID
01:45:44 [2019-10-14T01:45:44.153Z] --- PASS: TestDockerNetworkDeletePreferID (0.55s)
01:45:44 [2019-10-14T01:45:44.153Z] === RUN   TestInspectNetwork
01:45:44 [2019-10-14T01:45:44.153Z] === RUN   TestInspectNetwork/full_network_id
01:45:44 [2019-10-14T01:45:44.153Z] === RUN   TestInspectNetwork/partial_network_id
01:45:44 [2019-10-14T01:45:44.153Z] === RUN   TestInspectNetwork/network_name
01:45:44 [2019-10-14T01:45:44.153Z] === RUN   TestInspectNetwork/network_name_and_swarm_scope
01:45:44 [2019-10-14T01:45:44.439Z] --- PASS: TestInspectNetwork (8.32s)
01:45:44 [2019-10-14T01:45:44.439Z]     inspect_test.go:18: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestInspectNetwork"
01:45:44 [2019-10-14T01:45:44.439Z]     --- PASS: TestInspectNetwork/full_network_id (0.00s)
01:45:44 [2019-10-14T01:45:44.439Z]     --- PASS: TestInspectNetwork/partial_network_id (0.00s)
01:45:44 [2019-10-14T01:45:44.439Z]     --- PASS: TestInspectNetwork/network_name (0.00s)
01:45:44 [2019-10-14T01:45:44.439Z]     --- PASS: TestInspectNetwork/network_name_and_swarm_scope (0.00s)
01:45:44 [2019-10-14T01:45:44.439Z] === RUN   TestRunContainerWithBridgeNone
01:45:47 [2019-10-14T01:45:47.139Z] --- PASS: TestRunContainerWithBridgeNone (2.62s)
01:45:47 [2019-10-14T01:45:47.139Z]     network_test.go:25: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestRunContainerWithBridgeNone"
01:45:47 [2019-10-14T01:45:47.139Z] === RUN   TestNetworkInvalidJSON
01:45:47 [2019-10-14T01:45:47.139Z] === RUN   TestNetworkInvalidJSON//networks/create
01:45:47 [2019-10-14T01:45:47.139Z] === PAUSE TestNetworkInvalidJSON//networks/create
01:45:47 [2019-10-14T01:45:47.139Z] === RUN   TestNetworkInvalidJSON//networks/bridge/connect
01:45:47 [2019-10-14T01:45:47.139Z] === PAUSE TestNetworkInvalidJSON//networks/bridge/connect
01:45:47 [2019-10-14T01:45:47.139Z] === RUN   TestNetworkInvalidJSON//networks/bridge/disconnect
01:45:47 [2019-10-14T01:45:47.139Z] === PAUSE TestNetworkInvalidJSON//networks/bridge/disconnect
01:45:47 [2019-10-14T01:45:47.139Z] === CONT  TestNetworkInvalidJSON//networks/create
01:45:47 [2019-10-14T01:45:47.139Z] === CONT  TestNetworkInvalidJSON//networks/bridge/disconnect
01:45:47 [2019-10-14T01:45:47.139Z] === CONT  TestNetworkInvalidJSON//networks/bridge/connect
01:45:47 [2019-10-14T01:45:47.139Z] --- PASS: TestNetworkInvalidJSON (0.04s)
01:45:47 [2019-10-14T01:45:47.139Z]     --- PASS: TestNetworkInvalidJSON//networks/create (0.00s)
01:45:47 [2019-10-14T01:45:47.139Z]     --- PASS: TestNetworkInvalidJSON//networks/bridge/connect (0.00s)
01:45:47 [2019-10-14T01:45:47.139Z]     --- PASS: TestNetworkInvalidJSON//networks/bridge/disconnect (0.00s)
01:45:47 [2019-10-14T01:45:47.139Z] === RUN   TestDaemonRestartWithLiveRestore
01:45:48 [2019-10-14T01:45:48.164Z] --- PASS: TestDaemonRestartWithLiveRestore (1.07s)
01:45:48 [2019-10-14T01:45:48.164Z]     service_test.go:32: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartWithLiveRestore"
01:45:48 [2019-10-14T01:45:48.164Z] === RUN   TestDaemonDefaultNetworkPools
01:45:49 [2019-10-14T01:45:49.186Z] --- PASS: TestDaemonDefaultNetworkPools (0.77s)
01:45:49 [2019-10-14T01:45:49.186Z]     service_test.go:57: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonDefaultNetworkPools"
01:45:49 [2019-10-14T01:45:49.186Z] === RUN   TestDaemonRestartWithExistingNetwork
01:45:50 [2019-10-14T01:45:50.209Z] --- PASS: TestDaemonRestartWithExistingNetwork (1.24s)
01:45:50 [2019-10-14T01:45:50.209Z]     service_test.go:98: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartWithExistingNetwork"
01:45:50 [2019-10-14T01:45:50.209Z] === RUN   TestDaemonRestartWithExistingNetworkWithDefaultPoolRange
01:45:51 [2019-10-14T01:45:51.711Z] --- PASS: TestDaemonRestartWithExistingNetworkWithDefaultPoolRange (1.48s)
01:45:51 [2019-10-14T01:45:51.711Z]     service_test.go:131: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonRestartWithExistingNetworkWithDefaultPoolRange"
01:45:51 [2019-10-14T01:45:51.711Z] === RUN   TestDaemonWithBipAndDefaultNetworkPool
01:45:52 [2019-10-14T01:45:52.342Z] --- PASS: TestDaemonWithBipAndDefaultNetworkPool (0.58s)
01:45:52 [2019-10-14T01:45:52.342Z]     service_test.go:181: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonWithBipAndDefaultNetworkPool"
01:45:52 [2019-10-14T01:45:52.342Z] === RUN   TestServiceWithPredefinedNetwork
01:45:55 [2019-10-14T01:45:55.028Z] --- PASS: TestServiceWithPredefinedNetwork (2.43s)
01:45:55 [2019-10-14T01:45:55.028Z]     service_test.go:203: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestServiceWithPredefinedNetwork"
01:45:55 [2019-10-14T01:45:55.028Z] === RUN   TestServiceRemoveKeepsIngressNetwork
01:45:55 [2019-10-14T01:45:55.028Z] --- SKIP: TestServiceRemoveKeepsIngressNetwork (0.00s)
01:45:55 [2019-10-14T01:45:55.028Z]     service_test.go:230: FLAKY_TEST
01:45:55 [2019-10-14T01:45:55.028Z] === RUN   TestServiceWithDataPathPortInit
01:46:10 [2019-10-14T01:46:10.269Z] --- PASS: TestServiceWithDataPathPortInit (15.27s)
01:46:10 [2019-10-14T01:46:10.269Z]     service_test.go:323: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestServiceWithDataPathPortInit"
01:46:10 [2019-10-14T01:46:10.269Z]     service_test.go:355: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestServiceWithDataPathPortInit"
01:46:10 [2019-10-14T01:46:10.269Z] === RUN   TestServiceWithDefaultAddressPoolInit
01:46:18 [2019-10-14T01:46:18.658Z] --- PASS: TestServiceWithDefaultAddressPoolInit (7.30s)
01:46:18 [2019-10-14T01:46:18.658Z]     service_test.go:388: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestServiceWithDefaultAddressPoolInit"
01:46:18 [2019-10-14T01:46:18.658Z]     service_test.go:418: TestServiceWithDefaultAddressPoolInit: NetworkInspect: {Name:sthiraTestServiceWithDefaultAddressPoolInit ID:fu1zoat088h96eim4kjr8kzff Created:2019-10-14 01:46:11.120943414 +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[a845a61d28298eca5a40578561296664a1a465324ec27da81cba0e84391f6105:{Name:TestServiceTestServiceWithDefaultAddressPoolInit.1.ov82kbuo55eo1x3vz2e2ro0ta EndpointID:f76b3b001276310377aef4f97f58a7e87edaf29e25013cd7027b538527333bad MacAddress:02:42:14:14:00:03 IPv4Address:20.20.0.3/24 IPv6Address:} lb-sthiraTestServiceWithDefaultAddressPoolInit:{Name:sthiraTestServiceWithDefaultAddressPoolInit-endpoint EndpointID:6b82d4b722f92e7e0c3230ecf155dfaacfe208d14e2ad7010fd04d1cda7d9d9f 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:0b73973e0277 IP:127.0.0.1}] Services:map[TestServiceTestServiceWithDefaultAddressPoolInit:{VIP:20.20.0.2 Ports:[] LocalLBIndex:256 Tasks:[{Name:TestServiceTestServiceWithDefaultAddressPoolInit.1.ov82kbuo55eo1x3vz2e2ro0ta EndpointID:f76b3b001276310377aef4f97f58a7e87edaf29e25013cd7027b538527333bad EndpointIP:20.20.0.3 Info:map[Host IP:127.0.0.1]}]}]}
01:46:18 [2019-10-14T01:46:18.658Z] PASS
01:46:18 [2019-10-14T01:46:18.658Z] 
01:46:18 [2019-10-14T01:46:18.658Z] === Skipped
01:46:18 [2019-10-14T01:46:18.658Z] === SKIP: ppc64le.integration.network TestServiceRemoveKeepsIngressNetwork (0.00s)
01:46:18 [2019-10-14T01:46:18.658Z]     service_test.go:230: FLAKY_TEST
01:46:18 [2019-10-14T01:46:18.658Z] 
01:46:18 [2019-10-14T01:46:18.658Z] 
01:46:18 [2019-10-14T01:46:18.658Z] DONE 21 tests, 1 skipped in 42.126s
01:46:18 [2019-10-14T01:46:18.658Z] Running /go/src/github.com/docker/docker/integration/network/ipvlan (ppc64le.integration.network.ipvlan) flags=-test.v -test.timeout=120m 
01:46:18 [2019-10-14T01:46:18.658Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-network-ipvlan-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-network-ipvlan-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.network.ipvlan -t ./test.main -test.v -test.timeout=120m
01:46:18 [2019-10-14T01:46:18.658Z] ++ set -e
01:46:18 [2019-10-14T01:46:18.658Z] ++ '[' -n 0 ']'
01:46:18 [2019-10-14T01:46:18.658Z] ++ set -x
01:46:18 [2019-10-14T01:46:18.658Z] ++ 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=ppc64le 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/ppc64le-integration-network-ipvlan-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-network-ipvlan-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.network.ipvlan -t ./test.main -test.v -test.timeout=120m
01:46:18 [2019-10-14T01:46:18.658Z] INFO: Testing against a local daemon
01:46:18 [2019-10-14T01:46:18.658Z] === RUN   TestDockerNetworkIpvlanPersistance
01:46:18 [2019-10-14T01:46:18.942Z] --- PASS: TestDockerNetworkIpvlanPersistance (1.48s)
01:46:18 [2019-10-14T01:46:18.942Z]     ipvlan_test.go:28: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkIpvlanPersistance"
01:46:18 [2019-10-14T01:46:18.942Z] === RUN   TestDockerNetworkIpvlan
01:46:19 [2019-10-14T01:46:19.954Z] === RUN   TestDockerNetworkIpvlan/Subinterface
01:46:20 [2019-10-14T01:46:20.967Z] === RUN   TestDockerNetworkIpvlan/OverlapParent
01:46:21 [2019-10-14T01:46:21.603Z] === RUN   TestDockerNetworkIpvlan/L2NilParent
01:46:24 [2019-10-14T01:46:24.290Z] === RUN   TestDockerNetworkIpvlan/L2InternalMode
01:46:27 [2019-10-14T01:46:27.759Z] === RUN   TestDockerNetworkIpvlan/L3NilParent
01:46:30 [2019-10-14T01:46:30.478Z] === RUN   TestDockerNetworkIpvlan/L3InternalMode
01:46:33 [2019-10-14T01:46:33.949Z] === RUN   TestDockerNetworkIpvlan/L2MultiSubnet
01:46:38 [2019-10-14T01:46:38.362Z] === RUN   TestDockerNetworkIpvlan/L3MultiSubnet
01:46:43 [2019-10-14T01:46:43.873Z] === RUN   TestDockerNetworkIpvlan/Addressing
01:46:45 [2019-10-14T01:46:45.355Z] --- PASS: TestDockerNetworkIpvlan (26.41s)
01:46:45 [2019-10-14T01:46:45.355Z]     ipvlan_test.go:88: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkIpvlan"
01:46:45 [2019-10-14T01:46:45.355Z]     --- PASS: TestDockerNetworkIpvlan/Subinterface (0.10s)
01:46:45 [2019-10-14T01:46:45.355Z]     ipvlan_test.go:88: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkIpvlan"
01:46:45 [2019-10-14T01:46:45.355Z]     --- PASS: TestDockerNetworkIpvlan/OverlapParent (0.05s)
01:46:45 [2019-10-14T01:46:45.355Z]     ipvlan_test.go:88: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkIpvlan"
01:46:45 [2019-10-14T01:46:45.355Z]     --- PASS: TestDockerNetworkIpvlan/L2NilParent (1.17s)
01:46:45 [2019-10-14T01:46:45.355Z]     ipvlan_test.go:88: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkIpvlan"
01:46:45 [2019-10-14T01:46:45.355Z]     --- PASS: TestDockerNetworkIpvlan/L2InternalMode (2.16s)
01:46:45 [2019-10-14T01:46:45.355Z]     ipvlan_test.go:88: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkIpvlan"
01:46:45 [2019-10-14T01:46:45.355Z]     --- PASS: TestDockerNetworkIpvlan/L3NilParent (1.19s)
01:46:45 [2019-10-14T01:46:45.355Z]     ipvlan_test.go:88: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkIpvlan"
01:46:45 [2019-10-14T01:46:45.355Z]     --- PASS: TestDockerNetworkIpvlan/L3InternalMode (2.17s)
01:46:45 [2019-10-14T01:46:45.355Z]     ipvlan_test.go:88: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkIpvlan"
01:46:45 [2019-10-14T01:46:45.355Z]     --- PASS: TestDockerNetworkIpvlan/L2MultiSubnet (3.13s)
01:46:45 [2019-10-14T01:46:45.355Z]     ipvlan_test.go:88: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkIpvlan"
01:46:45 [2019-10-14T01:46:45.355Z]     --- PASS: TestDockerNetworkIpvlan/L3MultiSubnet (3.18s)
01:46:45 [2019-10-14T01:46:45.355Z]     ipvlan_test.go:88: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkIpvlan"
01:46:45 [2019-10-14T01:46:45.355Z]     --- PASS: TestDockerNetworkIpvlan/Addressing (1.95s)
01:46:45 [2019-10-14T01:46:45.355Z] PASS
01:46:45 [2019-10-14T01:46:45.355Z] 
01:46:45 [2019-10-14T01:46:45.355Z] DONE 11 tests in 27.989s
01:46:45 [2019-10-14T01:46:45.355Z] Running /go/src/github.com/docker/docker/integration/network/macvlan (ppc64le.integration.network.macvlan) flags=-test.v -test.timeout=120m 
01:46:45 [2019-10-14T01:46:45.355Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-network-macvlan-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-network-macvlan-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.network.macvlan -t ./test.main -test.v -test.timeout=120m
01:46:45 [2019-10-14T01:46:45.355Z] ++ set -e
01:46:45 [2019-10-14T01:46:45.355Z] ++ '[' -n 0 ']'
01:46:45 [2019-10-14T01:46:45.355Z] ++ set -x
01:46:45 [2019-10-14T01:46:45.355Z] ++ 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=ppc64le 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/ppc64le-integration-network-macvlan-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-network-macvlan-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.network.macvlan -t ./test.main -test.v -test.timeout=120m
01:46:45 [2019-10-14T01:46:45.355Z] INFO: Testing against a local daemon
01:46:45 [2019-10-14T01:46:45.355Z] === RUN   TestDockerNetworkMacvlanPersistance
01:46:46 [2019-10-14T01:46:46.844Z] --- PASS: TestDockerNetworkMacvlanPersistance (1.48s)
01:46:46 [2019-10-14T01:46:46.845Z]     macvlan_test.go:24: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkMacvlanPersistance"
01:46:46 [2019-10-14T01:46:46.845Z] === RUN   TestDockerNetworkMacvlan
01:46:47 [2019-10-14T01:46:47.868Z] === RUN   TestDockerNetworkMacvlan/Subinterface
01:46:48 [2019-10-14T01:46:48.882Z] === RUN   TestDockerNetworkMacvlan/OverlapParent
01:46:49 [2019-10-14T01:46:49.899Z] === RUN   TestDockerNetworkMacvlan/NilParent
01:46:52 [2019-10-14T01:46:52.596Z] === RUN   TestDockerNetworkMacvlan/InternalMode
01:46:56 [2019-10-14T01:46:56.194Z] === RUN   TestDockerNetworkMacvlan/MultiSubnet
01:47:00 [2019-10-14T01:47:00.605Z] === RUN   TestDockerNetworkMacvlan/Addressing
01:47:02 [2019-10-14T01:47:02.089Z] --- PASS: TestDockerNetworkMacvlan (15.14s)
01:47:02 [2019-10-14T01:47:02.089Z]     macvlan_test.go:70: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkMacvlan"
01:47:02 [2019-10-14T01:47:02.089Z]     --- PASS: TestDockerNetworkMacvlan/Subinterface (0.07s)
01:47:02 [2019-10-14T01:47:02.089Z]     macvlan_test.go:70: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkMacvlan"
01:47:02 [2019-10-14T01:47:02.089Z]     --- PASS: TestDockerNetworkMacvlan/OverlapParent (0.09s)
01:47:02 [2019-10-14T01:47:02.089Z]     macvlan_test.go:70: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkMacvlan"
01:47:02 [2019-10-14T01:47:02.089Z]     --- PASS: TestDockerNetworkMacvlan/NilParent (1.17s)
01:47:02 [2019-10-14T01:47:02.089Z]     macvlan_test.go:70: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkMacvlan"
01:47:02 [2019-10-14T01:47:02.089Z]     --- PASS: TestDockerNetworkMacvlan/InternalMode (2.18s)
01:47:02 [2019-10-14T01:47:02.089Z]     macvlan_test.go:70: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkMacvlan"
01:47:02 [2019-10-14T01:47:02.089Z]     --- PASS: TestDockerNetworkMacvlan/MultiSubnet (3.34s)
01:47:02 [2019-10-14T01:47:02.089Z]     macvlan_test.go:70: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkMacvlan"
01:47:02 [2019-10-14T01:47:02.089Z]     --- PASS: TestDockerNetworkMacvlan/Addressing (1.00s)
01:47:02 [2019-10-14T01:47:02.089Z] PASS
01:47:02 [2019-10-14T01:47:02.089Z] 
01:47:02 [2019-10-14T01:47:02.089Z] DONE 8 tests in 16.710s
01:47:02 [2019-10-14T01:47:02.089Z] Running /go/src/github.com/docker/docker/integration/plugin (ppc64le.integration.plugin) flags=-test.v -test.timeout=120m 
01:47:02 [2019-10-14T01:47:02.089Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin -t ./test.main -test.v -test.timeout=120m
01:47:02 [2019-10-14T01:47:02.089Z] ++ set -e
01:47:02 [2019-10-14T01:47:02.089Z] ++ '[' -n 0 ']'
01:47:02 [2019-10-14T01:47:02.089Z] ++ set -x
01:47:02 [2019-10-14T01:47:02.089Z] ++ 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=ppc64le 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/ppc64le-integration-plugin-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin -t ./test.main -test.v -test.timeout=120m
01:47:02 [2019-10-14T01:47:02.089Z] testing: warning: no tests to run
01:47:02 [2019-10-14T01:47:02.089Z] PASS
01:47:02 [2019-10-14T01:47:02.089Z] 
01:47:02 [2019-10-14T01:47:02.089Z] DONE 0 tests in 0.015s
01:47:02 [2019-10-14T01:47:02.089Z] Running /go/src/github.com/docker/docker/integration/plugin/authz (ppc64le.integration.plugin.authz) flags=-test.v -test.timeout=120m 
01:47:02 [2019-10-14T01:47:02.089Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-authz-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-authz-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin.authz -t ./test.main -test.v -test.timeout=120m
01:47:02 [2019-10-14T01:47:02.089Z] ++ set -e
01:47:02 [2019-10-14T01:47:02.089Z] ++ '[' -n 0 ']'
01:47:02 [2019-10-14T01:47:02.089Z] ++ set -x
01:47:02 [2019-10-14T01:47:02.089Z] ++ 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=ppc64le 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/ppc64le-integration-plugin-authz-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-authz-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin.authz -t ./test.main -test.v -test.timeout=120m
01:47:02 [2019-10-14T01:47:02.089Z] INFO: Testing against a local daemon
01:47:02 [2019-10-14T01:47:02.089Z] === RUN   TestAuthZPluginAllowRequest
01:47:04 [2019-10-14T01:47:04.128Z] --- PASS: TestAuthZPluginAllowRequest (1.59s)
01:47:04 [2019-10-14T01:47:04.128Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginAllowRequest"
01:47:04 [2019-10-14T01:47:04.128Z] === RUN   TestAuthZPluginTLS
01:47:04 [2019-10-14T01:47:04.430Z] --- PASS: TestAuthZPluginTLS (0.59s)
01:47:04 [2019-10-14T01:47:04.430Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginTLS"
01:47:04 [2019-10-14T01:47:04.430Z] === RUN   TestAuthZPluginDenyRequest
01:47:05 [2019-10-14T01:47:05.053Z] --- PASS: TestAuthZPluginDenyRequest (0.56s)
01:47:05 [2019-10-14T01:47:05.053Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginDenyRequest"
01:47:05 [2019-10-14T01:47:05.053Z] === RUN   TestAuthZPluginAPIDenyResponse
01:47:05 [2019-10-14T01:47:05.670Z] --- PASS: TestAuthZPluginAPIDenyResponse (0.57s)
01:47:05 [2019-10-14T01:47:05.670Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginAPIDenyResponse"
01:47:05 [2019-10-14T01:47:05.670Z] === RUN   TestAuthZPluginDenyResponse
01:47:05 [2019-10-14T01:47:05.954Z] --- PASS: TestAuthZPluginDenyResponse (0.58s)
01:47:05 [2019-10-14T01:47:05.954Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginDenyResponse"
01:47:05 [2019-10-14T01:47:05.954Z] === RUN   TestAuthZPluginAllowEventStream
01:47:07 [2019-10-14T01:47:07.996Z] --- PASS: TestAuthZPluginAllowEventStream (1.65s)
01:47:07 [2019-10-14T01:47:07.996Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginAllowEventStream"
01:47:07 [2019-10-14T01:47:07.996Z] === RUN   TestAuthZPluginErrorResponse
01:47:08 [2019-10-14T01:47:08.282Z] --- PASS: TestAuthZPluginErrorResponse (0.58s)
01:47:08 [2019-10-14T01:47:08.282Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginErrorResponse"
01:47:08 [2019-10-14T01:47:08.282Z] === RUN   TestAuthZPluginErrorRequest
01:47:08 [2019-10-14T01:47:08.901Z] --- PASS: TestAuthZPluginErrorRequest (0.56s)
01:47:08 [2019-10-14T01:47:08.901Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginErrorRequest"
01:47:08 [2019-10-14T01:47:08.901Z] === RUN   TestAuthZPluginEnsureNoDuplicatePluginRegistration
01:47:09 [2019-10-14T01:47:09.524Z] --- PASS: TestAuthZPluginEnsureNoDuplicatePluginRegistration (0.57s)
01:47:09 [2019-10-14T01:47:09.524Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginEnsureNoDuplicatePluginRegistration"
01:47:09 [2019-10-14T01:47:09.524Z] === RUN   TestAuthZPluginEnsureLoadImportWorking
01:47:11 [2019-10-14T01:47:11.564Z] --- PASS: TestAuthZPluginEnsureLoadImportWorking (2.14s)
01:47:11 [2019-10-14T01:47:11.564Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginEnsureLoadImportWorking"
01:47:11 [2019-10-14T01:47:11.564Z] === RUN   TestAuthzPluginEnsureContainerCopyToFrom
01:47:13 [2019-10-14T01:47:13.597Z] --- PASS: TestAuthzPluginEnsureContainerCopyToFrom (2.09s)
01:47:13 [2019-10-14T01:47:13.597Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthzPluginEnsureContainerCopyToFrom"
01:47:13 [2019-10-14T01:47:13.597Z] === RUN   TestAuthZPluginHeader
01:47:14 [2019-10-14T01:47:14.629Z] --- PASS: TestAuthZPluginHeader (0.93s)
01:47:14 [2019-10-14T01:47:14.629Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginHeader"
01:47:14 [2019-10-14T01:47:14.629Z] === RUN   TestAuthZPluginV2AllowNonVolumeRequest
01:47:14 [2019-10-14T01:47:14.629Z] --- SKIP: TestAuthZPluginV2AllowNonVolumeRequest (0.00s)
01:47:14 [2019-10-14T01:47:14.629Z]     authz_plugin_v2_test.go:43: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:47:14 [2019-10-14T01:47:14.629Z] === RUN   TestAuthZPluginV2Disable
01:47:14 [2019-10-14T01:47:14.629Z] --- SKIP: TestAuthZPluginV2Disable (0.00s)
01:47:14 [2019-10-14T01:47:14.629Z]     authz_plugin_v2_test.go:65: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:47:14 [2019-10-14T01:47:14.629Z] === RUN   TestAuthZPluginV2RejectVolumeRequests
01:47:14 [2019-10-14T01:47:14.629Z] --- SKIP: TestAuthZPluginV2RejectVolumeRequests (0.00s)
01:47:14 [2019-10-14T01:47:14.629Z]     authz_plugin_v2_test.go:91: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:47:14 [2019-10-14T01:47:14.629Z] === RUN   TestAuthZPluginV2BadManifestFailsDaemonStart
01:47:14 [2019-10-14T01:47:14.629Z] --- SKIP: TestAuthZPluginV2BadManifestFailsDaemonStart (0.00s)
01:47:14 [2019-10-14T01:47:14.629Z]     authz_plugin_v2_test.go:126: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:47:14 [2019-10-14T01:47:14.629Z] === RUN   TestAuthZPluginV2NonexistentFailsDaemonStart
01:47:33 [2019-10-14T01:47:33.091Z] --- PASS: TestAuthZPluginV2NonexistentFailsDaemonStart (16.88s)
01:47:33 [2019-10-14T01:47:33.091Z]     main_test.go:54: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestAuthZPluginV2NonexistentFailsDaemonStart"
01:47:33 [2019-10-14T01:47:33.091Z] PASS
01:47:33 [2019-10-14T01:47:33.091Z] 
01:47:33 [2019-10-14T01:47:33.091Z] === Skipped
01:47:33 [2019-10-14T01:47:33.091Z] === SKIP: ppc64le.integration.plugin.authz TestAuthZPluginV2AllowNonVolumeRequest (0.00s)
01:47:33 [2019-10-14T01:47:33.091Z]     authz_plugin_v2_test.go:43: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:47:33 [2019-10-14T01:47:33.091Z] 
01:47:33 [2019-10-14T01:47:33.091Z] === SKIP: ppc64le.integration.plugin.authz TestAuthZPluginV2Disable (0.00s)
01:47:33 [2019-10-14T01:47:33.091Z]     authz_plugin_v2_test.go:65: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:47:33 [2019-10-14T01:47:33.091Z] 
01:47:33 [2019-10-14T01:47:33.091Z] === SKIP: ppc64le.integration.plugin.authz TestAuthZPluginV2RejectVolumeRequests (0.00s)
01:47:33 [2019-10-14T01:47:33.091Z]     authz_plugin_v2_test.go:91: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:47:33 [2019-10-14T01:47:33.091Z] 
01:47:33 [2019-10-14T01:47:33.091Z] === SKIP: ppc64le.integration.plugin.authz TestAuthZPluginV2BadManifestFailsDaemonStart (0.00s)
01:47:33 [2019-10-14T01:47:33.091Z]     authz_plugin_v2_test.go:126: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:47:33 [2019-10-14T01:47:33.091Z] 
01:47:33 [2019-10-14T01:47:33.091Z] 
01:47:33 [2019-10-14T01:47:33.091Z] DONE 17 tests, 4 skipped in 29.417s
01:47:33 [2019-10-14T01:47:33.091Z] Running /go/src/github.com/docker/docker/integration/plugin/common (ppc64le.integration.plugin.common) flags=-test.v -test.timeout=120m 
01:47:33 [2019-10-14T01:47:33.091Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-common-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-common-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin.common -t ./test.main -test.v -test.timeout=120m
01:47:33 [2019-10-14T01:47:33.091Z] ++ set -e
01:47:33 [2019-10-14T01:47:33.091Z] ++ '[' -n 0 ']'
01:47:33 [2019-10-14T01:47:33.091Z] ++ set -x
01:47:33 [2019-10-14T01:47:33.092Z] ++ 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=ppc64le 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/ppc64le-integration-plugin-common-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-common-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin.common -t ./test.main -test.v -test.timeout=120m
01:47:33 [2019-10-14T01:47:33.092Z] INFO: Testing against a local daemon
01:47:33 [2019-10-14T01:47:33.092Z] === RUN   TestPluginInvalidJSON
01:47:33 [2019-10-14T01:47:33.092Z] === RUN   TestPluginInvalidJSON//plugins/foobar/set
01:47:33 [2019-10-14T01:47:33.092Z] === PAUSE TestPluginInvalidJSON//plugins/foobar/set
01:47:33 [2019-10-14T01:47:33.092Z] === CONT  TestPluginInvalidJSON//plugins/foobar/set
01:47:33 [2019-10-14T01:47:33.092Z] --- PASS: TestPluginInvalidJSON (0.05s)
01:47:33 [2019-10-14T01:47:33.092Z]     --- PASS: TestPluginInvalidJSON//plugins/foobar/set (0.00s)
01:47:33 [2019-10-14T01:47:33.092Z] PASS
01:47:33 [2019-10-14T01:47:33.092Z] 
01:47:33 [2019-10-14T01:47:33.092Z] DONE 2 tests in 0.133s
01:47:33 [2019-10-14T01:47:33.092Z] Running /go/src/github.com/docker/docker/integration/plugin/graphdriver (ppc64le.integration.plugin.graphdriver) flags=-test.v -test.timeout=120m 
01:47:33 [2019-10-14T01:47:33.092Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-graphdriver-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-graphdriver-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin.graphdriver -t ./test.main -test.v -test.timeout=120m
01:47:33 [2019-10-14T01:47:33.092Z] ++ set -e
01:47:33 [2019-10-14T01:47:33.092Z] ++ '[' -n 0 ']'
01:47:33 [2019-10-14T01:47:33.092Z] ++ set -x
01:47:33 [2019-10-14T01:47:33.092Z] ++ 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=ppc64le 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/ppc64le-integration-plugin-graphdriver-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-graphdriver-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin.graphdriver -t ./test.main -test.v -test.timeout=120m
01:47:33 [2019-10-14T01:47:33.092Z] INFO: Testing against a local daemon
01:47:33 [2019-10-14T01:47:33.092Z] === RUN   TestExternalGraphDriver
01:47:33 [2019-10-14T01:47:33.092Z] === RUN   TestExternalGraphDriver/json
01:47:34 [2019-10-14T01:47:34.106Z] === RUN   TestExternalGraphDriver/spec
01:47:36 [2019-10-14T01:47:36.140Z] === RUN   TestExternalGraphDriver/pull
01:47:38 [2019-10-14T01:47:38.819Z] --- PASS: TestExternalGraphDriver (6.92s)
01:47:38 [2019-10-14T01:47:38.819Z]     external_test.go:57: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestExternalGraphDriver"
01:47:38 [2019-10-14T01:47:38.819Z]     --- PASS: TestExternalGraphDriver/json (2.08s)
01:47:38 [2019-10-14T01:47:38.819Z]     --- PASS: TestExternalGraphDriver/spec (2.00s)
01:47:38 [2019-10-14T01:47:38.819Z]     --- PASS: TestExternalGraphDriver/pull (2.62s)
01:47:38 [2019-10-14T01:47:38.819Z] === RUN   TestGraphdriverPluginV2
01:47:38 [2019-10-14T01:47:38.819Z] --- SKIP: TestGraphdriverPluginV2 (0.06s)
01:47:38 [2019-10-14T01:47:38.819Z]     external_test.go:410: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:47:38 [2019-10-14T01:47:38.819Z] PASS
01:47:38 [2019-10-14T01:47:38.819Z] 
01:47:38 [2019-10-14T01:47:38.819Z] === Skipped
01:47:38 [2019-10-14T01:47:38.819Z] === SKIP: ppc64le.integration.plugin.graphdriver TestGraphdriverPluginV2 (0.06s)
01:47:38 [2019-10-14T01:47:38.819Z]     external_test.go:410: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:47:38 [2019-10-14T01:47:38.819Z] 
01:47:38 [2019-10-14T01:47:38.819Z] 
01:47:38 [2019-10-14T01:47:38.819Z] DONE 5 tests, 1 skipped in 7.082s
01:47:38 [2019-10-14T01:47:38.819Z] Running /go/src/github.com/docker/docker/integration/plugin/logging (ppc64le.integration.plugin.logging) flags=-test.v -test.timeout=120m 
01:47:38 [2019-10-14T01:47:38.819Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-logging-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-logging-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin.logging -t ./test.main -test.v -test.timeout=120m
01:47:38 [2019-10-14T01:47:38.819Z] ++ set -e
01:47:38 [2019-10-14T01:47:38.819Z] ++ '[' -n 0 ']'
01:47:38 [2019-10-14T01:47:38.819Z] ++ set -x
01:47:38 [2019-10-14T01:47:38.819Z] ++ 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=ppc64le 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/ppc64le-integration-plugin-logging-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-logging-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin.logging -t ./test.main -test.v -test.timeout=120m
01:47:38 [2019-10-14T01:47:38.819Z] INFO: Testing against a local daemon
01:47:38 [2019-10-14T01:47:38.819Z] === RUN   TestContinueAfterPluginCrash
01:47:38 [2019-10-14T01:47:38.819Z] === PAUSE TestContinueAfterPluginCrash
01:47:38 [2019-10-14T01:47:38.819Z] === RUN   TestDaemonStartWithLogOpt
01:47:38 [2019-10-14T01:47:38.819Z] === PAUSE TestDaemonStartWithLogOpt
01:47:38 [2019-10-14T01:47:38.819Z] === CONT  TestContinueAfterPluginCrash
01:47:38 [2019-10-14T01:47:38.819Z] === CONT  TestDaemonStartWithLogOpt
01:47:54 [2019-10-14T01:47:54.792Z] --- PASS: TestDaemonStartWithLogOpt (15.66s)
01:47:54 [2019-10-14T01:47:54.792Z]     validation_test.go:23: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDaemonStartWithLogOpt"
01:48:00 [2019-10-14T01:48:00.305Z] --- PASS: TestContinueAfterPluginCrash (20.46s)
01:48:00 [2019-10-14T01:48:00.305Z]     logging_linux_test.go:22: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestContinueAfterPluginCrash"
01:48:00 [2019-10-14T01:48:00.305Z] PASS
01:48:00 [2019-10-14T01:48:00.305Z] 
01:48:00 [2019-10-14T01:48:00.305Z] DONE 2 tests in 20.550s
01:48:00 [2019-10-14T01:48:00.305Z] Running /go/src/github.com/docker/docker/integration/plugin/volumes (ppc64le.integration.plugin.volumes) flags=-test.v -test.timeout=120m 
01:48:00 [2019-10-14T01:48:00.305Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-volumes-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-volumes-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin.volumes -t ./test.main -test.v -test.timeout=120m
01:48:00 [2019-10-14T01:48:00.305Z] ++ set -e
01:48:00 [2019-10-14T01:48:00.305Z] ++ '[' -n 0 ']'
01:48:00 [2019-10-14T01:48:00.305Z] ++ set -x
01:48:00 [2019-10-14T01:48:00.306Z] ++ 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=ppc64le 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/ppc64le-integration-plugin-volumes-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-plugin-volumes-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.plugin.volumes -t ./test.main -test.v -test.timeout=120m
01:48:00 [2019-10-14T01:48:00.306Z] INFO: Testing against a local daemon
01:48:00 [2019-10-14T01:48:00.306Z] === RUN   TestPluginWithDevMounts
01:48:00 [2019-10-14T01:48:00.306Z] === PAUSE TestPluginWithDevMounts
01:48:00 [2019-10-14T01:48:00.306Z] === CONT  TestPluginWithDevMounts
01:48:01 [2019-10-14T01:48:01.783Z] --- PASS: TestPluginWithDevMounts (2.32s)
01:48:01 [2019-10-14T01:48:01.784Z]     mounts_test.go:23: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestPluginWithDevMounts"
01:48:01 [2019-10-14T01:48:01.784Z] PASS
01:48:01 [2019-10-14T01:48:01.784Z] 
01:48:01 [2019-10-14T01:48:01.784Z] DONE 1 tests in 2.432s
01:48:01 [2019-10-14T01:48:01.784Z] Running /go/src/github.com/docker/docker/integration/secret (ppc64le.integration.secret) flags=-test.v -test.timeout=120m 
01:48:01 [2019-10-14T01:48:01.784Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-secret-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-secret-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.secret -t ./test.main -test.v -test.timeout=120m
01:48:01 [2019-10-14T01:48:01.784Z] ++ set -e
01:48:01 [2019-10-14T01:48:01.784Z] ++ '[' -n 0 ']'
01:48:01 [2019-10-14T01:48:01.784Z] ++ set -x
01:48:01 [2019-10-14T01:48:01.784Z] ++ 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=ppc64le 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/ppc64le-integration-secret-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-secret-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.secret -t ./test.main -test.v -test.timeout=120m
01:48:01 [2019-10-14T01:48:01.784Z] INFO: Testing against a local daemon
01:48:01 [2019-10-14T01:48:01.784Z] === RUN   TestSecretInspect
01:48:05 [2019-10-14T01:48:05.293Z] --- PASS: TestSecretInspect (2.72s)
01:48:05 [2019-10-14T01:48:05.293Z]     secret_test.go:25: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestSecretInspect"
01:48:05 [2019-10-14T01:48:05.293Z] === RUN   TestSecretList
01:48:06 [2019-10-14T01:48:06.781Z] --- PASS: TestSecretList (2.23s)
01:48:06 [2019-10-14T01:48:06.781Z]     secret_test.go:48: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestSecretList"
01:48:06 [2019-10-14T01:48:06.781Z] === RUN   TestSecretsCreateAndDelete
01:48:09 [2019-10-14T01:48:09.469Z] --- PASS: TestSecretsCreateAndDelete (2.15s)
01:48:09 [2019-10-14T01:48:09.469Z]     secret_test.go:125: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestSecretsCreateAndDelete"
01:48:09 [2019-10-14T01:48:09.469Z] === RUN   TestSecretsUpdate
01:48:11 [2019-10-14T01:48:11.512Z] --- PASS: TestSecretsUpdate (2.23s)
01:48:11 [2019-10-14T01:48:11.512Z]     secret_test.go:172: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestSecretsUpdate"
01:48:11 [2019-10-14T01:48:11.512Z] === RUN   TestTemplatedSecret
01:48:14 [2019-10-14T01:48:14.197Z] --- PASS: TestTemplatedSecret (2.85s)
01:48:14 [2019-10-14T01:48:14.197Z]     secret_test.go:221: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestTemplatedSecret"
01:48:14 [2019-10-14T01:48:14.197Z] === RUN   TestSecretCreateResolve
01:48:16 [2019-10-14T01:48:16.881Z] --- PASS: TestSecretCreateResolve (2.71s)
01:48:16 [2019-10-14T01:48:16.881Z]     secret_test.go:342: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestSecretCreateResolve"
01:48:16 [2019-10-14T01:48:16.881Z] PASS
01:48:16 [2019-10-14T01:48:16.881Z] 
01:48:16 [2019-10-14T01:48:16.881Z] DONE 6 tests in 14.984s
01:48:16 [2019-10-14T01:48:16.881Z] Running /go/src/github.com/docker/docker/integration/service (ppc64le.integration.service) flags=-test.v -test.timeout=120m 
01:48:16 [2019-10-14T01:48:16.882Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-service-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-service-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.service -t ./test.main -test.v -test.timeout=120m
01:48:16 [2019-10-14T01:48:16.882Z] ++ set -e
01:48:16 [2019-10-14T01:48:16.882Z] ++ '[' -n 0 ']'
01:48:16 [2019-10-14T01:48:16.882Z] ++ set -x
01:48:16 [2019-10-14T01:48:16.882Z] ++ 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=ppc64le 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/ppc64le-integration-service-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-service-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.service -t ./test.main -test.v -test.timeout=120m
01:48:16 [2019-10-14T01:48:16.882Z] INFO: Testing against a local daemon
01:48:16 [2019-10-14T01:48:16.882Z] === RUN   TestServiceCreateInit
01:48:16 [2019-10-14T01:48:16.882Z] === RUN   TestServiceCreateInit/daemonInitDisabled
01:48:21 [2019-10-14T01:48:21.290Z] === RUN   TestServiceCreateInit/daemonInitEnabled
01:48:25 [2019-10-14T01:48:25.780Z] --- PASS: TestServiceCreateInit (8.33s)
01:48:25 [2019-10-14T01:48:25.780Z]     --- PASS: TestServiceCreateInit/daemonInitDisabled (4.14s)
01:48:25 [2019-10-14T01:48:25.780Z]         create_test.go:38: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestServiceCreateInit/daemonInitDisabled"
01:48:25 [2019-10-14T01:48:25.780Z]     --- PASS: TestServiceCreateInit/daemonInitEnabled (4.14s)
01:48:25 [2019-10-14T01:48:25.780Z]         create_test.go:38: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestServiceCreateInit/daemonInitEnabled"
01:48:25 [2019-10-14T01:48:25.780Z] === RUN   TestCreateServiceMultipleTimes
01:48:44 [2019-10-14T01:48:44.306Z] --- PASS: TestCreateServiceMultipleTimes (18.71s)
01:48:44 [2019-10-14T01:48:44.306Z]     create_test.go:80: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCreateServiceMultipleTimes"
01:48:44 [2019-10-14T01:48:44.306Z] === RUN   TestCreateServiceConflict
01:48:46 [2019-10-14T01:48:46.343Z] --- PASS: TestCreateServiceConflict (2.18s)
01:48:46 [2019-10-14T01:48:46.343Z]     create_test.go:129: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCreateServiceConflict"
01:48:46 [2019-10-14T01:48:46.343Z] === RUN   TestCreateServiceMaxReplicas
01:48:49 [2019-10-14T01:48:49.817Z] --- PASS: TestCreateServiceMaxReplicas (3.06s)
01:48:49 [2019-10-14T01:48:49.817Z]     create_test.go:150: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCreateServiceMaxReplicas"
01:48:49 [2019-10-14T01:48:49.817Z] === RUN   TestCreateWithDuplicateNetworkNames
01:49:05 [2019-10-14T01:49:05.085Z] --- PASS: TestCreateWithDuplicateNetworkNames (13.39s)
01:49:05 [2019-10-14T01:49:05.085Z]     create_test.go:171: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCreateWithDuplicateNetworkNames"
01:49:05 [2019-10-14T01:49:05.085Z] === RUN   TestCreateServiceSecretFileMode
01:49:05 [2019-10-14T01:49:05.085Z] --- PASS: TestCreateServiceSecretFileMode (2.50s)
01:49:05 [2019-10-14T01:49:05.085Z]     create_test.go:224: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCreateServiceSecretFileMode"
01:49:05 [2019-10-14T01:49:05.085Z] === RUN   TestCreateServiceConfigFileMode
01:49:07 [2019-10-14T01:49:07.772Z] --- PASS: TestCreateServiceConfigFileMode (2.50s)
01:49:07 [2019-10-14T01:49:07.772Z]     create_test.go:288: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCreateServiceConfigFileMode"
01:49:07 [2019-10-14T01:49:07.772Z] === RUN   TestCreateServiceSysctls
01:49:11 [2019-10-14T01:49:11.242Z] --- PASS: TestCreateServiceSysctls (3.59s)
01:49:11 [2019-10-14T01:49:11.242Z]     create_test.go:378: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCreateServiceSysctls"
01:49:11 [2019-10-14T01:49:11.242Z] === RUN   TestCreateServiceCapabilities
01:49:13 [2019-10-14T01:49:13.945Z] --- PASS: TestCreateServiceCapabilities (2.62s)
01:49:13 [2019-10-14T01:49:13.945Z]     create_test.go:462: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestCreateServiceCapabilities"
01:49:13 [2019-10-14T01:49:13.945Z] === RUN   TestInspect
01:49:16 [2019-10-14T01:49:16.632Z] --- PASS: TestInspect (2.81s)
01:49:16 [2019-10-14T01:49:16.632Z]     inspect_test.go:23: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestInspect"
01:49:16 [2019-10-14T01:49:16.632Z] === RUN   TestDockerNetworkConnectAlias
01:49:22 [2019-10-14T01:49:22.137Z] --- PASS: TestDockerNetworkConnectAlias (4.56s)
01:49:22 [2019-10-14T01:49:22.137Z]     network_test.go:20: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkConnectAlias"
01:49:22 [2019-10-14T01:49:22.137Z] === RUN   TestDockerNetworkReConnect
01:49:24 [2019-10-14T01:49:24.836Z] --- PASS: TestDockerNetworkReConnect (3.72s)
01:49:24 [2019-10-14T01:49:24.836Z]     network_test.go:82: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestDockerNetworkReConnect"
01:49:24 [2019-10-14T01:49:24.836Z] === RUN   TestServicePlugin
01:49:24 [2019-10-14T01:49:24.836Z] --- SKIP: TestServicePlugin (0.00s)
01:49:24 [2019-10-14T01:49:24.836Z]     plugin_test.go:28: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:49:24 [2019-10-14T01:49:24.836Z] === RUN   TestServiceUpdateLabel
01:49:27 [2019-10-14T01:49:27.523Z] --- PASS: TestServiceUpdateLabel (2.20s)
01:49:27 [2019-10-14T01:49:27.523Z]     update_test.go:21: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestServiceUpdateLabel"
01:49:27 [2019-10-14T01:49:27.523Z] === RUN   TestServiceUpdateSecrets
01:49:42 [2019-10-14T01:49:42.761Z] --- PASS: TestServiceUpdateSecrets (14.92s)
01:49:42 [2019-10-14T01:49:42.761Z]     update_test.go:77: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestServiceUpdateSecrets"
01:49:42 [2019-10-14T01:49:42.761Z] === RUN   TestServiceUpdateConfigs
01:49:57 [2019-10-14T01:49:57.987Z] --- PASS: TestServiceUpdateConfigs (14.81s)
01:49:57 [2019-10-14T01:49:57.987Z]     update_test.go:139: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestServiceUpdateConfigs"
01:49:57 [2019-10-14T01:49:57.987Z] === RUN   TestServiceUpdateNetwork
01:50:10 [2019-10-14T01:50:10.525Z] --- PASS: TestServiceUpdateNetwork (12.90s)
01:50:10 [2019-10-14T01:50:10.526Z]     update_test.go:201: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestServiceUpdateNetwork"
01:50:10 [2019-10-14T01:50:10.526Z] PASS
01:50:10 [2019-10-14T01:50:10.526Z] 
01:50:10 [2019-10-14T01:50:10.526Z] === Skipped
01:50:10 [2019-10-14T01:50:10.526Z] === SKIP: ppc64le.integration.service TestServicePlugin (0.00s)
01:50:10 [2019-10-14T01:50:10.526Z]     plugin_test.go:28: os.Getenv("DOCKER_ENGINE_GOARCH") != "amd64"
01:50:10 [2019-10-14T01:50:10.526Z] 
01:50:10 [2019-10-14T01:50:10.526Z] 
01:50:10 [2019-10-14T01:50:10.526Z] DONE 19 tests, 1 skipped in 112.934s
01:50:10 [2019-10-14T01:50:10.526Z] Running /go/src/github.com/docker/docker/integration/session (ppc64le.integration.session) flags=-test.v -test.timeout=120m 
01:50:10 [2019-10-14T01:50:10.526Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-session-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-session-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.session -t ./test.main -test.v -test.timeout=120m
01:50:10 [2019-10-14T01:50:10.526Z] ++ set -e
01:50:10 [2019-10-14T01:50:10.526Z] ++ '[' -n 0 ']'
01:50:10 [2019-10-14T01:50:10.526Z] ++ set -x
01:50:10 [2019-10-14T01:50:10.526Z] ++ 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=ppc64le 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/ppc64le-integration-session-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-session-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.session -t ./test.main -test.v -test.timeout=120m
01:50:10 [2019-10-14T01:50:10.526Z] INFO: Testing against a local daemon
01:50:10 [2019-10-14T01:50:10.526Z] === RUN   TestSessionCreate
01:50:10 [2019-10-14T01:50:10.526Z] --- PASS: TestSessionCreate (0.06s)
01:50:10 [2019-10-14T01:50:10.526Z] === RUN   TestSessionCreateWithBadUpgrade
01:50:10 [2019-10-14T01:50:10.526Z] --- PASS: TestSessionCreateWithBadUpgrade (0.05s)
01:50:10 [2019-10-14T01:50:10.526Z] PASS
01:50:10 [2019-10-14T01:50:10.526Z] 
01:50:10 [2019-10-14T01:50:10.526Z] DONE 2 tests in 0.231s
01:50:10 [2019-10-14T01:50:10.526Z] Running /go/src/github.com/docker/docker/integration/system (ppc64le.integration.system) flags=-test.v -test.timeout=120m 
01:50:10 [2019-10-14T01:50:10.526Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-system-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-system-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.system -t ./test.main -test.v -test.timeout=120m
01:50:10 [2019-10-14T01:50:10.526Z] ++ set -e
01:50:10 [2019-10-14T01:50:10.526Z] ++ '[' -n 0 ']'
01:50:10 [2019-10-14T01:50:10.526Z] ++ set -x
01:50:10 [2019-10-14T01:50:10.526Z] ++ 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=ppc64le 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/ppc64le-integration-system-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-system-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.system -t ./test.main -test.v -test.timeout=120m
01:50:10 [2019-10-14T01:50:10.526Z] INFO: Testing against a local daemon
01:50:10 [2019-10-14T01:50:10.526Z] === RUN   TestCgroupDriverSystemdMemoryLimit
01:50:10 [2019-10-14T01:50:10.526Z] --- SKIP: TestCgroupDriverSystemdMemoryLimit (0.00s)
01:50:10 [2019-10-14T01:50:10.526Z]     cgroupdriver_systemd_test.go:32: !hasSystemd()
01:50:10 [2019-10-14T01:50:10.526Z] === RUN   TestEventsExecDie
01:50:11 [2019-10-14T01:50:11.142Z] --- PASS: TestEventsExecDie (0.91s)
01:50:11 [2019-10-14T01:50:11.142Z] === RUN   TestEventsBackwardsCompatible
01:50:11 [2019-10-14T01:50:11.142Z] --- PASS: TestEventsBackwardsCompatible (0.10s)
01:50:11 [2019-10-14T01:50:11.142Z] === RUN   TestInfoBinaryCommits
01:50:11 [2019-10-14T01:50:11.142Z] --- PASS: TestInfoBinaryCommits (0.06s)
01:50:11 [2019-10-14T01:50:11.142Z] === RUN   TestInfoAPIVersioned
01:50:11 [2019-10-14T01:50:11.142Z] --- PASS: TestInfoAPIVersioned (0.02s)
01:50:11 [2019-10-14T01:50:11.142Z] === RUN   TestInfoAPI
01:50:11 [2019-10-14T01:50:11.431Z] --- PASS: TestInfoAPI (0.06s)
01:50:11 [2019-10-14T01:50:11.431Z] === RUN   TestInfoAPIWarnings
01:50:12 [2019-10-14T01:50:12.446Z] --- PASS: TestInfoAPIWarnings (0.92s)
01:50:12 [2019-10-14T01:50:12.446Z]     info_test.go:49: Creating a new daemon at: "/go/src/github.com/docker/docker/bundles/test-integration/TestInfoAPIWarnings"
01:50:12 [2019-10-14T01:50:12.446Z] === RUN   TestLoginFailsWithBadCredentials
01:50:13 [2019-10-14T01:50:13.063Z] --- PASS: TestLoginFailsWithBadCredentials (0.96s)
01:50:13 [2019-10-14T01:50:13.063Z] === RUN   TestPingCacheHeaders
01:50:13 [2019-10-14T01:50:13.348Z] --- PASS: TestPingCacheHeaders (0.07s)
01:50:13 [2019-10-14T01:50:13.348Z] === RUN   TestPingGet
01:50:13 [2019-10-14T01:50:13.348Z] --- PASS: TestPingGet (0.04s)
01:50:13 [2019-10-14T01:50:13.348Z] === RUN   TestPingHead
01:50:13 [2019-10-14T01:50:13.348Z] --- PASS: TestPingHead (0.06s)
01:50:13 [2019-10-14T01:50:13.348Z] === RUN   TestVersion
01:50:13 [2019-10-14T01:50:13.348Z] --- PASS: TestVersion (0.05s)
01:50:13 [2019-10-14T01:50:13.348Z] PASS
01:50:13 [2019-10-14T01:50:13.348Z] 
01:50:13 [2019-10-14T01:50:13.348Z] === Skipped
01:50:13 [2019-10-14T01:50:13.348Z] === SKIP: ppc64le.integration.system TestCgroupDriverSystemdMemoryLimit (0.00s)
01:50:13 [2019-10-14T01:50:13.348Z]     cgroupdriver_systemd_test.go:32: !hasSystemd()
01:50:13 [2019-10-14T01:50:13.348Z] 
01:50:13 [2019-10-14T01:50:13.348Z] 
01:50:13 [2019-10-14T01:50:13.348Z] DONE 12 tests, 1 skipped in 3.323s
01:50:13 [2019-10-14T01:50:13.348Z] Running /go/src/github.com/docker/docker/integration/volume (ppc64le.integration.volume) flags=-test.v -test.timeout=120m 
01:50:13 [2019-10-14T01:50:13.348Z] ++ test_env gotestsum --format=standard-verbose --jsonfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-volume-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-volume-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.volume -t ./test.main -test.v -test.timeout=120m
01:50:13 [2019-10-14T01:50:13.348Z] ++ set -e
01:50:13 [2019-10-14T01:50:13.348Z] ++ '[' -n 0 ']'
01:50:13 [2019-10-14T01:50:13.348Z] ++ set -x
01:50:13 [2019-10-14T01:50:13.348Z] ++ 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=ppc64le 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/ppc64le-integration-volume-go-test-report.json --junitfile=/go/src/github.com/docker/docker/bundles/test-integration/ppc64le-integration-volume-junit-report.xml --raw-command -- go tool test2json -p ppc64le.integration.volume -t ./test.main -test.v -test.timeout=120m
01:50:13 [2019-10-14T01:50:13.633Z] INFO: Testing against a local daemon
01:50:13 [2019-10-14T01:50:13.633Z] === RUN   TestVolumesCreateAndList
01:50:13 [2019-10-14T01:50:13.633Z] --- PASS: TestVolumesCreateAndList (0.04s)
01:50:13 [2019-10-14T01:50:13.633Z] === RUN   TestVolumesRemove
01:50:13 [2019-10-14T01:50:13.633Z] --- PASS: TestVolumesRemove (0.10s)
01:50:13 [2019-10-14T01:50:13.633Z] === RUN   TestVolumesInspect
01:50:13 [2019-10-14T01:50:13.633Z] --- PASS: TestVolumesInspect (0.04s)
01:50:13 [2019-10-14T01:50:13.633Z] === RUN   TestVolumesInvalidJSON
01:50:13 [2019-10-14T01:50:13.633Z] === RUN   TestVolumesInvalidJSON//volumes/create
01:50:13 [2019-10-14T01:50:13.633Z] === PAUSE TestVolumesInvalidJSON//volumes/create
01:50:13 [2019-10-14T01:50:13.633Z] === CONT  TestVolumesInvalidJSON//volumes/create
01:50:13 [2019-10-14T01:50:13.633Z] --- PASS: TestVolumesInvalidJSON (0.03s)
01:50:13 [2019-10-14T01:50:13.633Z]     --- PASS: TestVolumesInvalidJSON//volumes/create (0.00s)
01:50:13 [2019-10-14T01:50:13.633Z] PASS
01:50:13 [2019-10-14T01:50:13.633Z] 
01:50:13 [2019-10-14T01:50:13.633Z] DONE 5 tests in 0.314s
01:50:13 [2019-10-14T01:50:13.633Z] ---> Making bundle: .integration-daemon-stop (in bundles/test-integration)
01:50:14 [2019-10-14T01:50:14.259Z] ++++ cat bundles/test-integration/docker.pid
01:50:14 [2019-10-14T01:50:14.259Z] +++ kill 13049
01:50:15 [2019-10-14T01:50:15.736Z] +++ /etc/init.d/apparmor stop
01:50:15 [2019-10-14T01:50:15.736Z] Clearing AppArmor profiles cache:.
01:50:15 [2019-10-14T01:50:15.736Z] All profile caches have been cleared, but no profiles have been unloaded.
01:50:15 [2019-10-14T01:50:15.736Z] Unloading profiles will leave already running processes permanently
01:50:15 [2019-10-14T01:50:15.736Z] unconfined, which can lead to unexpected situations.
01:50:15 [2019-10-14T01:50:15.736Z] 
01:50:15 [2019-10-14T01:50:15.736Z] To set a process to complain mode, use the command line tool
01:50:15 [2019-10-14T01:50:15.736Z] 'aa-complain'. To really tear down all profiles, run the init script
01:50:15 [2019-10-14T01:50:15.736Z] with the 'teardown' option."
01:50:15 [2019-10-14T01:50:15.736Z]