This job view page is being replaced by Spyglass soon. Check out the new job view.
ResultFAILURE
Tests 1 failed / 5 succeeded
Started2019-09-15 20:48
Elapsed27m34s
Revision
Buildergke-prow-ssd-pool-1a225945-n47b
links{u'resultstore': {u'url': u'https://source.cloud.google.com/results/invocations/ef74df3d-9e35-476a-9e2f-3ea594c70fb1/targets/test'}}
pod13ebbd5d-d7fa-11e9-9f18-22ab134e4c57
resultstorehttps://source.cloud.google.com/results/invocations/ef74df3d-9e35-476a-9e2f-3ea594c70fb1/targets/test
infra-commite1cbc3ccd
job-versionv1.17.0-alpha.0.1440+ba07527278ef2c
pod13ebbd5d-d7fa-11e9-9f18-22ab134e4c57
revisionv1.17.0-alpha.0.1440+ba07527278ef2c

Test Failures


Up 22m55s

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 ...
I0915 20:48:11.884] process 45 exited with code 0 after 0.0m
I0915 20:48:11.884] Will upload results to gs://kubernetes-jenkins/logs using pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com
I0915 20:48:11.885] Root: /workspace
I0915 20:48:11.885] cd to /workspace
I0915 20:48:11.885] Configure environment...
I0915 20:48:11.885] Call:  git show -s --format=format:%ct HEAD
W0915 20:48:11.889] fatal: Not a git repository (or any of the parent directories): .git
I0915 20:48:11.889] process 57 exited with code 128 after 0.0m
W0915 20:48:11.890] Unable to print commit date for HEAD
I0915 20:48:11.890] Call:  gcloud auth activate-service-account --key-file=/etc/service-account/service-account.json
W0915 20:48:12.404] Activated service account credentials for: [pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com]
I0915 20:48:12.445] process 58 exited with code 0 after 0.0m
I0915 20:48:12.446] Call:  gcloud config get-value account
... skipping 701 lines ...
I0915 20:49:08.536]  * read about installing addons at: https://github.com/kubernetes/kops/blob/master/docs/addons.md.
I0915 20:49:08.536] 
W0915 20:49:08.637] 2019/09/15 20:49:08 process.go:155: Step '/workspace/kops update cluster e2e-kops-aws.test-cncf-aws.k8s.io --yes' finished in 19.787719813s
W0915 20:49:08.637] 2019/09/15 20:49:08 process.go:153: Running: kubectl get nodes -ojson
W0915 20:49:08.716] 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
W0915 20:49:08.720] 2019/09/15 20:49:08 process.go:155: Step 'kubectl get nodes -ojson' finished in 180.287927ms
W0915 20:49:08.720] 2019/09/15 20:49:08 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0915 20:49:08.720] 2019/09/15 20:49:08 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0915 20:49:38.720] 2019/09/15 20:49:38 process.go:153: Running: kubectl get nodes -ojson
W0915 20:51:08.829] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0915 20:51:08.831] 2019/09/15 20:51:08 process.go:155: Step 'kubectl get nodes -ojson' finished in 1m30.110875125s
W0915 20:51:08.831] 2019/09/15 20:51:08 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0915 20:51:08.832] 2019/09/15 20:51:08 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0915 20:51:38.832] 2019/09/15 20:51:38 process.go:153: Running: kubectl get nodes -ojson
W0915 20:53:08.942] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0915 20:53:08.944] 2019/09/15 20:53:08 process.go:155: Step 'kubectl get nodes -ojson' finished in 1m30.112663722s
W0915 20:53:08.944] 2019/09/15 20:53:08 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0915 20:53:08.945] 2019/09/15 20:53:08 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0915 20:53:38.945] 2019/09/15 20:53:38 process.go:153: Running: kubectl get nodes -ojson
W0915 20:56:09.029] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0915 20:56:09.030] 2019/09/15 20:56:09 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.084835248s
W0915 20:56:09.030] 2019/09/15 20:56:09 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0915 20:56:09.030] 2019/09/15 20:56:09 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0915 20:56:39.030] 2019/09/15 20:56:39 process.go:153: Running: kubectl get nodes -ojson
W0915 20:59:09.096] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0915 20:59:09.098] 2019/09/15 20:59:09 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.068361078s
W0915 20:59:09.098] 2019/09/15 20:59:09 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0915 20:59:09.098] 2019/09/15 20:59:09 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0915 20:59:39.098] 2019/09/15 20:59:39 process.go:153: Running: kubectl get nodes -ojson
W0915 21:02:09.175] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0915 21:02:09.175] 2019/09/15 21:02:09 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.076504883s
W0915 21:02:09.175] 2019/09/15 21:02:09 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0915 21:02:09.176] 2019/09/15 21:02:09 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0915 21:02:39.175] 2019/09/15 21:02:39 process.go:153: Running: kubectl get nodes -ojson
W0915 21:05:09.248] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0915 21:05:09.251] 2019/09/15 21:05:09 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.076181318s
W0915 21:05:09.251] 2019/09/15 21:05:09 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0915 21:05:09.252] 2019/09/15 21:05:09 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0915 21:05:39.252] 2019/09/15 21:05:39 process.go:153: Running: kubectl get nodes -ojson
W0915 21:08:09.339] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0915 21:08:09.341] 2019/09/15 21:08:09 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.089450973s
W0915 21:08:09.341] 2019/09/15 21:08:09 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0915 21:08:09.342] 2019/09/15 21:08:09 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0915 21:08:39.342] 2019/09/15 21:08:39 process.go:153: Running: kubectl get nodes -ojson
W0915 21:11:09.437] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0915 21:11:09.437] 2019/09/15 21:11:09 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.094772909s
W0915 21:11:09.437] 2019/09/15 21:11:09 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0915 21:11:09.437] 2019/09/15 21:11:09 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0915 21:11:39.438] 2019/09/15 21:11:39 process.go:153: Running: /workspace/kops toolbox dump --name e2e-kops-aws.test-cncf-aws.k8s.io -ojson
W0915 21:11:44.074] 2019/09/15 21:11:44 process.go:155: Step '/workspace/kops toolbox dump --name e2e-kops-aws.test-cncf-aws.k8s.io -ojson' finished in 4.634472018s
W0915 21:11:44.074] 2019/09/15 21:11:44 process.go:153: Running: kubectl get nodes -ojson
W0915 21:14:14.137] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0915 21:14:14.140] 2019/09/15 21:14:14 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.066052692s
W0915 21:14:14.140] 2019/09/15 21:14:14 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0915 21:14:14.140] 2019/09/15 21:14:14 dump.go:89: Failed to get nodes for dumping via kubectl: error during kubectl get nodes -ojson: exit status 1
W0915 21:14:14.141] 2019/09/15 21:14:14 dump.go:123: dumping node not registered in kubernetes: 35.182.115.109
W0915 21:14:14.141] 2019/09/15 21:14:14 dump.go:157: Dumping node 35.182.115.109
W0915 21:14:14.488] 2019/09/15 21:14:14 dump.go:358: Running SSH command: sudo journalctl --output=short-precise -k
W0915 21:14:14.705] 2019/09/15 21:14:14 dump.go:358: Running SSH command: sudo journalctl --output=short-precise
W0915 21:14:18.415] 2019/09/15 21:14:18 dump.go:358: Running SSH command: sudo systemctl list-units -t service --no-pager --no-legend --all
W0915 21:14:18.486] 2019/09/15 21:14:18 dump.go:358: Running SSH command: sudo journalctl --output=cat -u kubelet.service
... skipping 170 lines ...
W0915 21:15:36.528]     check_env(env, self.command, *args)
W0915 21:15:36.529]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 111, in check_env
W0915 21:15:36.529]     subprocess.check_call(cmd, env=env)
W0915 21:15:36.529]   File "/usr/lib/python2.7/subprocess.py", line 186, in check_call
W0915 21:15:36.529]     raise CalledProcessError(retcode, cmd)
W0915 21:15:36.529] 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=ca-central-1b', '--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
E0915 21:15:36.530] Command failed
I0915 21:15:36.530] process 260 exited with code 1 after 27.4m
E0915 21:15:36.530] FAIL: ci-kubernetes-e2e-kops-aws
I0915 21:15:36.530] Call:  gcloud auth activate-service-account --key-file=/etc/service-account/service-account.json
W0915 21:15:36.992] Activated service account credentials for: [pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com]
I0915 21:15:37.033] process 620 exited with code 0 after 0.0m
I0915 21:15:37.034] Call:  gcloud config get-value account
I0915 21:15:37.302] process 632 exited with code 0 after 0.0m
I0915 21:15:37.303] Will upload results to gs://kubernetes-jenkins/logs using pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com
I0915 21:15:37.303] Upload result and artifacts...
I0915 21:15:37.303] Gubernator results at https://gubernator.k8s.io/build/kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws/1173337692222525446
I0915 21:15:37.303] Call:  gsutil ls gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws/1173337692222525446/artifacts
W0915 21:15:38.234] CommandException: One or more URLs matched no objects.
E0915 21:15:38.336] Command failed
I0915 21:15:38.336] process 644 exited with code 1 after 0.0m
W0915 21:15:38.336] Remote dir gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws/1173337692222525446/artifacts not exist yet
I0915 21:15:38.336] 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/1173337692222525446/artifacts
I0915 21:15:42.056] process 786 exited with code 0 after 0.1m
I0915 21:15:42.056] Call:  git rev-parse HEAD
W0915 21:15:42.059] fatal: Not a git repository (or any of the parent directories): .git
E0915 21:15:42.060] Command failed
I0915 21:15:42.060] process 1425 exited with code 128 after 0.0m
I0915 21:15:42.060] Call:  git rev-parse HEAD
I0915 21:15:42.064] process 1426 exited with code 0 after 0.0m
I0915 21:15:42.064] Call:  gsutil stat gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws/jobResultsCache.json
I0915 21:15:43.070] process 1427 exited with code 0 after 0.0m
I0915 21:15:43.071] Call:  gsutil -q cat 'gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws/jobResultsCache.json#1568580166051702'
... skipping 8 lines ...