This job view page is being replaced by Spyglass soon. Check out the new job view.
ResultFAILURE
Tests 1 failed / 5 succeeded
Started2019-09-11 09:13
Elapsed25m30s
Revision
Buildergke-prow-ssd-pool-1a225945-t5v8
links{u'resultstore': {u'url': u'https://source.cloud.google.com/results/invocations/9ea6c7b1-9867-48e0-810e-4a1ee9cda8a8/targets/test'}}
pod4b400c3a-d474-11e9-9d26-329cee23a2e0
resultstorehttps://source.cloud.google.com/results/invocations/9ea6c7b1-9867-48e0-810e-4a1ee9cda8a8/targets/test
infra-commit3d071c448
job-versionv1.17.0-alpha.0.1229+3bf2b1258da74a
pod4b400c3a-d474-11e9-9d26-329cee23a2e0
revisionv1.17.0-alpha.0.1229+3bf2b1258da74a

Test Failures


Up 20m57s

waiting for ready nodes timed out
				from junit_runner.xml

Filter through log files | View test history on testgrid


Show 5 Passed Tests

Error lines from build-log.txt

... skipping 12 lines ...
I0911 09:13:21.091] process 45 exited with code 0 after 0.0m
I0911 09:13:21.092] Will upload results to gs://kubernetes-jenkins/logs using pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com
I0911 09:13:21.092] Root: /workspace
I0911 09:13:21.092] cd to /workspace
I0911 09:13:21.093] Configure environment...
I0911 09:13:21.093] Call:  git show -s --format=format:%ct HEAD
W0911 09:13:21.097] fatal: Not a git repository (or any of the parent directories): .git
I0911 09:13:21.098] process 57 exited with code 128 after 0.0m
W0911 09:13:21.098] Unable to print commit date for HEAD
I0911 09:13:21.099] Call:  gcloud auth activate-service-account --key-file=/etc/service-account/service-account.json
W0911 09:13:21.665] Activated service account credentials for: [pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com]
I0911 09:13:21.738] process 58 exited with code 0 after 0.0m
I0911 09:13:21.739] Call:  gcloud config get-value account
... skipping 701 lines ...
I0911 09:14:18.575]  * read about installing addons at: https://github.com/kubernetes/kops/blob/master/docs/addons.md.
I0911 09:14:18.575] 
W0911 09:14:18.683] 2019/09/11 09:14:18 process.go:155: Step '/workspace/kops update cluster e2e-kops-aws.test-cncf-aws.k8s.io --yes' finished in 20.338914318s
W0911 09:14:18.683] 2019/09/11 09:14:18 process.go:153: Running: kubectl get nodes -ojson
W0911 09:14:18.975] Unable to connect to the server: dial tcp: lookup api.e2e-kops-aws.test-cncf-aws.k8s.io on 10.63.240.10:53: no such host
W0911 09:14:18.982] 2019/09/11 09:14:18 process.go:155: Step 'kubectl get nodes -ojson' finished in 392.839388ms
W0911 09:14:18.983] 2019/09/11 09:14:18 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:14:18.984] 2019/09/11 09:14:18 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:14:48.983] 2019/09/11 09:14:48 process.go:153: Running: kubectl get nodes -ojson
W0911 09:15:19.232] Unable to connect to the server: dial tcp: lookup api.e2e-kops-aws.test-cncf-aws.k8s.io on 10.63.240.10:53: no such host
W0911 09:15:19.238] 2019/09/11 09:15:19 process.go:155: Step 'kubectl get nodes -ojson' finished in 30.254964026s
W0911 09:15:19.239] 2019/09/11 09:15:19 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:15:19.239] 2019/09/11 09:15:19 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:15:49.239] 2019/09/11 09:15:49 process.go:153: Running: kubectl get nodes -ojson
W0911 09:16:49.548] Unable to connect to the server: dial tcp: lookup api.e2e-kops-aws.test-cncf-aws.k8s.io on 10.63.240.10:53: no such host
W0911 09:16:49.552] 2019/09/11 09:16:49 process.go:155: Step 'kubectl get nodes -ojson' finished in 1m0.313795909s
W0911 09:16:49.553] 2019/09/11 09:16:49 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:16:49.553] 2019/09/11 09:16:49 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:17:19.554] 2019/09/11 09:17:19 process.go:153: Running: kubectl get nodes -ojson
W0911 09:17:19.779] Unable to connect to the server: dial tcp: lookup api.e2e-kops-aws.test-cncf-aws.k8s.io on 10.63.240.10:53: no such host
W0911 09:17:19.782] 2019/09/11 09:17:19 process.go:155: Step 'kubectl get nodes -ojson' finished in 228.359393ms
W0911 09:17:19.782] 2019/09/11 09:17:19 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:17:19.783] 2019/09/11 09:17:19 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:17:49.782] 2019/09/11 09:17:49 process.go:153: Running: kubectl get nodes -ojson
W0911 09:18:20.030] Unable to connect to the server: dial tcp: lookup api.e2e-kops-aws.test-cncf-aws.k8s.io on 10.63.240.10:53: no such host
W0911 09:18:20.039] 2019/09/11 09:18:20 process.go:155: Step 'kubectl get nodes -ojson' finished in 30.256866012s
W0911 09:18:20.041] 2019/09/11 09:18:20 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:18:20.041] 2019/09/11 09:18:20 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:18:50.040] 2019/09/11 09:18:50 process.go:153: Running: kubectl get nodes -ojson
W0911 09:19:20.323] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0911 09:19:20.325] 2019/09/11 09:19:20 process.go:155: Step 'kubectl get nodes -ojson' finished in 30.285423451s
W0911 09:19:20.326] 2019/09/11 09:19:20 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:19:20.326] 2019/09/11 09:19:20 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:19:50.327] 2019/09/11 09:19:50 process.go:153: Running: kubectl get nodes -ojson
W0911 09:22:20.508] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0911 09:22:20.513] 2019/09/11 09:22:20 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.185981644s
W0911 09:22:20.513] 2019/09/11 09:22:20 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:22:20.514] 2019/09/11 09:22:20 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:22:50.514] 2019/09/11 09:22:50 process.go:153: Running: kubectl get nodes -ojson
W0911 09:25:20.753] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0911 09:25:20.759] 2019/09/11 09:25:20 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.245209331s
W0911 09:25:20.761] 2019/09/11 09:25:20 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:25:20.761] 2019/09/11 09:25:20 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:25:50.760] 2019/09/11 09:25:50 process.go:153: Running: kubectl get nodes -ojson
W0911 09:28:20.914] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0911 09:28:20.915] 2019/09/11 09:28:20 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.155349083s
W0911 09:28:20.915] 2019/09/11 09:28:20 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:28:20.916] 2019/09/11 09:28:20 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:28:50.915] 2019/09/11 09:28:50 process.go:153: Running: kubectl get nodes -ojson
W0911 09:31:21.000] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0911 09:31:21.005] 2019/09/11 09:31:21 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.089091478s
W0911 09:31:21.005] 2019/09/11 09:31:21 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:31:21.006] 2019/09/11 09:31:21 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:31:51.005] 2019/09/11 09:31:51 process.go:153: Running: kubectl get nodes -ojson
W0911 09:34:21.116] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0911 09:34:21.119] 2019/09/11 09:34:21 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.113532985s
W0911 09:34:21.119] 2019/09/11 09:34:21 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:34:21.119] 2019/09/11 09:34:21 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0911 09:34:51.120] 2019/09/11 09:34:51 process.go:153: Running: /workspace/kops toolbox dump --name e2e-kops-aws.test-cncf-aws.k8s.io -ojson
W0911 09:34:55.714] 2019/09/11 09:34:55 process.go:155: Step '/workspace/kops toolbox dump --name e2e-kops-aws.test-cncf-aws.k8s.io -ojson' finished in 4.594594052s
W0911 09:34:55.715] 2019/09/11 09:34:55 process.go:153: Running: kubectl get nodes -ojson
W0911 09:37:25.815] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0911 09:37:25.819] 2019/09/11 09:37:25 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.104444984s
W0911 09:37:25.820] 2019/09/11 09:37:25 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0911 09:37:25.820] 2019/09/11 09:37:25 dump.go:89: Failed to get nodes for dumping via kubectl: error during kubectl get nodes -ojson: exit status 1
W0911 09:37:25.820] 2019/09/11 09:37:25 dump.go:123: dumping node not registered in kubernetes: 52.53.198.206
W0911 09:37:25.821] 2019/09/11 09:37:25 dump.go:157: Dumping node 52.53.198.206
W0911 09:37:26.303] 2019/09/11 09:37:26 dump.go:358: Running SSH command: sudo journalctl --output=short-precise -k
W0911 09:37:26.487] 2019/09/11 09:37:26 dump.go:358: Running SSH command: sudo journalctl --output=short-precise
W0911 09:37:29.182] 2019/09/11 09:37:29 dump.go:358: Running SSH command: sudo systemctl list-units -t service --no-pager --no-legend --all
W0911 09:37:29.275] 2019/09/11 09:37:29 dump.go:358: Running SSH command: sudo journalctl --output=cat -u kubelet.service
... skipping 160 lines ...
W0911 09:38:39.553]     check_env(env, self.command, *args)
W0911 09:38:39.553]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 111, in check_env
W0911 09:38:39.553]     subprocess.check_call(cmd, env=env)
W0911 09:38:39.553]   File "/usr/lib/python2.7/subprocess.py", line 186, in check_call
W0911 09:38:39.553]     raise CalledProcessError(retcode, cmd)
W0911 09:38:39.554] subprocess.CalledProcessError: Command '('/workspace/kops-e2e-runner.sh', '--dump=/workspace/_artifacts', '--gcp-service-account=/etc/service-account/service-account.json', '--up', '--down', '--test', '--provider=aws', '--cluster=e2e-kops-aws.test-cncf-aws.k8s.io', '--gcp-network=e2e-kops-aws.test-cncf-aws.k8s.io', '--extract=ci/latest', '--ginkgo-parallel', '--test_args=--ginkgo.flakeAttempts=2 --ginkgo.skip=\\[Slow\\]|\\[Serial\\]|\\[Disruptive\\]|\\[Flaky\\]|\\[Feature:.+\\]|\\[HPA\\]|Dashboard|Services.*functioning.*NodePort', '--timeout=120m', '--kops-cluster=e2e-kops-aws.test-cncf-aws.k8s.io', '--kops-zones=us-west-1a', '--kops-state=s3://k8s-kops-prow/', '--kops-nodes=4', '--kops-ssh-key=/workspace/.ssh/kube_aws_rsa', '--kops-ssh-user=admin')' returned non-zero exit status 1
E0911 09:38:39.554] Command failed
I0911 09:38:39.554] process 260 exited with code 1 after 25.3m
E0911 09:38:39.555] FAIL: ci-kubernetes-e2e-kops-aws
I0911 09:38:39.555] Call:  gcloud auth activate-service-account --key-file=/etc/service-account/service-account.json
W0911 09:38:40.141] Activated service account credentials for: [pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com]
I0911 09:38:40.198] process 623 exited with code 0 after 0.0m
I0911 09:38:40.198] Call:  gcloud config get-value account
I0911 09:38:40.544] process 635 exited with code 0 after 0.0m
I0911 09:38:40.545] Will upload results to gs://kubernetes-jenkins/logs using pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com
I0911 09:38:40.545] Upload result and artifacts...
I0911 09:38:40.545] Gubernator results at https://gubernator.k8s.io/build/kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws/1171713267509235714
I0911 09:38:40.546] Call:  gsutil ls gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws/1171713267509235714/artifacts
W0911 09:38:41.703] CommandException: One or more URLs matched no objects.
E0911 09:38:41.831] Command failed
I0911 09:38:41.831] process 647 exited with code 1 after 0.0m
W0911 09:38:41.832] Remote dir gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws/1171713267509235714/artifacts not exist yet
I0911 09:38:41.832] 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-kops-aws/1171713267509235714/artifacts
I0911 09:38:46.170] process 789 exited with code 0 after 0.1m
I0911 09:38:46.171] Call:  git rev-parse HEAD
W0911 09:38:46.176] fatal: Not a git repository (or any of the parent directories): .git
E0911 09:38:46.177] Command failed
I0911 09:38:46.177] process 1428 exited with code 128 after 0.0m
I0911 09:38:46.177] Call:  git rev-parse HEAD
I0911 09:38:46.183] process 1429 exited with code 0 after 0.0m
I0911 09:38:46.184] Call:  gsutil stat gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws/jobResultsCache.json
I0911 09:38:47.549] process 1430 exited with code 0 after 0.0m
I0911 09:38:47.550] Call:  gsutil -q cat 'gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws/jobResultsCache.json#1568192890275492'
... skipping 8 lines ...