2025-03-26 12:33:38.597221 | Job console starting... 2025-03-26 12:33:38.622271 | Updating repositories 2025-03-26 12:33:38.643708 | Preparing job workspace 2025-03-26 12:33:39.430548 | Running Ansible setup... 2025-03-26 12:33:44.553380 | PRE-RUN START: [trusted : github.com/regiocloud/zuul-config/playbooks/base/pre.yaml@main] 2025-03-26 12:33:45.247074 | 2025-03-26 12:33:45.247225 | PLAY [Base pre] 2025-03-26 12:33:45.276459 | 2025-03-26 12:33:45.276594 | TASK [Setup log path fact] 2025-03-26 12:33:45.308167 | ubuntu-jammy | ok 2025-03-26 12:33:45.326411 | 2025-03-26 12:33:45.326535 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-03-26 12:33:45.370014 | ubuntu-jammy | ok 2025-03-26 12:33:45.383653 | 2025-03-26 12:33:45.383807 | TASK [emit-job-header : Print job information] 2025-03-26 12:33:45.443214 | # Job Information 2025-03-26 12:33:45.443447 | Ansible Version: 2.15.3 2025-03-26 12:33:45.443504 | Job: e2e-tests-gardener-1.30-quick 2025-03-26 12:33:45.443558 | Pipeline: periodic-hourly 2025-03-26 12:33:45.443594 | Executor: 7d211f194f6a 2025-03-26 12:33:45.443628 | Triggered by: https://github.com/regiocloud/e2e-tests 2025-03-26 12:33:45.443661 | Event ID: ddd6ea1193b246a8b60c7a57537a1305 2025-03-26 12:33:45.453933 | 2025-03-26 12:33:45.454062 | LOOP [emit-job-header : Print node information] 2025-03-26 12:33:45.601053 | ubuntu-jammy | ok: 2025-03-26 12:33:45.601284 | ubuntu-jammy | # Node Information 2025-03-26 12:33:45.601338 | ubuntu-jammy | Inventory Hostname: ubuntu-jammy 2025-03-26 12:33:45.601383 | ubuntu-jammy | Hostname: ubuntu 2025-03-26 12:33:45.601419 | ubuntu-jammy | Username: zuul 2025-03-26 12:33:45.601452 | ubuntu-jammy | Distro: Ubuntu 22.04 2025-03-26 12:33:45.601491 | ubuntu-jammy | Provider: regiocloud-a 2025-03-26 12:33:45.601525 | ubuntu-jammy | Label: ubuntu-jammy 2025-03-26 12:33:45.601559 | ubuntu-jammy | Product Name: OpenStack Nova 2025-03-26 12:33:45.601590 | ubuntu-jammy | Interface IP: 81.163.193.196 2025-03-26 12:33:45.633369 | 2025-03-26 12:33:45.633502 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-03-26 12:33:46.100501 | ubuntu-jammy -> localhost | changed 2025-03-26 12:33:46.115166 | 2025-03-26 12:33:46.115306 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-03-26 12:33:47.152055 | ubuntu-jammy -> localhost | changed 2025-03-26 12:33:47.179248 | 2025-03-26 12:33:47.179384 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-03-26 12:33:47.481188 | ubuntu-jammy -> localhost | ok 2025-03-26 12:33:47.494126 | 2025-03-26 12:33:47.494273 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-03-26 12:33:47.533491 | ubuntu-jammy | ok 2025-03-26 12:33:47.554186 | ubuntu-jammy | included: /var/lib/zuul/builds/073bcae86ea14028853b1c148aabe018/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-03-26 12:33:47.562555 | 2025-03-26 12:33:47.562650 | TASK [add-build-sshkey : Create Temp SSH key] 2025-03-26 12:33:48.167336 | ubuntu-jammy -> localhost | Generating public/private rsa key pair. 2025-03-26 12:33:48.167674 | ubuntu-jammy -> localhost | Your identification has been saved in /var/lib/zuul/builds/073bcae86ea14028853b1c148aabe018/work/073bcae86ea14028853b1c148aabe018_id_rsa 2025-03-26 12:33:48.167754 | ubuntu-jammy -> localhost | Your public key has been saved in /var/lib/zuul/builds/073bcae86ea14028853b1c148aabe018/work/073bcae86ea14028853b1c148aabe018_id_rsa.pub 2025-03-26 12:33:48.167796 | ubuntu-jammy -> localhost | The key fingerprint is: 2025-03-26 12:33:48.167834 | ubuntu-jammy -> localhost | SHA256:Bay0J0rPnHz8SRDIFjA2qJ1DN3z9O+vcIf8ZoitM41U zuul-build-sshkey 2025-03-26 12:33:48.167869 | ubuntu-jammy -> localhost | The key's randomart image is: 2025-03-26 12:33:48.167902 | ubuntu-jammy -> localhost | +---[RSA 3072]----+ 2025-03-26 12:33:48.167934 | ubuntu-jammy -> localhost | | o=o.=. | 2025-03-26 12:33:48.167966 | ubuntu-jammy -> localhost | | o.+o* +. | 2025-03-26 12:33:48.167998 | ubuntu-jammy -> localhost | | + o = o o. | 2025-03-26 12:33:48.168043 | ubuntu-jammy -> localhost | |. + . + o.. E | 2025-03-26 12:33:48.168075 | ubuntu-jammy -> localhost | | o * =S. o | 2025-03-26 12:33:48.168107 | ubuntu-jammy -> localhost | | . * = = | 2025-03-26 12:33:48.168147 | ubuntu-jammy -> localhost | | = =.+o . | 2025-03-26 12:33:48.168181 | ubuntu-jammy -> localhost | | +.+= o o | 2025-03-26 12:33:48.168212 | ubuntu-jammy -> localhost | | o=.o.o | 2025-03-26 12:33:48.168244 | ubuntu-jammy -> localhost | +----[SHA256]-----+ 2025-03-26 12:33:48.168324 | ubuntu-jammy -> localhost | ok: Runtime: 0:00:00.113225 2025-03-26 12:33:48.181317 | 2025-03-26 12:33:48.181453 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-03-26 12:33:48.230634 | ubuntu-jammy | ok 2025-03-26 12:33:48.246655 | ubuntu-jammy | included: /var/lib/zuul/builds/073bcae86ea14028853b1c148aabe018/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-03-26 12:33:48.260621 | 2025-03-26 12:33:48.260896 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-03-26 12:33:48.291089 | ubuntu-jammy | skipping: Conditional result was False 2025-03-26 12:33:48.305843 | 2025-03-26 12:33:48.306019 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-03-26 12:33:49.001676 | ubuntu-jammy | changed 2025-03-26 12:33:49.018541 | 2025-03-26 12:33:49.018690 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-03-26 12:33:49.295053 | ubuntu-jammy | ok 2025-03-26 12:33:49.304674 | 2025-03-26 12:33:49.304814 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-03-26 12:33:49.990030 | ubuntu-jammy | changed 2025-03-26 12:33:49.999678 | 2025-03-26 12:33:49.999837 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-03-26 12:33:50.663396 | ubuntu-jammy | changed 2025-03-26 12:33:50.672773 | 2025-03-26 12:33:50.672900 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-03-26 12:33:50.697934 | ubuntu-jammy | skipping: Conditional result was False 2025-03-26 12:33:50.713124 | 2025-03-26 12:33:50.713273 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-03-26 12:33:51.149644 | ubuntu-jammy -> localhost | changed 2025-03-26 12:33:51.172774 | 2025-03-26 12:33:51.172909 | TASK [add-build-sshkey : Add back temp key] 2025-03-26 12:33:51.525622 | ubuntu-jammy -> localhost | Identity added: /var/lib/zuul/builds/073bcae86ea14028853b1c148aabe018/work/073bcae86ea14028853b1c148aabe018_id_rsa (zuul-build-sshkey) 2025-03-26 12:33:51.526024 | ubuntu-jammy -> localhost | ok: Runtime: 0:00:00.014613 2025-03-26 12:33:51.536492 | 2025-03-26 12:33:51.536608 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-03-26 12:33:51.958941 | ubuntu-jammy | ok 2025-03-26 12:33:51.968799 | 2025-03-26 12:33:51.968929 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-03-26 12:33:52.004639 | ubuntu-jammy | skipping: Conditional result was False 2025-03-26 12:33:52.025669 | 2025-03-26 12:33:52.025833 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-03-26 12:33:52.475433 | ubuntu-jammy | ok 2025-03-26 12:33:52.526368 | 2025-03-26 12:33:52.526498 | TASK [validate-host : Define zuul_info_dir fact] 2025-03-26 12:33:52.569081 | ubuntu-jammy | ok 2025-03-26 12:33:52.575756 | 2025-03-26 12:33:52.575859 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-03-26 12:33:52.856639 | ubuntu-jammy -> localhost | ok 2025-03-26 12:33:52.868650 | 2025-03-26 12:33:52.868816 | TASK [validate-host : Collect information about the host] 2025-03-26 12:33:54.146270 | ubuntu-jammy | ok 2025-03-26 12:33:54.158784 | 2025-03-26 12:33:54.158908 | TASK [validate-host : Sanitize hostname] 2025-03-26 12:33:54.232031 | ubuntu-jammy | ok 2025-03-26 12:33:54.238511 | 2025-03-26 12:33:54.238617 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-03-26 12:33:54.794774 | ubuntu-jammy -> localhost | changed 2025-03-26 12:33:54.809601 | 2025-03-26 12:33:54.809800 | TASK [validate-host : Collect information about zuul worker] 2025-03-26 12:33:55.261863 | ubuntu-jammy | ok 2025-03-26 12:33:55.273356 | 2025-03-26 12:33:55.273493 | TASK [validate-host : Write out all zuul information for each host] 2025-03-26 12:33:55.851263 | ubuntu-jammy -> localhost | changed 2025-03-26 12:33:55.872189 | 2025-03-26 12:33:55.872306 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-03-26 12:33:56.149862 | ubuntu-jammy | ok 2025-03-26 12:33:56.157301 | 2025-03-26 12:33:56.157400 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-03-26 12:33:56.943328 | ubuntu-jammy | changed: 2025-03-26 12:33:56.943640 | ubuntu-jammy | cd+++++++++ src/ 2025-03-26 12:33:56.943711 | ubuntu-jammy | cd+++++++++ src/github.com/ 2025-03-26 12:33:56.943783 | ubuntu-jammy | cd+++++++++ src/github.com/regiocloud/ 2025-03-26 12:33:56.943829 | ubuntu-jammy | cd+++++++++ src/github.com/regiocloud/e2e-tests/ 2025-03-26 12:33:56.943871 | ubuntu-jammy | :182): Cannot iterate over null (null) 2025-03-26 12:34:37.669851 | ubuntu-jammy | + [[ '' =~ False ]] 2025-03-26 12:34:37.669930 | ubuntu-jammy | + kubectl get shoots 2025-03-26 12:34:37.845342 | ubuntu-jammy | NAME CLOUDPROFILE PROVIDER REGION K8S VERSION HIBERNATION LAST OPERATION STATUS AGE 2025-03-26 12:34:37.845781 | ubuntu-jammy | 073bcae8 regiocloud openstack RegionA 1.30.11 Awake Create Pending (0%) healthy 10s 2025-03-26 12:34:37.850436 | ubuntu-jammy | + '[' -n '' ']' 2025-03-26 12:34:37.851106 | ubuntu-jammy | + '[' -n '' ']' 2025-03-26 12:34:37.851190 | ubuntu-jammy | ++ uuidgen 2025-03-26 12:34:37.853704 | ubuntu-jammy | + export GCTL_SESSION_ID=dd59d6bc-6d86-4530-b56c-6c2f01c2a703 2025-03-26 12:34:38.119555 | ubuntu-jammy | + GCTL_SESSION_ID=dd59d6bc-6d86-4530-b56c-6c2f01c2a703 2025-03-26 12:34:38.119683 | ubuntu-jammy | + gardenctl target --garden e2e --project cruv4yqhsc --shoot 073bcae8 2025-03-26 12:34:38.119723 | ubuntu-jammy | Error: no advertised addresses listed in the Shoot status for the Shoot Kube API server 2025-03-26 12:34:38.342482 | ubuntu-jammy | ERROR 2025-03-26 12:34:38.342962 | ubuntu-jammy | { 2025-03-26 12:34:38.343081 | ubuntu-jammy | "delta": "0:00:11.545751", 2025-03-26 12:34:38.343157 | ubuntu-jammy | "end": "2025-03-26 12:34:38.128705", 2025-03-26 12:34:38.343229 | ubuntu-jammy | "msg": "non-zero return code", 2025-03-26 12:34:38.343292 | ubuntu-jammy | "rc": 1, 2025-03-26 12:34:38.343349 | ubuntu-jammy | "start": "2025-03-26 12:34:26.582954" 2025-03-26 12:34:38.343404 | ubuntu-jammy | } failure 2025-03-26 12:34:38.347758 | 2025-03-26 12:34:38.347895 | PLAY RECAP 2025-03-26 12:34:38.348000 | ubuntu-jammy | ok: 4 changed: 3 unreachable: 0 failed: 1 skipped: 0 rescued: 0 ignored: 0 2025-03-26 12:34:38.348055 | 2025-03-26 12:34:38.464589 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/regiocloud/e2e-tests/playbooks/gardener/pre.yml@main] 2025-03-26 12:34:38.471438 | POST-RUN START: [untrusted : github.com/regiocloud/e2e-tests/playbooks/gardener/post.yml@main] 2025-03-26 12:34:39.147738 | 2025-03-26 12:34:39.147883 | PLAY [Post play] 2025-03-26 12:34:39.174485 | 2025-03-26 12:34:39.174612 | TASK [Run post script] 2025-03-26 12:34:39.658765 | ubuntu-jammy | + export KUBECONFIG=kubeconfig.yaml 2025-03-26 12:34:39.891360 | ubuntu-jammy | + KUBECONFIG=kubeconfig.yaml 2025-03-26 12:34:39.891446 | ubuntu-jammy | + kubectl annotate confirmation.gardener.cloud/deletion=true -f deployment.yaml 2025-03-26 12:34:39.891475 | ubuntu-jammy | shoot.core.gardener.cloud/073bcae8 annotated 2025-03-26 12:34:39.894321 | ubuntu-jammy | + kubectl delete -f deployment.yaml 2025-03-26 12:34:40.056286 | ubuntu-jammy | shoot.core.gardener.cloud "073bcae8" deleted 2025-03-26 12:34:40.213475 | ubuntu-jammy | ok 2025-03-26 12:34:40.249237 | 2025-03-26 12:34:40.249336 | PLAY RECAP 2025-03-26 12:34:40.249396 | ubuntu-jammy | ok: 1 changed: 0 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2025-03-26 12:34:40.249428 | 2025-03-26 12:34:40.350677 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/regiocloud/e2e-tests/playbooks/gardener/post.yml@main] 2025-03-26 12:34:40.353581 | POST-RUN START: [trusted : github.com/regiocloud/zuul-config/playbooks/base/post.yaml@main] 2025-03-26 12:34:41.012274 | 2025-03-26 12:34:41.012453 | PLAY [Base post] 2025-03-26 12:34:41.037538 | 2025-03-26 12:34:41.037672 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2025-03-26 12:34:41.609438 | ubuntu-jammy | changed 2025-03-26 12:34:41.644003 | 2025-03-26 12:34:41.644113 | PLAY RECAP 2025-03-26 12:34:41.644177 | ubuntu-jammy | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2025-03-26 12:34:41.644240 | 2025-03-26 12:34:41.749051 | POST-RUN END RESULT_NORMAL: [trusted : github.com/regiocloud/zuul-config/playbooks/base/post.yaml@main] 2025-03-26 12:34:41.756502 | POST-RUN START: [trusted : github.com/regiocloud/zuul-config/playbooks/base/post-logs.yaml@main] 2025-03-26 12:34:42.483883 | 2025-03-26 12:34:42.484036 | PLAY [Base post-logs] 2025-03-26 12:34:42.509043 | 2025-03-26 12:34:42.509166 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2025-03-26 12:34:42.942999 | localhost | changed 2025-03-26 12:34:42.950200 | 2025-03-26 12:34:42.950385 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2025-03-26 12:34:42.992929 | localhost | ok 2025-03-26 12:34:43.002865 | 2025-03-26 12:34:43.003002 | TASK [Set zuul-log-path fact] 2025-03-26 12:34:43.034181 | localhost | ok 2025-03-26 12:34:43.049168 | 2025-03-26 12:34:43.049310 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-03-26 12:34:43.088622 | localhost | ok 2025-03-26 12:34:43.095797 | 2025-03-26 12:34:43.095910 | TASK [upload-logs : Create log directories] 2025-03-26 12:34:43.639734 | localhost | changed 2025-03-26 12:34:43.647807 | 2025-03-26 12:34:43.647957 | TASK [upload-logs : Ensure logs are readable before uploading] 2025-03-26 12:34:44.154226 | localhost -> localhost | ok: Runtime: 0:00:00.007167 2025-03-26 12:34:44.159512 | 2025-03-26 12:34:44.159626 | TASK [upload-logs : Upload logs to log server] 2025-03-26 12:34:44.686055 | localhost | Output suppressed because no_log was given 2025-03-26 12:34:44.689235 | 2025-03-26 12:34:44.689344 | LOOP [upload-logs : Compress console log and json output] 2025-03-26 12:34:44.753235 | localhost | skipping: Conditional result was False 2025-03-26 12:34:44.781044 | localhost | skipping: Conditional result was False 2025-03-26 12:34:44.794058 | 2025-03-26 12:34:44.794237 | LOOP [upload-logs : Upload compressed console log and json output] 2025-03-26 12:34:44.854312 | localhost | skipping: Conditional result was False 2025-03-26 12:34:44.854893 | 2025-03-26 12:34:44.866759 | localhost | skipping: Conditional result was False 2025-03-26 12:34:44.880705 | 2025-03-26 12:34:44.880895 | LOOP [upload-logs : Upload console log and json output]