This job view page is being replaced by Spyglass soon. Check out the new job view.
ResultFAILURE
Tests 1 failed / 6 succeeded
Started2020-10-26 16:00
Elapsed15m47s
Revision
Builder5b2a5728-17a4-11eb-b256-6ee25ea2e440
infra-commitf7d653694
job-versionv1.19.4-rc.0.22+9e8ad8ce9d8a30
revisionv1.19.4-rc.0.22+9e8ad8ce9d8a30

Test Failures


Up 7m13s

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 6 Passed Tests

Error lines from build-log.txt

... skipping 15 lines ...
I1026 16:00:39.820] process 47 exited with code 0 after 0.0m
I1026 16:00:39.821] Will upload results to gs://kubernetes-jenkins/logs using pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com
I1026 16:00:39.821] Root: /workspace
I1026 16:00:39.821] cd to /workspace
I1026 16:00:39.821] Configure environment...
I1026 16:00:39.822] Call:  git show -s --format=format:%ct HEAD
W1026 16:00:39.826] fatal: not a git repository (or any of the parent directories): .git
I1026 16:00:39.826] process 60 exited with code 128 after 0.0m
W1026 16:00:39.826] Unable to print commit date for HEAD
I1026 16:00:39.827] Call:  gcloud auth activate-service-account --key-file=/etc/service-account/service-account.json
W1026 16:00:40.518] Activated service account credentials for: [pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com]
I1026 16:00:40.749] process 61 exited with code 0 after 0.0m
I1026 16:00:40.750] Call:  gcloud config get-value account
... skipping 373 lines ...
W1026 16:04:33.688] Trying to find master named 'bootstrap-e2e-master'
W1026 16:04:33.689] Looking for address 'bootstrap-e2e-master-ip'
W1026 16:04:34.821] Using master: bootstrap-e2e-master (external IP: 35.197.7.238; internal IP: (not set))
I1026 16:04:34.921] Waiting up to 300 seconds for cluster initialization.
I1026 16:04:34.922] 
I1026 16:04:34.922]   This will continually check to see if the API for kubernetes is reachable.
I1026 16:04:34.922]   This may time out if there was some uncaught error during start up.
I1026 16:04:34.922] 
I1026 16:09:35.934] .................................................................................................Checking for custom logdump instances, if any
I1026 16:09:35.940] Sourcing kube-util.sh
I1026 16:09:36.003] Detecting project
I1026 16:09:36.004] Project: k8s-jkns-e2e-prow-canary
I1026 16:09:36.004] Network Project: k8s-jkns-e2e-prow-canary
I1026 16:09:36.004] Zone: us-west1-b
I1026 16:09:36.004] Dumping logs from master locally to '/workspace/_artifacts'
W1026 16:09:36.105] Cluster failed to initialize within 300 seconds.
W1026 16:09:36.105] Last output from querying API server follows:
W1026 16:09:36.105] -----------------------------------------------------
W1026 16:09:36.105] * Expire in 0 ms for 6 (transfer 0x56125a346f50)
W1026 16:09:36.105] * Expire in 5000 ms for 8 (transfer 0x56125a346f50)
W1026 16:09:36.105] *   Trying 35.197.7.238...
W1026 16:09:36.106] * TCP_NODELAY set
W1026 16:09:36.106] * Expire in 200 ms for 4 (transfer 0x56125a346f50)
W1026 16:09:36.106] * connect to 35.197.7.238 port 443 failed: Connection refused
W1026 16:09:36.106] * Failed to connect to 35.197.7.238 port 443: Connection refused
W1026 16:09:36.106] * Closing connection 0
W1026 16:09:36.107] curl: (7) Failed to connect to 35.197.7.238 port 443: Connection refused
W1026 16:09:36.107] -----------------------------------------------------
W1026 16:09:36.107] 2020/10/26 16:09:35 process.go:155: Step './hack/e2e-internal/e2e-up.sh' finished in 7m13.105461467s
W1026 16:09:36.107] 2020/10/26 16:09:35 e2e.go:544: Dumping logs locally to: /workspace/_artifacts
W1026 16:09:36.107] 2020/10/26 16:09:35 process.go:153: Running: ./cluster/log-dump/log-dump.sh /workspace/_artifacts
W1026 16:09:36.108] Trying to find master named 'bootstrap-e2e-master'
W1026 16:09:36.108] Looking for address 'bootstrap-e2e-master-ip'
... skipping 6 lines ...
W1026 16:10:21.572] scp: /var/log/cluster-autoscaler.log*: No such file or directory
W1026 16:10:21.572] scp: /var/log/kube-addon-manager.log*: No such file or directory
W1026 16:10:21.573] scp: /var/log/konnectivity-server.log*: No such file or directory
W1026 16:10:21.573] scp: /var/log/fluentd.log*: No such file or directory
W1026 16:10:21.573] scp: /var/log/kubelet.cov*: No such file or directory
W1026 16:10:21.573] scp: /var/log/startupscript.log*: No such file or directory
W1026 16:10:21.579] ERROR: (gcloud.compute.scp) [/usr/bin/scp] exited with return code [1].
I1026 16:10:21.815] Dumping logs from nodes locally to '/workspace/_artifacts'
I1026 16:10:21.815] Detecting nodes in the cluster
I1026 16:11:04.891] Changing logfiles to be world-readable for download
I1026 16:11:05.305] Changing logfiles to be world-readable for download
I1026 16:11:05.719] Changing logfiles to be world-readable for download
I1026 16:11:08.727] Copying 'kube-proxy.log fluentd.log node-problem-detector.log kubelet.cov  startupscript.log' from bootstrap-e2e-minion-group-dknm
... skipping 6 lines ...
W1026 16:11:10.851] 
W1026 16:11:10.851] Specify --start=43903 in the next get-serial-port-output invocation to get only the new output starting from here.
W1026 16:11:12.233] scp: /var/log/fluentd.log*: No such file or directory
W1026 16:11:12.234] scp: /var/log/node-problem-detector.log*: No such file or directory
W1026 16:11:12.234] scp: /var/log/kubelet.cov*: No such file or directory
W1026 16:11:12.234] scp: /var/log/startupscript.log*: No such file or directory
W1026 16:11:12.237] ERROR: (gcloud.compute.scp) [/usr/bin/scp] exited with return code [1].
W1026 16:11:12.547] scp: /var/log/fluentd.log*: No such file or directory
W1026 16:11:12.548] scp: /var/log/node-problem-detector.log*: No such file or directory
W1026 16:11:12.548] scp: /var/log/kubelet.cov*: No such file or directory
W1026 16:11:12.548] scp: /var/log/startupscript.log*: No such file or directory
W1026 16:11:12.551] ERROR: (gcloud.compute.scp) [/usr/bin/scp] exited with return code [1].
W1026 16:11:12.941] scp: /var/log/fluentd.log*: No such file or directory
W1026 16:11:12.941] scp: /var/log/node-problem-detector.log*: No such file or directory
W1026 16:11:12.942] scp: /var/log/kubelet.cov*: No such file or directory
W1026 16:11:12.942] scp: /var/log/startupscript.log*: No such file or directory
W1026 16:11:12.945] ERROR: (gcloud.compute.scp) [/usr/bin/scp] exited with return code [1].
W1026 16:11:17.063] INSTANCE_GROUPS=bootstrap-e2e-minion-group
W1026 16:11:17.063] NODE_NAMES=bootstrap-e2e-minion-group-88j4 bootstrap-e2e-minion-group-9jpk bootstrap-e2e-minion-group-dknm
I1026 16:11:18.316] Failures for bootstrap-e2e-minion-group (if any):
W1026 16:11:20.800] 2020/10/26 16:11:20 process.go:155: Step './cluster/log-dump/log-dump.sh /workspace/_artifacts' finished in 1m44.869139814s
W1026 16:11:20.801] 2020/10/26 16:11:20 process.go:153: Running: ./hack/e2e-internal/e2e-down.sh
W1026 16:11:20.865] Project: k8s-jkns-e2e-prow-canary
... skipping 12 lines ...
W1026 16:11:28.088] NODE_NAMES=bootstrap-e2e-minion-group-88j4 bootstrap-e2e-minion-group-9jpk bootstrap-e2e-minion-group-dknm
W1026 16:11:59.127] Deleting Managed Instance Group...
W1026 16:11:59.128] ..Deleted [https://www.googleapis.com/compute/v1/projects/k8s-jkns-e2e-prow-canary/zones/us-west1-b/instanceGroupManagers/bootstrap-e2e-minion-group].
W1026 16:11:59.131] done.
W1026 16:12:03.301] Deleted [https://www.googleapis.com/compute/v1/projects/k8s-jkns-e2e-prow-canary/global/instanceTemplates/bootstrap-e2e-windows-node-template].
W1026 16:12:03.361] Deleted [https://www.googleapis.com/compute/v1/projects/k8s-jkns-e2e-prow-canary/global/instanceTemplates/bootstrap-e2e-minion-template].
W1026 16:13:07.559] 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 bootstrap-e2e-master\" | cut -f 3 -d \") -XDELETE -L 2>/dev/null' on bootstrap-e2e-master despite 5 attempts
W1026 16:13:07.559] Last attempt failed with: 
I1026 16:13:07.660] Removing etcd replica, name: bootstrap-e2e-master, port: 2379, result: 1
I1026 16:13:09.651] Successfully executed '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 bootstrap-e2e-master\" | cut -f 3 -d \") -XDELETE -L 2>/dev/null' on bootstrap-e2e-master
I1026 16:13:09.651] Removing etcd replica, name: bootstrap-e2e-master, port: 4002, result: 0
W1026 16:13:13.688] Updated [https://www.googleapis.com/compute/v1/projects/k8s-jkns-e2e-prow-canary/zones/us-west1-b/instances/bootstrap-e2e-master].
W1026 16:15:00.855] Deleted [https://www.googleapis.com/compute/v1/projects/k8s-jkns-e2e-prow-canary/zones/us-west1-b/instances/bootstrap-e2e-master].
W1026 16:15:10.063] Deleted [https://www.googleapis.com/compute/v1/projects/k8s-jkns-e2e-prow-canary/global/firewalls/bootstrap-e2e-master-https].
... skipping 19 lines ...
I1026 16:16:14.693] Cleared config for k8s-jkns-e2e-prow-canary_bootstrap-e2e from /workspace/.kube/config
I1026 16:16:14.693] Done
W1026 16:16:14.718] W1026 16:16:14.688966   11064 loader.go:223] Config not found: /workspace/.kube/config
W1026 16:16:14.718] W1026 16:16:14.689176   11064 loader.go:223] Config not found: /workspace/.kube/config
W1026 16:16:14.719] 2020/10/26 16:16:14 process.go:155: Step './hack/e2e-internal/e2e-down.sh' finished in 4m53.894691205s
W1026 16:16:14.719] 2020/10/26 16:16:14 process.go:96: Saved XML output to /workspace/_artifacts/junit_runner.xml.
W1026 16:16:14.719] 2020/10/26 16:16:14 main.go:316: Something went wrong: starting e2e cluster: error during ./hack/e2e-internal/e2e-up.sh: exit status 2
W1026 16:16:14.719] Traceback (most recent call last):
W1026 16:16:14.719]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 720, in <module>
W1026 16:16:14.719]     main(parse_args())
W1026 16:16:14.719]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 570, in main
W1026 16:16:14.720]     mode.start(runner_args)
W1026 16:16:14.720]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 228, in start
W1026 16:16:14.720]     check_env(env, self.command, *args)
W1026 16:16:14.720]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 111, in check_env
W1026 16:16:14.720]     subprocess.check_call(cmd, env=env)
W1026 16:16:14.720]   File "/usr/lib/python2.7/subprocess.py", line 190, in check_call
W1026 16:16:14.720]     raise CalledProcessError(retcode, cmd)
W1026 16:16:14.721] subprocess.CalledProcessError: Command '('kubetest', '--dump=/workspace/_artifacts', '--gcp-service-account=/etc/service-account/service-account.json', '--up', '--down', '--test', '--provider=gce', '--cluster=bootstrap-e2e', '--gcp-network=bootstrap-e2e', '--check-leaked-resources', '--check-version-skew=false', '--extract=ci/k8s-stable1', '--extract=ci/k8s-beta', '--gcp-node-image=gci', '--gcp-zone=us-west1-b', '--ginkgo-parallel', '--skew', '--test_args=--ginkgo.skip=\\[Slow\\]|\\[Serial\\]|\\[Disruptive\\]|\\[Flaky\\]|\\[Feature:.+\\] --kubectl-path=../../../../kubernetes_skew/cluster/kubectl.sh --minStartupPods=8', '--timeout=120m', '--upgrade_args=--ginkgo.focus=\\[Feature:ClusterDowngrade\\] --upgrade-target=ci/k8s-stable1 --upgrade-image=gci')' returned non-zero exit status 1
E1026 16:16:14.721] Command failed
I1026 16:16:14.721] process 266 exited with code 1 after 15.5m
E1026 16:16:14.722] FAIL: ci-kubernetes-e2e-gce-beta-stable1-downgrade-cluster-parallel
I1026 16:16:14.722] Call:  gcloud auth activate-service-account --key-file=/etc/service-account/service-account.json
W1026 16:16:15.429] Activated service account credentials for: [pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com]
I1026 16:16:15.584] process 11074 exited with code 0 after 0.0m
I1026 16:16:15.584] Call:  gcloud config get-value account
I1026 16:16:16.307] process 11087 exited with code 0 after 0.0m
I1026 16:16:16.308] Will upload results to gs://kubernetes-jenkins/logs using pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com
I1026 16:16:16.308] Upload result and artifacts...
I1026 16:16:16.308] Gubernator results at https://gubernator.k8s.io/build/kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-beta-stable1-downgrade-cluster-parallel/1320757174984511488
I1026 16:16:16.309] Call:  gsutil ls gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-beta-stable1-downgrade-cluster-parallel/1320757174984511488/artifacts
W1026 16:16:17.584] CommandException: One or more URLs matched no objects.
E1026 16:16:17.876] Command failed
I1026 16:16:17.877] process 11100 exited with code 1 after 0.0m
W1026 16:16:17.877] Remote dir gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-beta-stable1-downgrade-cluster-parallel/1320757174984511488/artifacts not exist yet
I1026 16:16:17.877] 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-beta-stable1-downgrade-cluster-parallel/1320757174984511488/artifacts
I1026 16:16:20.776] process 11243 exited with code 0 after 0.0m
I1026 16:16:20.777] Call:  git rev-parse HEAD
W1026 16:16:20.783] fatal: not a git repository (or any of the parent directories): .git
E1026 16:16:20.784] Command failed
I1026 16:16:20.784] process 11888 exited with code 128 after 0.0m
I1026 16:16:20.784] Call:  git rev-parse HEAD
I1026 16:16:20.789] process 11889 exited with code 0 after 0.0m
I1026 16:16:20.790] Call:  gsutil stat gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-beta-stable1-downgrade-cluster-parallel/jobResultsCache.json
I1026 16:16:22.066] process 11890 exited with code 0 after 0.0m
I1026 16:16:22.067] Call:  gsutil -q cat 'gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-gce-beta-stable1-downgrade-cluster-parallel/jobResultsCache.json#1603721748478219'
... skipping 8 lines ...