2025-06-25 08:04:08.339457 | Job console starting 2025-06-25 08:04:08.349355 | Updating git repos 2025-06-25 08:04:08.376307 | Cloning repos into workspace 2025-06-25 08:04:08.447097 | Restoring repo states 2025-06-25 08:04:08.459749 | Merging changes 2025-06-25 08:04:09.009341 | Checking out repos 2025-06-25 08:04:09.040637 | Preparing playbooks 2025-06-25 08:04:09.569846 | Running Ansible setup 2025-06-25 08:04:13.953132 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-06-25 08:04:14.784015 | 2025-06-25 08:04:14.784195 | PLAY [Base pre] 2025-06-25 08:04:14.802587 | 2025-06-25 08:04:14.802746 | TASK [Setup log path fact] 2025-06-25 08:04:14.832469 | debian-bookworm | ok 2025-06-25 08:04:14.848830 | 2025-06-25 08:04:14.849021 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-06-25 08:04:14.879987 | debian-bookworm | ok 2025-06-25 08:04:14.893608 | 2025-06-25 08:04:14.893752 | TASK [emit-job-header : Print job information] 2025-06-25 08:04:14.933116 | # Job Information 2025-06-25 08:04:14.933327 | Ansible Version: 2.16.14 2025-06-25 08:04:14.933364 | Job: container-image-python-osism-build 2025-06-25 08:04:14.933396 | Pipeline: check 2025-06-25 08:04:14.933419 | Executor: 521e9411259a 2025-06-25 08:04:14.933440 | Triggered by: https://github.com/osism/python-osism/pull/1504 2025-06-25 08:04:14.933462 | Event ID: d4053590-519a-11f0-8b4c-8717a7fb6817 2025-06-25 08:04:14.939273 | 2025-06-25 08:04:14.939391 | LOOP [emit-job-header : Print node information] 2025-06-25 08:04:15.074045 | debian-bookworm | ok: 2025-06-25 08:04:15.074316 | debian-bookworm | # Node Information 2025-06-25 08:04:15.074358 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-06-25 08:04:15.074382 | debian-bookworm | Hostname: debian 2025-06-25 08:04:15.074403 | debian-bookworm | Username: zuul 2025-06-25 08:04:15.074424 | debian-bookworm | Distro: Debian 12.11 2025-06-25 08:04:15.074452 | debian-bookworm | Provider: regiocloud-a 2025-06-25 08:04:15.074473 | debian-bookworm | Region: 2025-06-25 08:04:15.074494 | debian-bookworm | Label: debian-bookworm 2025-06-25 08:04:15.074514 | debian-bookworm | Product Name: OpenStack Nova 2025-06-25 08:04:15.074533 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe51:b4a7 2025-06-25 08:04:15.096279 | 2025-06-25 08:04:15.096422 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-06-25 08:04:15.542311 | debian-bookworm -> localhost | changed 2025-06-25 08:04:15.550234 | 2025-06-25 08:04:15.550365 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-06-25 08:04:16.751074 | debian-bookworm -> localhost | changed 2025-06-25 08:04:16.765756 | 2025-06-25 08:04:16.765894 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-06-25 08:04:17.106564 | debian-bookworm -> localhost | ok 2025-06-25 08:04:17.115836 | 2025-06-25 08:04:17.115999 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-06-25 08:04:17.166001 | debian-bookworm | ok 2025-06-25 08:04:17.190389 | debian-bookworm | included: /var/lib/zuul/builds/007d4e8addd643c0a5de185dd1d910a5/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-06-25 08:04:17.197521 | 2025-06-25 08:04:17.197642 | TASK [add-build-sshkey : Create Temp SSH key] 2025-06-25 08:04:18.866370 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-06-25 08:04:18.866603 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/007d4e8addd643c0a5de185dd1d910a5/work/007d4e8addd643c0a5de185dd1d910a5_id_rsa 2025-06-25 08:04:18.866646 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/007d4e8addd643c0a5de185dd1d910a5/work/007d4e8addd643c0a5de185dd1d910a5_id_rsa.pub 2025-06-25 08:04:18.866673 | debian-bookworm -> localhost | The key fingerprint is: 2025-06-25 08:04:18.867336 | debian-bookworm -> localhost | SHA256:8/N2b5RIYP+hS7UqdY/dvMbTxu1aXTlSMGwJHWriA44 zuul-build-sshkey 2025-06-25 08:04:18.867669 | debian-bookworm -> localhost | The key's randomart image is: 2025-06-25 08:04:18.867706 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-06-25 08:04:18.867732 | debian-bookworm -> localhost | | .++o | 2025-06-25 08:04:18.867757 | debian-bookworm -> localhost | | o.=o | 2025-06-25 08:04:18.867780 | debian-bookworm -> localhost | | . ..o+ . | 2025-06-25 08:04:18.867802 | debian-bookworm -> localhost | | o o o o.o.| 2025-06-25 08:04:18.868235 | debian-bookworm -> localhost | | E .So ..=o=| 2025-06-25 08:04:18.868684 | debian-bookworm -> localhost | | o. =.==| 2025-06-25 08:04:18.868717 | debian-bookworm -> localhost | | o o =*B| 2025-06-25 08:04:18.868740 | debian-bookworm -> localhost | | +.oo=@| 2025-06-25 08:04:18.868762 | debian-bookworm -> localhost | | .o.oB=| 2025-06-25 08:04:18.868785 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-06-25 08:04:18.868856 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.017467 2025-06-25 08:04:18.888437 | 2025-06-25 08:04:18.888560 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-06-25 08:04:18.931520 | debian-bookworm | ok 2025-06-25 08:04:18.947184 | debian-bookworm | included: /var/lib/zuul/builds/007d4e8addd643c0a5de185dd1d910a5/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-06-25 08:04:18.956789 | 2025-06-25 08:04:18.956955 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-06-25 08:04:18.981277 | debian-bookworm | skipping: Conditional result was False 2025-06-25 08:04:18.988607 | 2025-06-25 08:04:18.988725 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-06-25 08:04:19.714823 | debian-bookworm | changed 2025-06-25 08:04:19.722345 | 2025-06-25 08:04:19.722484 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-06-25 08:04:19.960458 | debian-bookworm | ok 2025-06-25 08:04:19.968132 | 2025-06-25 08:04:19.968269 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-06-25 08:04:20.608581 | debian-bookworm | changed 2025-06-25 08:04:20.619283 | 2025-06-25 08:04:20.619428 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-06-25 08:04:21.279925 | debian-bookworm | changed 2025-06-25 08:04:21.287178 | 2025-06-25 08:04:21.287309 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-06-25 08:04:21.311579 | debian-bookworm | skipping: Conditional result was False 2025-06-25 08:04:21.318486 | 2025-06-25 08:04:21.318615 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-06-25 08:04:21.872322 | debian-bookworm -> localhost | changed 2025-06-25 08:04:21.884900 | 2025-06-25 08:04:21.885078 | TASK [add-build-sshkey : Add back temp key] 2025-06-25 08:04:22.461062 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/007d4e8addd643c0a5de185dd1d910a5/work/007d4e8addd643c0a5de185dd1d910a5_id_rsa (zuul-build-sshkey) 2025-06-25 08:04:22.461312 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.020080 2025-06-25 08:04:22.470003 | 2025-06-25 08:04:22.470117 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-06-25 08:04:22.868702 | debian-bookworm | ok 2025-06-25 08:04:22.887379 | 2025-06-25 08:04:22.887552 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-06-25 08:04:22.925972 | debian-bookworm | skipping: Conditional result was False 2025-06-25 08:04:22.937278 | 2025-06-25 08:04:22.937406 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-06-25 08:04:23.394617 | debian-bookworm | ok 2025-06-25 08:04:23.422428 | 2025-06-25 08:04:23.422562 | TASK [validate-host : Define zuul_info_dir fact] 2025-06-25 08:04:23.482084 | debian-bookworm | ok 2025-06-25 08:04:23.487568 | 2025-06-25 08:04:23.487685 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-06-25 08:04:24.102813 | debian-bookworm -> localhost | ok 2025-06-25 08:04:24.109640 | 2025-06-25 08:04:24.109759 | TASK [validate-host : Collect information about the host] 2025-06-25 08:04:25.543106 | debian-bookworm | ok 2025-06-25 08:04:25.563715 | 2025-06-25 08:04:25.563879 | TASK [validate-host : Sanitize hostname] 2025-06-25 08:04:25.791470 | debian-bookworm | ok 2025-06-25 08:04:25.883118 | 2025-06-25 08:04:25.883264 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-06-25 08:04:27.071389 | debian-bookworm -> localhost | changed 2025-06-25 08:04:27.094187 | 2025-06-25 08:04:27.094328 | TASK [validate-host : Collect information about zuul worker] 2025-06-25 08:04:27.629311 | debian-bookworm | ok 2025-06-25 08:04:27.641677 | 2025-06-25 08:04:27.641819 | TASK [validate-host : Write out all zuul information for each host] 2025-06-25 08:04:28.718350 | debian-bookworm -> localhost | changed 2025-06-25 08:04:28.731565 | 2025-06-25 08:04:28.731697 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-06-25 08:04:29.029589 | debian-bookworm | ok 2025-06-25 08:04:29.041752 | 2025-06-25 08:04:29.041889 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-06-25 08:04:30.259943 | debian-bookworm | changed: 2025-06-25 08:04:30.260105 | debian-bookworm | cd+++++++++ src/ 2025-06-25 08:04:30.260133 | debian-bookworm | cd+++++++++ src/github.com/ 2025-06-25 08:04:30.260153 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-06-25 08:04:30.260171 | debian-bookworm | cd+++++++++ src/github.com/osism/python-osism/ 2025-06-25 08:04:30.260188 | debian-bookworm | Containerfile 2025-06-25 08:04:30.260280 | debian-bookworm | localhost | ok: Runtime: 0:00:00.004524 2025-06-25 08:06:44.436097 | 2025-06-25 08:06:44.436292 | TASK [upload-logs : Upload logs to log server] 2025-06-25 08:06:45.020465 | localhost | Output suppressed because no_log was given 2025-06-25 08:06:45.023170 | 2025-06-25 08:06:45.023320 | LOOP [upload-logs : Compress console log and json output] 2025-06-25 08:06:45.089397 | localhost | skipping: Conditional result was False 2025-06-25 08:06:45.103080 | localhost | skipping: Conditional result was False 2025-06-25 08:06:45.113708 | 2025-06-25 08:06:45.113837 | LOOP [upload-logs : Upload compressed console log and json output] 2025-06-25 08:06:45.170237 | localhost | skipping: Conditional result was False 2025-06-25 08:06:45.171086 | 2025-06-25 08:06:45.173995 | localhost | skipping: Conditional result was False 2025-06-25 08:06:45.187795 | 2025-06-25 08:06:45.188005 | LOOP [upload-logs : Upload console log and json output]