2025-04-09 14:30:35.491656 | Job console starting... 2025-04-09 14:30:35.499916 | Updating repositories 2025-04-09 14:30:35.518952 | Preparing job workspace 2025-04-09 14:30:36.377765 | Running Ansible setup... 2025-04-09 14:30:41.231247 | PRE-RUN START: [trusted : github.com/regiocloud/zuul-config/playbooks/base/pre.yaml@main] 2025-04-09 14:30:41.959194 | 2025-04-09 14:30:41.959346 | PLAY [Base pre] 2025-04-09 14:30:41.988713 | 2025-04-09 14:30:41.988953 | TASK [Setup log path fact] 2025-04-09 14:30:42.011094 | ubuntu-jammy | ok 2025-04-09 14:30:42.030449 | 2025-04-09 14:30:42.030588 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-04-09 14:30:42.072471 | ubuntu-jammy | ok 2025-04-09 14:30:42.085541 | 2025-04-09 14:30:42.085653 | TASK [emit-job-header : Print job information] 2025-04-09 14:30:42.147763 | # Job Information 2025-04-09 14:30:42.147937 | Ansible Version: 2.15.3 2025-04-09 14:30:42.147972 | Job: e2e-tests-gardener-1.31-quick 2025-04-09 14:30:42.148003 | Pipeline: periodic-hourly 2025-04-09 14:30:42.148024 | Executor: 7d211f194f6a 2025-04-09 14:30:42.148043 | Triggered by: https://github.com/regiocloud/e2e-tests 2025-04-09 14:30:42.148081 | Event ID: bf7895b1a34045d89e2c669e3c9d3ca3 2025-04-09 14:30:42.154589 | 2025-04-09 14:30:42.154703 | LOOP [emit-job-header : Print node information] 2025-04-09 14:30:42.313390 | ubuntu-jammy | ok: 2025-04-09 14:30:42.313861 | ubuntu-jammy | # Node Information 2025-04-09 14:30:42.313934 | ubuntu-jammy | Inventory Hostname: ubuntu-jammy 2025-04-09 14:30:42.313977 | ubuntu-jammy | Hostname: ubuntu 2025-04-09 14:30:42.314013 | ubuntu-jammy | Username: zuul 2025-04-09 14:30:42.314046 | ubuntu-jammy | Distro: Ubuntu 22.04 2025-04-09 14:30:42.314103 | ubuntu-jammy | Provider: regiocloud-a 2025-04-09 14:30:42.314137 | ubuntu-jammy | Label: ubuntu-jammy 2025-04-09 14:30:42.314171 | ubuntu-jammy | Product Name: OpenStack Nova 2025-04-09 14:30:42.314204 | ubuntu-jammy | Interface IP: 81.163.192.224 2025-04-09 14:30:42.346886 | 2025-04-09 14:30:42.347125 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-04-09 14:30:42.816016 | ubuntu-jammy -> localhost | changed 2025-04-09 14:30:42.830964 | 2025-04-09 14:30:42.831170 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-04-09 14:30:43.850515 | ubuntu-jammy -> localhost | changed 2025-04-09 14:30:43.865384 | 2025-04-09 14:30:43.865499 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-04-09 14:30:44.128012 | ubuntu-jammy -> localhost | ok 2025-04-09 14:30:44.143121 | 2025-04-09 14:30:44.143280 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-04-09 14:30:44.180619 | ubuntu-jammy | ok 2025-04-09 14:30:44.217790 | ubuntu-jammy | included: /var/lib/zuul/builds/14944389c9764096993a144a652903bd/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-04-09 14:30:44.225902 | 2025-04-09 14:30:44.226012 | TASK [add-build-sshkey : Create Temp SSH key] 2025-04-09 14:30:44.824357 | ubuntu-jammy -> localhost | Generating public/private rsa key pair. 2025-04-09 14:30:44.824609 | ubuntu-jammy -> localhost | Your identification has been saved in /var/lib/zuul/builds/14944389c9764096993a144a652903bd/work/14944389c9764096993a144a652903bd_id_rsa 2025-04-09 14:30:44.824650 | ubuntu-jammy -> localhost | Your public key has been saved in /var/lib/zuul/builds/14944389c9764096993a144a652903bd/work/14944389c9764096993a144a652903bd_id_rsa.pub 2025-04-09 14:30:44.824678 | ubuntu-jammy -> localhost | The key fingerprint is: 2025-04-09 14:30:44.824703 | ubuntu-jammy -> localhost | SHA256:qW4aCJa4dPXVavs27Z+fTRpTKUVEfTPhKwmgvQYHb7g zuul-build-sshkey 2025-04-09 14:30:44.824728 | ubuntu-jammy -> localhost | The key's randomart image is: 2025-04-09 14:30:44.824750 | ubuntu-jammy -> localhost | +---[RSA 3072]----+ 2025-04-09 14:30:44.824773 | ubuntu-jammy -> localhost | | . . o=o| 2025-04-09 14:30:44.824795 | ubuntu-jammy -> localhost | | * o ooo| 2025-04-09 14:30:44.824817 | ubuntu-jammy -> localhost | | . + * o o+| 2025-04-09 14:30:44.824851 | ubuntu-jammy -> localhost | |. . . . *.o . o o| 2025-04-09 14:30:44.824873 | ubuntu-jammy -> localhost | |o+ . ES= + o.| 2025-04-09 14:30:44.824894 | ubuntu-jammy -> localhost | |oo.. .o . o. | 2025-04-09 14:30:44.824921 | ubuntu-jammy -> localhost | |. . . . . . o .| 2025-04-09 14:30:44.824943 | ubuntu-jammy -> localhost | | o. .o . =+| 2025-04-09 14:30:44.824964 | ubuntu-jammy -> localhost | | .o. ..o.o++| 2025-04-09 14:30:44.824986 | ubuntu-jammy -> localhost | +----[SHA256]-----+ 2025-04-09 14:30:44.825044 | ubuntu-jammy -> localhost | ok: Runtime: 0:00:00.075715 2025-04-09 14:30:44.834556 | 2025-04-09 14:30:44.834678 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-04-09 14:30:44.865740 | ubuntu-jammy | ok 2025-04-09 14:30:44.877203 | ubuntu-jammy | included: /var/lib/zuul/builds/14944389c9764096993a144a652903bd/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-04-09 14:30:44.887182 | 2025-04-09 14:30:44.887285 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-04-09 14:30:44.912349 | ubuntu-jammy | skipping: Conditional result was False 2025-04-09 14:30:44.919906 | 2025-04-09 14:30:44.920019 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-04-09 14:30:45.482253 | ubuntu-jammy | changed 2025-04-09 14:30:45.491405 | 2025-04-09 14:30:45.491527 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-04-09 14:30:45.725332 | ubuntu-jammy | ok 2025-04-09 14:30:45.734035 | 2025-04-09 14:30:45.734174 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-04-09 14:30:46.328922 | ubuntu-jammy | changed 2025-04-09 14:30:46.336755 | 2025-04-09 14:30:46.336870 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-04-09 14:30:46.953901 | ubuntu-jammy | changed 2025-04-09 14:30:46.963024 | 2025-04-09 14:30:46.963163 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-04-09 14:30:46.998400 | ubuntu-jammy | skipping: Conditional result was False 2025-04-09 14:30:47.014382 | 2025-04-09 14:30:47.014529 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-04-09 14:30:47.499582 | ubuntu-jammy -> localhost | changed 2025-04-09 14:30:47.526509 | 2025-04-09 14:30:47.526641 | TASK [add-build-sshkey : Add back temp key] 2025-04-09 14:30:47.878287 | ubuntu-jammy -> localhost | Identity added: /var/lib/zuul/builds/14944389c9764096993a144a652903bd/work/14944389c9764096993a144a652903bd_id_rsa (zuul-build-sshkey) 2025-04-09 14:30:47.878820 | ubuntu-jammy -> localhost | ok: Runtime: 0:00:00.013962 2025-04-09 14:30:47.895236 | 2025-04-09 14:30:47.895395 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-04-09 14:30:48.306563 | ubuntu-jammy | ok 2025-04-09 14:30:48.323291 | 2025-04-09 14:30:48.323452 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-04-09 14:30:48.358827 | ubuntu-jammy | skipping: Conditional result was False 2025-04-09 14:30:48.372252 | 2025-04-09 14:30:48.372357 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-04-09 14:30:48.795238 | ubuntu-jammy | ok 2025-04-09 14:30:48.844118 | 2025-04-09 14:30:48.844242 | TASK [validate-host : Define zuul_info_dir fact] 2025-04-09 14:30:48.880559 | ubuntu-jammy | ok 2025-04-09 14:30:48.889821 | 2025-04-09 14:30:48.889944 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-04-09 14:30:49.191595 | ubuntu-jammy -> localhost | ok 2025-04-09 14:30:49.199642 | 2025-04-09 14:30:49.199750 | TASK [validate-host : Collect information about the host] 2025-04-09 14:30:50.306527 | ubuntu-jammy | ok 2025-04-09 14:30:50.321265 | 2025-04-09 14:30:50.321372 | TASK [validate-host : Sanitize hostname] 2025-04-09 14:30:50.401281 | ubuntu-jammy | ok 2025-04-09 14:30:50.409796 | 2025-04-09 14:30:50.409913 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-04-09 14:30:51.010086 | ubuntu-jammy -> localhost | changed 2025-04-09 14:30:51.017854 | 2025-04-09 14:30:51.017975 | TASK [validate-host : Collect information about zuul worker] 2025-04-09 14:30:51.470904 | ubuntu-jammy | ok 2025-04-09 14:30:51.479084 | 2025-04-09 14:30:51.479211 | TASK [validate-host : Write out all zuul information for each host] 2025-04-09 14:30:52.047551 | ubuntu-jammy -> localhost | changed 2025-04-09 14:30:52.059713 | 2025-04-09 14:30:52.059823 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-04-09 14:30:52.304941 | ubuntu-jammy | ok 2025-04-09 14:30:52.312868 | 2025-04-09 14:30:52.313000 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-04-09 14:30:53.083454 | ubuntu-jammy | changed: 2025-04-09 14:30:53.083633 | ubuntu-jammy | cd+++++++++ src/ 2025-04-09 14:30:53.083668 | ubuntu-jammy | cd+++++++++ src/github.com/ 2025-04-09 14:30:53.083693 | ubuntu-jammy | cd+++++++++ src/github.com/regiocloud/ 2025-04-09 14:30:53.083715 | ubuntu-jammy | cd+++++++++ src/github.com/regiocloud/e2e-tests/ 2025-04-09 14:30:53.083736 | ubuntu-jammy | localhost | ok: Runtime: 0:00:00.007115 2025-04-09 14:31:25.122596 | 2025-04-09 14:31:25.122744 | TASK [upload-logs : Upload logs to log server] 2025-04-09 14:31:25.707134 | localhost | Output suppressed because no_log was given 2025-04-09 14:31:25.712541 | 2025-04-09 14:31:25.712697 | LOOP [upload-logs : Compress console log and json output] 2025-04-09 14:31:25.789010 | localhost | skipping: Conditional result was False 2025-04-09 14:31:25.804949 | localhost | skipping: Conditional result was False 2025-04-09 14:31:25.822121 | 2025-04-09 14:31:25.822306 | LOOP [upload-logs : Upload compressed console log and json output] 2025-04-09 14:31:25.884746 | localhost | skipping: Conditional result was False 2025-04-09 14:31:25.885432 | 2025-04-09 14:31:25.897093 | localhost | skipping: Conditional result was False 2025-04-09 14:31:25.908616 | 2025-04-09 14:31:25.908799 | LOOP [upload-logs : Upload console log and json output]