This job view page is being replaced by Spyglass soon. Check out the new job view.
ResultFAILURE
Tests 1 failed / 8 succeeded
Started2022-08-11 10:45
Elapsed17m20s
Revision
Builderbfcf79d0-1962-11ed-b2a2-1215444f8a61
infra-commitf5b010f5b
job-versionv1.23.10-rc.0.25+ca85da939b14a6
kubetest-versionv20220804-4fa19ea91a
revisionv1.23.10-rc.0.25+ca85da939b14a6

Test Failures


kubetest Up 7m37s

error during ./hack/e2e-internal/e2e-up.sh: exit status 2
				from junit_runner.xml

Filter through log files | View test history on testgrid


Show 8 Passed Tests

Error lines from build-log.txt

... skipping 15 lines ...
I0811 10:45:50.582] process 57 exited with code 0 after 0.0m
I0811 10:45:50.582] Will upload results to gs://kubernetes-jenkins/logs using prow-build@k8s-infra-prow-build.iam.gserviceaccount.com
I0811 10:45:50.582] Root: /workspace
I0811 10:45:50.583] cd to /workspace
I0811 10:45:50.583] Configure environment...
I0811 10:45:50.583] Call:  git show -s --format=format:%ct HEAD
W0811 10:45:50.586] fatal: not a git repository (or any of the parent directories): .git
I0811 10:45:50.586] process 71 exited with code 128 after 0.0m
W0811 10:45:50.586] Unable to print commit date for HEAD
I0811 10:45:50.587] Call:  gcloud auth activate-service-account --key-file=/etc/service-account/service-account.json
W0811 10:45:51.447] Activated service account credentials for: [prow-build@k8s-infra-prow-build.iam.gserviceaccount.com]
I0811 10:45:51.730] process 72 exited with code 0 after 0.0m
I0811 10:45:51.730] Call:  gcloud config get-value account
... skipping 360 lines ...
W0811 10:49:55.865] Trying to find master named 'test-a8a0b221b9-master'
W0811 10:49:55.865] Looking for address 'test-a8a0b221b9-master-ip'
W0811 10:49:57.480] Using master: test-a8a0b221b9-master (external IP: 34.168.255.11; internal IP: (not set))
I0811 10:49:57.580] Waiting up to 300 seconds for cluster initialization.
I0811 10:49:57.581] 
I0811 10:49:57.581]   This will continually check to see if the API for kubernetes is reachable.
I0811 10:49:57.581]   This may time out if there was some uncaught error during start up.
I0811 10:49:57.581] 
I0811 10:54:58.077] ...........................................................................................................................................Checking for custom logdump instances, if any
I0811 10:54:58.082] ----------------------------------------------------------------------------------------------------
I0811 10:54:58.083] k/k version of the log-dump.sh script is deprecated!
I0811 10:54:58.083] Please migrate your test job to use test-infra's repo version of log-dump.sh!
I0811 10:54:58.083] Migration steps can be found in the readme file.
I0811 10:54:58.083] ----------------------------------------------------------------------------------------------------
I0811 10:54:58.084] Sourcing kube-util.sh
I0811 10:54:58.147] Detecting project
I0811 10:54:58.147] Project: k8s-infra-e2e-boskos-120
I0811 10:54:58.148] Network Project: k8s-infra-e2e-boskos-120
I0811 10:54:58.148] Zone: us-west1-b
I0811 10:54:58.157] Dumping logs from master locally to '/workspace/_artifacts'
W0811 10:54:58.258] Cluster failed to initialize within 300 seconds.
W0811 10:54:58.258] Last output from querying API server follows:
W0811 10:54:58.258] -----------------------------------------------------
W0811 10:54:58.258] * Expire in 0 ms for 6 (transfer 0x56526aa2d0f0)
W0811 10:54:58.258] * Expire in 5000 ms for 8 (transfer 0x56526aa2d0f0)
W0811 10:54:58.259] *   Trying 34.168.255.11...
W0811 10:54:58.259] * TCP_NODELAY set
W0811 10:54:58.259] * Expire in 200 ms for 4 (transfer 0x56526aa2d0f0)
W0811 10:54:58.259] * connect to 34.168.255.11 port 443 failed: Connection refused
W0811 10:54:58.259] * Failed to connect to 34.168.255.11 port 443: Connection refused
W0811 10:54:58.259] * Closing connection 0
W0811 10:54:58.260] curl: (7) Failed to connect to 34.168.255.11 port 443: Connection refused
W0811 10:54:58.260] -----------------------------------------------------
W0811 10:54:58.260] 2022/08/11 10:54:58 process.go:155: Step './hack/e2e-internal/e2e-up.sh' finished in 7m37.168149135s
W0811 10:54:58.260] 2022/08/11 10:54:58 e2e.go:574: Dumping logs locally to: /workspace/_artifacts
W0811 10:54:58.260] 2022/08/11 10:54:58 process.go:153: Running: ./cluster/log-dump/log-dump.sh /workspace/_artifacts
W0811 10:54:58.261] Trying to find master named 'test-a8a0b221b9-master'
W0811 10:54:58.261] Looking for address 'test-a8a0b221b9-master-ip'
... skipping 5 lines ...
W0811 10:55:46.384] scp: /var/log/glbc.log*: No such file or directory
W0811 10:55:46.385] scp: /var/log/cluster-autoscaler.log*: No such file or directory
W0811 10:55:46.385] scp: /var/log/kube-addon-manager.log*: No such file or directory
W0811 10:55:46.463] scp: /var/log/fluentd.log*: No such file or directory
W0811 10:55:46.463] scp: /var/log/kubelet.cov*: No such file or directory
W0811 10:55:46.463] scp: /var/log/startupscript.log*: No such file or directory
W0811 10:55:46.467] ERROR: (gcloud.compute.scp) [/usr/bin/scp] exited with return code [1].
I0811 10:55:46.768] Dumping logs from nodes locally to '/workspace/_artifacts'
I0811 10:55:46.769] Detecting nodes in the cluster
I0811 10:57:12.786] Changing logfiles to be world-readable for download
I0811 10:57:14.223] Changing logfiles to be world-readable for download
I0811 10:57:17.830] Changing logfiles to be world-readable for download
I0811 10:57:20.433] Copying 'kube-proxy.log containers/konnectivity-agent-*.log fluentd.log node-problem-detector.log kubelet.cov startupscript.log' from test-a8a0b221b9-minion-group-3hz9
... skipping 5 lines ...
W0811 10:57:25.960] scp: /var/log/kube-proxy.log*: No such file or directory
W0811 10:57:25.961] scp: /var/log/containers/konnectivity-agent-*.log*: No such file or directory
W0811 10:57:25.961] scp: /var/log/fluentd.log*: No such file or directory
W0811 10:57:25.961] scp: /var/log/node-problem-detector.log*: No such file or directory
W0811 10:57:25.961] scp: /var/log/kubelet.cov*: No such file or directory
W0811 10:57:25.961] scp: /var/log/startupscript.log*: No such file or directory
W0811 10:57:26.012] ERROR: (gcloud.compute.scp) [/usr/bin/scp] exited with return code [1].
I0811 10:57:26.113] Copying 'kube-proxy.log containers/konnectivity-agent-*.log fluentd.log node-problem-detector.log kubelet.cov startupscript.log' from test-a8a0b221b9-minion-group-9dzf
W0811 10:57:28.078] 
W0811 10:57:28.079] Specify --start=99357 in the next get-serial-port-output invocation to get only the new output starting from here.
W0811 10:57:28.548] scp: /var/log/kube-proxy.log*: No such file or directory
W0811 10:57:28.549] scp: /var/log/containers/konnectivity-agent-*.log*: No such file or directory
W0811 10:57:28.549] scp: /var/log/fluentd.log*: No such file or directory
W0811 10:57:28.549] scp: /var/log/node-problem-detector.log*: No such file or directory
W0811 10:57:28.549] scp: /var/log/kubelet.cov*: No such file or directory
W0811 10:57:28.550] scp: /var/log/startupscript.log*: No such file or directory
W0811 10:57:28.552] ERROR: (gcloud.compute.scp) [/usr/bin/scp] exited with return code [1].
W0811 10:57:30.441] scp: /var/log/kube-proxy.log*: No such file or directory
W0811 10:57:30.441] scp: /var/log/containers/konnectivity-agent-*.log*: No such file or directory
W0811 10:57:30.442] scp: /var/log/fluentd.log*: No such file or directory
W0811 10:57:30.442] scp: /var/log/node-problem-detector.log*: No such file or directory
W0811 10:57:30.442] scp: /var/log/kubelet.cov*: No such file or directory
W0811 10:57:30.442] scp: /var/log/startupscript.log*: No such file or directory
W0811 10:57:30.445] ERROR: (gcloud.compute.scp) [/usr/bin/scp] exited with return code [1].
W0811 10:57:35.747] INSTANCE_GROUPS=test-a8a0b221b9-minion-group
W0811 10:57:35.748] NODE_NAMES=test-a8a0b221b9-minion-group-3hz9 test-a8a0b221b9-minion-group-9dzf test-a8a0b221b9-minion-group-fk00
I0811 10:57:37.114] Failures for test-a8a0b221b9-minion-group (if any):
W0811 10:57:38.686] 2022/08/11 10:57:38 process.go:155: Step './cluster/log-dump/log-dump.sh /workspace/_artifacts' finished in 2m40.611228594s
W0811 10:57:38.686] 2022/08/11 10:57:38 process.go:153: Running: ./hack/e2e-internal/e2e-down.sh
W0811 10:57:38.747] Project: k8s-infra-e2e-boskos-120
... skipping 14 lines ...
I0811 10:57:47.220] Bringing down cluster
W0811 10:58:13.809] Deleting Managed Instance Group...
W0811 10:58:13.809] ..Deleted [https://www.googleapis.com/compute/v1/projects/k8s-infra-e2e-boskos-120/zones/us-west1-b/instanceGroupManagers/test-a8a0b221b9-minion-group].
W0811 10:58:13.813] done.
W0811 10:58:21.008] Deleted [https://www.googleapis.com/compute/v1/projects/k8s-infra-e2e-boskos-120/global/instanceTemplates/test-a8a0b221b9-minion-template].
W0811 10:58:21.604] Deleted [https://www.googleapis.com/compute/v1/projects/k8s-infra-e2e-boskos-120/global/instanceTemplates/test-a8a0b221b9-windows-node-template].
W0811 10:59:25.627] Failed to execute 'curl -s --cacert /etc/srv/kubernetes/pki/etcd-apiserver-ca.crt --cert /etc/srv/kubernetes/pki/etcd-apiserver-client.crt --key /etc/srv/kubernetes/pki/etcd-apiserver-client.key https://127.0.0.1:2379/v2/members/$(curl -s --cacert /etc/srv/kubernetes/pki/etcd-apiserver-ca.crt --cert /etc/srv/kubernetes/pki/etcd-apiserver-client.crt --key /etc/srv/kubernetes/pki/etcd-apiserver-client.key https://127.0.0.1:2379/v2/members -XGET | sed 's/{\"id/\n/g' | grep test-a8a0b221b9-master\" | cut -f 3 -d \") -XDELETE -L 2>/dev/null' on test-a8a0b221b9-master despite 5 attempts
W0811 10:59:25.627] Last attempt failed with: 
I0811 10:59:25.728] Removing etcd replica, name: test-a8a0b221b9-master, port: 2379, result: 1
W0811 11:00:26.360] Failed to execute 'curl -s  http://127.0.0.1:4002/v2/members/$(curl -s  http://127.0.0.1:4002/v2/members -XGET | sed 's/{\"id/\n/g' | grep test-a8a0b221b9-master\" | cut -f 3 -d \") -XDELETE -L 2>/dev/null' on test-a8a0b221b9-master despite 5 attempts
W0811 11:00:26.361] Last attempt failed with: 
I0811 11:00:26.461] Removing etcd replica, name: test-a8a0b221b9-master, port: 4002, result: 1
W0811 11:00:30.966] Updated [https://www.googleapis.com/compute/v1/projects/k8s-infra-e2e-boskos-120/zones/us-west1-b/instances/test-a8a0b221b9-master].
W0811 11:00:52.314] Deleted [https://www.googleapis.com/compute/v1/projects/k8s-infra-e2e-boskos-120/zones/us-west1-b/instances/test-a8a0b221b9-master].
W0811 11:00:55.099] WARNING: The following filter keys were not present in any resource : name
W0811 11:01:05.123] Deleted [https://www.googleapis.com/compute/v1/projects/k8s-infra-e2e-boskos-120/global/firewalls/test-a8a0b221b9-master-https].
W0811 11:01:07.484] Deleted [https://www.googleapis.com/compute/v1/projects/k8s-infra-e2e-boskos-120/global/firewalls/test-a8a0b221b9-minion-all].
... skipping 20 lines ...
I0811 11:02:55.021] Cleared config for k8s-infra-e2e-boskos-120_test-a8a0b221b9 from /workspace/.kube/config
I0811 11:02:55.022] Done
W0811 11:02:55.049] W0811 11:02:55.018667   11492 loader.go:221] Config not found: /workspace/.kube/config
W0811 11:02:55.049] W0811 11:02:55.018857   11492 loader.go:221] Config not found: /workspace/.kube/config
W0811 11:02:55.049] 2022/08/11 11:02:55 process.go:155: Step './hack/e2e-internal/e2e-down.sh' finished in 5m16.336515168s
W0811 11:02:55.050] 2022/08/11 11:02:55 process.go:96: Saved XML output to /workspace/_artifacts/junit_runner.xml.
W0811 11:02:55.050] 2022/08/11 11:02:55 main.go:331: Something went wrong: starting e2e cluster: error during ./hack/e2e-internal/e2e-up.sh: exit status 2
W0811 11:02:55.050] Traceback (most recent call last):
W0811 11:02:55.050]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 723, in <module>
W0811 11:02:55.050]     main(parse_args())
W0811 11:02:55.051]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 569, in main
W0811 11:02:55.051]     mode.start(runner_args)
W0811 11:02:55.051]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 228, in start
W0811 11:02:55.051]     check_env(env, self.command, *args)
W0811 11:02:55.051]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 111, in check_env
W0811 11:02:55.051]     subprocess.check_call(cmd, env=env)
W0811 11:02:55.052]   File "/usr/lib/python2.7/subprocess.py", line 190, in check_call
W0811 11:02:55.052]     raise CalledProcessError(retcode, cmd)
W0811 11:02:55.052] subprocess.CalledProcessError: Command '('kubetest', '--dump=/workspace/_artifacts', '--gcp-service-account=/etc/service-account/service-account.json', '--up', '--down', '--test', '--provider=gce', '--cluster=test-a8a0b221b9', '--gcp-network=test-a8a0b221b9', '--check-leaked-resources', '--gcp-zone=us-west1-b', '--gcp-node-image=gci', '--extract=ci/latest-1.23', '--extract-ci-bucket=k8s-release-dev', '--timeout=180m', '--runtime-config=api/all=true', '--test_args=--ginkgo.focus=\\[Feature:(Audit|BlockVolume|PodPreset|ExpandCSIVolumes|ExpandInUseVolumes)\\]|Networking --ginkgo.skip=Networking-Performance|IPv6|Feature:(Volumes|SCTPConnectivity) --minStartupPods=8')' returned non-zero exit status 1
E0811 11:02:55.053] Command failed
I0811 11:02:55.053] process 272 exited with code 1 after 17.0m
E0811 11:02:55.053] FAIL: ci-kubernetes-e2e-gce-cos-k8sstable2-alphafeatures
I0811 11:02:55.053] Call:  gcloud auth activate-service-account --key-file=/etc/service-account/service-account.json
W0811 11:02:55.849] Activated service account credentials for: [prow-build@k8s-infra-prow-build.iam.gserviceaccount.com]
I0811 11:02:56.044] process 11503 exited with code 0 after 0.0m
I0811 11:02:56.044] Call:  gcloud config get-value account
I0811 11:02:56.820] process 11517 exited with code 0 after 0.0m
I0811 11:02:56.821] Will upload results to gs://kubernetes-jenkins/logs using prow-build@k8s-infra-prow-build.iam.gserviceaccount.com
I0811 11:02:56.821] Upload result and artifacts...
I0811 11:02:56.821] Gubernator results at https://gubernator.k8s.io/build/kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-cos-k8sstable2-alphafeatures/1557679649549455360
I0811 11:02:56.821] Call:  gsutil ls gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-cos-k8sstable2-alphafeatures/1557679649549455360/artifacts
W0811 11:02:58.152] CommandException: One or more URLs matched no objects.
E0811 11:02:58.456] Command failed
I0811 11:02:58.456] process 11531 exited with code 1 after 0.0m
W0811 11:02:58.457] Remote dir gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-cos-k8sstable2-alphafeatures/1557679649549455360/artifacts not exist yet
I0811 11:02:58.457] Call:  gsutil -m -q -o GSUtil:use_magicfile=True cp -r -c -z log,txt,xml /workspace/_artifacts gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-cos-k8sstable2-alphafeatures/1557679649549455360/artifacts
I0811 11:03:03.842] process 11671 exited with code 0 after 0.1m
I0811 11:03:03.843] Call:  git rev-parse HEAD
W0811 11:03:03.845] fatal: not a git repository (or any of the parent directories): .git
E0811 11:03:03.846] Command failed
I0811 11:03:03.846] process 12299 exited with code 128 after 0.0m
I0811 11:03:03.846] Call:  git rev-parse HEAD
I0811 11:03:03.849] process 12300 exited with code 0 after 0.0m
I0811 11:03:03.850] Call:  gsutil stat gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-cos-k8sstable2-alphafeatures/jobResultsCache.json
I0811 11:03:05.343] process 12301 exited with code 0 after 0.0m
I0811 11:03:05.343] Call:  gsutil -q cat 'gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-cos-k8sstable2-alphafeatures/jobResultsCache.json#1660194118598893'
... skipping 8 lines ...