This job view page is being replaced by Spyglass soon. Check out the new job view.
ResultFAILURE
Tests 1 failed / 5 succeeded
Started2019-07-22 06:56
Elapsed28m20s
Revision
Buildergke-prow-ssd-pool-1a225945-c9hz
links{u'resultstore': {u'url': u'https://source.cloud.google.com/results/invocations/4778fd68-cc7a-4b2c-830e-a14711714c0d/targets/test'}}
podc547092f-ac4d-11e9-b82b-365474bd0c86
resultstorehttps://source.cloud.google.com/results/invocations/4778fd68-cc7a-4b2c-830e-a14711714c0d/targets/test
infra-commit001214534
job-versionv1.16.0-alpha.1.124+c2a4369ba4f37e
podc547092f-ac4d-11e9-b82b-365474bd0c86
revisionv1.16.0-alpha.1.124+c2a4369ba4f37e

Test Failures


Up 23m4s

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 ...
I0722 06:56:31.827] process 44 exited with code 0 after 0.0m
I0722 06:56:31.827] Will upload results to gs://kubernetes-jenkins/logs using pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com
I0722 06:56:31.828] Root: /workspace
I0722 06:56:31.828] cd to /workspace
I0722 06:56:31.828] Configure environment...
I0722 06:56:31.829] Call:  git show -s --format=format:%ct HEAD
W0722 06:56:31.833] fatal: Not a git repository (or any of the parent directories): .git
I0722 06:56:31.834] process 56 exited with code 128 after 0.0m
W0722 06:56:31.835] Unable to print commit date for HEAD
I0722 06:56:31.835] Call:  gcloud auth activate-service-account --key-file=/etc/service-account/service-account.json
W0722 06:56:32.347] Activated service account credentials for: [pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com]
I0722 06:56:32.476] process 57 exited with code 0 after 0.0m
I0722 06:56:32.476] Call:  gcloud config get-value account
... skipping 602 lines ...
I0722 06:57:39.978]  * read about installing addons at: https://github.com/kubernetes/kops/blob/master/docs/addons.md.
I0722 06:57:39.978] 
W0722 06:57:40.079] 2019/07/22 06:57:39 process.go:155: Step '/tmp/kops254452279/kops update cluster e2e-kops-aws-newrunner.test-cncf-aws.k8s.io --yes' finished in 24.496149564s
W0722 06:57:40.079] 2019/07/22 06:57:39 process.go:153: Running: kubectl get nodes -ojson
W0722 06:57:40.219] Unable to connect to the server: dial tcp: lookup api.e2e-kops-aws-newrunner.test-cncf-aws.k8s.io on 10.63.240.10:53: no such host
W0722 06:57:40.222] 2019/07/22 06:57:40 process.go:155: Step 'kubectl get nodes -ojson' finished in 237.251509ms
W0722 06:57:40.222] 2019/07/22 06:57:40 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 06:57:40.222] 2019/07/22 06:57:40 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0722 06:58:10.223] 2019/07/22 06:58:10 process.go:153: Running: kubectl get nodes -ojson
W0722 06:59:10.360] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0722 06:59:10.364] 2019/07/22 06:59:10 process.go:155: Step 'kubectl get nodes -ojson' finished in 1m0.141961669s
W0722 06:59:10.365] 2019/07/22 06:59:10 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 06:59:10.365] 2019/07/22 06:59:10 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0722 06:59:40.365] 2019/07/22 06:59:40 process.go:153: Running: kubectl get nodes -ojson
W0722 07:00:10.516] Unable to connect to the server: dial tcp: lookup api.e2e-kops-aws-newrunner.test-cncf-aws.k8s.io on 10.63.240.10:53: no such host
W0722 07:00:10.520] 2019/07/22 07:00:10 process.go:155: Step 'kubectl get nodes -ojson' finished in 30.155528915s
W0722 07:00:10.521] 2019/07/22 07:00:10 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 07:00:10.521] 2019/07/22 07:00:10 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0722 07:00:40.524] 2019/07/22 07:00:40 process.go:153: Running: kubectl get nodes -ojson
W0722 07:01:40.643] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0722 07:01:40.647] 2019/07/22 07:01:40 process.go:155: Step 'kubectl get nodes -ojson' finished in 1m0.122633636s
W0722 07:01:40.647] 2019/07/22 07:01:40 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 07:01:40.647] 2019/07/22 07:01:40 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0722 07:02:10.647] 2019/07/22 07:02:10 process.go:153: Running: kubectl get nodes -ojson
W0722 07:04:40.728] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0722 07:04:40.733] 2019/07/22 07:04:40 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.085961476s
W0722 07:04:40.734] 2019/07/22 07:04:40 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 07:04:40.734] 2019/07/22 07:04:40 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0722 07:05:10.734] 2019/07/22 07:05:10 process.go:153: Running: kubectl get nodes -ojson
W0722 07:07:40.850] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0722 07:07:40.854] 2019/07/22 07:07:40 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.120347825s
W0722 07:07:40.854] 2019/07/22 07:07:40 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 07:07:40.855] 2019/07/22 07:07:40 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0722 07:08:10.855] 2019/07/22 07:08:10 process.go:153: Running: kubectl get nodes -ojson
W0722 07:10:40.938] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0722 07:10:40.939] 2019/07/22 07:10:40 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.085011337s
W0722 07:10:40.940] 2019/07/22 07:10:40 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 07:10:40.940] 2019/07/22 07:10:40 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0722 07:11:10.940] 2019/07/22 07:11:10 process.go:153: Running: kubectl get nodes -ojson
W0722 07:13:41.032] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0722 07:13:41.037] 2019/07/22 07:13:41 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.096720548s
W0722 07:13:41.037] 2019/07/22 07:13:41 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 07:13:41.037] 2019/07/22 07:13:41 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0722 07:14:11.037] 2019/07/22 07:14:11 process.go:153: Running: kubectl get nodes -ojson
W0722 07:16:41.126] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0722 07:16:41.126] 2019/07/22 07:16:41 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.089263194s
W0722 07:16:41.127] 2019/07/22 07:16:41 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 07:16:41.127] 2019/07/22 07:16:41 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0722 07:17:11.127] 2019/07/22 07:17:11 process.go:153: Running: kubectl get nodes -ojson
W0722 07:19:41.213] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0722 07:19:41.217] 2019/07/22 07:19:41 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.090713784s
W0722 07:19:41.218] 2019/07/22 07:19:41 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 07:19:41.218] 2019/07/22 07:19:41 kubernetes.go:69: kubectl get nodes failed, sleeping: error during kubectl get nodes -ojson: exit status 1
W0722 07:20:11.219] 2019/07/22 07:20:11 process.go:153: Running: /tmp/kops254452279/kops toolbox dump --name e2e-kops-aws-newrunner.test-cncf-aws.k8s.io -ojson
W0722 07:20:20.962] 2019/07/22 07:20:20 process.go:155: Step '/tmp/kops254452279/kops toolbox dump --name e2e-kops-aws-newrunner.test-cncf-aws.k8s.io -ojson' finished in 9.742891632s
W0722 07:20:20.963] 2019/07/22 07:20:20 process.go:153: Running: kubectl get nodes -ojson
W0722 07:22:51.035] Unable to connect to the server: dial tcp 203.0.113.123:443: i/o timeout
W0722 07:22:51.040] 2019/07/22 07:22:51 process.go:155: Step 'kubectl get nodes -ojson' finished in 2m30.076929732s
W0722 07:22:51.040] 2019/07/22 07:22:51 kubernetes.go:34: kubectl get nodes failed: error during kubectl get nodes -ojson: exit status 1
W0722 07:22:51.040] 2019/07/22 07:22:51 dump.go:89: Failed to get nodes for dumping via kubectl: error during kubectl get nodes -ojson: exit status 1
W0722 07:22:51.040] 2019/07/22 07:22:51 dump.go:123: dumping node not registered in kubernetes: 54.252.151.102
W0722 07:22:51.040] 2019/07/22 07:22:51 dump.go:157: Dumping node 54.252.151.102
W0722 07:22:53.119] 2019/07/22 07:22:53 dump.go:358: Running SSH command: sudo journalctl --output=short-precise -k
W0722 07:22:53.946] 2019/07/22 07:22:53 dump.go:358: Running SSH command: sudo journalctl --output=short-precise
W0722 07:23:01.419] 2019/07/22 07:23:01 dump.go:358: Running SSH command: sudo systemctl list-units -t service --no-pager --no-legend --all
W0722 07:23:01.831] 2019/07/22 07:23:01 dump.go:358: Running SSH command: sudo journalctl --output=cat -u kubelet.service
... skipping 150 lines ...
W0722 07:24:40.970]     check_env(env, self.command, *args)
W0722 07:24:40.970]   File "/workspace/./test-infra/jenkins/../scenarios/kubernetes_e2e.py", line 111, in check_env
W0722 07:24:40.970]     subprocess.check_call(cmd, env=env)
W0722 07:24:40.970]   File "/usr/lib/python2.7/subprocess.py", line 186, in check_call
W0722 07:24:40.970]     raise CalledProcessError(retcode, cmd)
W0722 07:24:40.971] subprocess.CalledProcessError: Command '('kubetest', '--dump=/workspace/_artifacts', '--gcp-service-account=/etc/service-account/service-account.json', '--up', '--down', '--test', '--deployment=kops', '--provider=aws', '--cluster=e2e-kops-aws-newrunner.test-cncf-aws.k8s.io', '--gcp-network=e2e-kops-aws-newrunner.test-cncf-aws.k8s.io', '--extract=ci/latest', '--ginkgo-parallel', '--kops-version=https://storage.googleapis.com/kops-ci/bin/latest-ci-updown-green.txt', '--test_args=--ginkgo.flakeAttempts=2 --ginkgo.skip=\\[Slow\\]|\\[Serial\\]|\\[Disruptive\\]|\\[Flaky\\]|\\[Feature:.+\\]|\\[HPA\\]|Dashboard|Services.*functioning.*NodePort', '--timeout=120m', '--kops-zones=ap-southeast-2c', '--kops-cluster=e2e-kops-aws-newrunner.test-cncf-aws.k8s.io', '--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
E0722 07:24:40.971] Command failed
I0722 07:24:40.971] process 259 exited with code 1 after 28.1m
E0722 07:24:40.971] FAIL: ci-kubernetes-e2e-kops-aws-newrunner
I0722 07:24:40.972] Call:  gcloud auth activate-service-account --key-file=/etc/service-account/service-account.json
W0722 07:24:41.466] Activated service account credentials for: [pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com]
I0722 07:24:41.515] process 595 exited with code 0 after 0.0m
I0722 07:24:41.516] Call:  gcloud config get-value account
I0722 07:24:41.812] process 607 exited with code 0 after 0.0m
I0722 07:24:41.812] Will upload results to gs://kubernetes-jenkins/logs using pr-kubekins@kubernetes-jenkins-pull.iam.gserviceaccount.com
I0722 07:24:41.812] Upload result and artifacts...
I0722 07:24:41.812] Gubernator results at https://gubernator.k8s.io/build/kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws-newrunner/1153197060225241091
I0722 07:24:41.813] Call:  gsutil ls gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws-newrunner/1153197060225241091/artifacts
W0722 07:24:42.905] CommandException: One or more URLs matched no objects.
E0722 07:24:43.021] Command failed
I0722 07:24:43.021] process 619 exited with code 1 after 0.0m
W0722 07:24:43.021] Remote dir gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws-newrunner/1153197060225241091/artifacts not exist yet
I0722 07:24:43.022] 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-newrunner/1153197060225241091/artifacts
I0722 07:24:47.068] process 761 exited with code 0 after 0.1m
I0722 07:24:47.069] Call:  git rev-parse HEAD
W0722 07:24:47.073] fatal: Not a git repository (or any of the parent directories): .git
E0722 07:24:47.074] Command failed
I0722 07:24:47.074] process 1400 exited with code 128 after 0.0m
I0722 07:24:47.074] Call:  git rev-parse HEAD
I0722 07:24:47.079] process 1401 exited with code 0 after 0.0m
I0722 07:24:47.079] Call:  gsutil stat gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws-newrunner/jobResultsCache.json
I0722 07:24:48.146] process 1402 exited with code 0 after 0.0m
I0722 07:24:48.147] Call:  gsutil -q cat 'gs://kubernetes-jenkins/logs/ci-kubernetes-e2e-kops-aws-newrunner/jobResultsCache.json#1563776651133465'
... skipping 8 lines ...