2026-01-26 20:39:47.034095 | Job console starting 2026-01-26 20:39:47.043238 | Updating git repos 2026-01-26 20:39:47.083207 | Cloning repos into workspace 2026-01-26 20:39:47.150536 | Restoring repo states 2026-01-26 20:39:47.166179 | Merging changes 2026-01-26 20:39:47.835326 | Checking out repos 2026-01-26 20:39:47.895200 | Preparing playbooks 2026-01-26 20:39:48.520324 | Running Ansible setup 2026-01-26 20:39:53.676635 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-01-26 20:39:54.639464 | 2026-01-26 20:39:54.639637 | PLAY [Base pre] 2026-01-26 20:39:54.668360 | 2026-01-26 20:39:54.668556 | TASK [Setup log path fact] 2026-01-26 20:39:54.716547 | debian-bookworm | ok 2026-01-26 20:39:54.735482 | 2026-01-26 20:39:54.735664 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-01-26 20:39:54.782474 | debian-bookworm | ok 2026-01-26 20:39:54.799461 | 2026-01-26 20:39:54.799602 | TASK [emit-job-header : Print job information] 2026-01-26 20:39:54.891305 | # Job Information 2026-01-26 20:39:54.891545 | Ansible Version: 2.16.14 2026-01-26 20:39:54.891586 | Job: python-black 2026-01-26 20:39:54.891619 | Pipeline: check 2026-01-26 20:39:54.891642 | Executor: 521e9411259a 2026-01-26 20:39:54.891663 | Triggered by: https://github.com/osism/python-osism/pull/1955 2026-01-26 20:39:54.891686 | Event ID: 1c8d8c30-faf7-11f0-8f0c-95406785757d 2026-01-26 20:39:54.896661 | 2026-01-26 20:39:54.896775 | LOOP [emit-job-header : Print node information] 2026-01-26 20:39:55.029776 | debian-bookworm | ok: 2026-01-26 20:39:55.029978 | debian-bookworm | # Node Information 2026-01-26 20:39:55.030013 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-01-26 20:39:55.030039 | debian-bookworm | Hostname: debian 2026-01-26 20:39:55.030062 | debian-bookworm | Username: zuul 2026-01-26 20:39:55.030082 | debian-bookworm | Distro: Debian 12.13 2026-01-26 20:39:55.030106 | debian-bookworm | Provider: regiocloud-a 2026-01-26 20:39:55.030128 | debian-bookworm | Region: 2026-01-26 20:39:55.030149 | debian-bookworm | Label: debian-bookworm 2026-01-26 20:39:55.030169 | debian-bookworm | Product Name: OpenStack Nova 2026-01-26 20:39:55.030189 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe3e:9d11 2026-01-26 20:39:55.043779 | 2026-01-26 20:39:55.043912 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-01-26 20:39:55.578446 | debian-bookworm -> localhost | changed 2026-01-26 20:39:55.585967 | 2026-01-26 20:39:55.586099 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-01-26 20:39:56.744114 | debian-bookworm -> localhost | changed 2026-01-26 20:39:56.768916 | 2026-01-26 20:39:56.773302 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-01-26 20:39:57.063951 | debian-bookworm -> localhost | ok 2026-01-26 20:39:57.070661 | 2026-01-26 20:39:57.070780 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-01-26 20:39:57.099677 | debian-bookworm | ok 2026-01-26 20:39:57.117900 | debian-bookworm | included: /var/lib/zuul/builds/6ec0397195a145a88e5cb034be77861b/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-01-26 20:39:57.124118 | 2026-01-26 20:39:57.124228 | TASK [add-build-sshkey : Create Temp SSH key] 2026-01-26 20:39:58.966649 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-01-26 20:39:58.966957 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/6ec0397195a145a88e5cb034be77861b/work/6ec0397195a145a88e5cb034be77861b_id_rsa 2026-01-26 20:39:58.967004 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/6ec0397195a145a88e5cb034be77861b/work/6ec0397195a145a88e5cb034be77861b_id_rsa.pub 2026-01-26 20:39:58.967031 | debian-bookworm -> localhost | The key fingerprint is: 2026-01-26 20:39:58.967057 | debian-bookworm -> localhost | SHA256:RHKx/xYuZ8S1ZiQK68QvuaTx2TedSJa8+ptjNRfCK7c zuul-build-sshkey 2026-01-26 20:39:58.967079 | debian-bookworm -> localhost | The key's randomart image is: 2026-01-26 20:39:58.967112 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-01-26 20:39:58.967134 | debian-bookworm -> localhost | | . +. | 2026-01-26 20:39:58.967155 | debian-bookworm -> localhost | | + . | 2026-01-26 20:39:58.967175 | debian-bookworm -> localhost | | + o o | 2026-01-26 20:39:58.967194 | debian-bookworm -> localhost | | o + o * o | 2026-01-26 20:39:58.967213 | debian-bookworm -> localhost | | S o.+.* .| 2026-01-26 20:39:58.967239 | debian-bookworm -> localhost | | o o ==*o .| 2026-01-26 20:39:58.967260 | debian-bookworm -> localhost | | . = ooO=.+ | 2026-01-26 20:39:58.967280 | debian-bookworm -> localhost | | = = =BEo | 2026-01-26 20:39:58.967301 | debian-bookworm -> localhost | | . + o=++ | 2026-01-26 20:39:58.967322 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-01-26 20:39:58.967375 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.197543 2026-01-26 20:39:58.973852 | 2026-01-26 20:39:58.973986 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-01-26 20:39:59.006089 | debian-bookworm | ok 2026-01-26 20:39:59.017227 | debian-bookworm | included: /var/lib/zuul/builds/6ec0397195a145a88e5cb034be77861b/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-01-26 20:39:59.026562 | 2026-01-26 20:39:59.026747 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-01-26 20:39:59.051193 | debian-bookworm | skipping: Conditional result was False 2026-01-26 20:39:59.059877 | 2026-01-26 20:39:59.060000 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-01-26 20:39:59.786299 | debian-bookworm | changed 2026-01-26 20:39:59.798228 | 2026-01-26 20:39:59.798465 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-01-26 20:40:00.128487 | debian-bookworm | ok 2026-01-26 20:40:00.141097 | 2026-01-26 20:40:00.141233 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-01-26 20:40:00.855841 | debian-bookworm | changed 2026-01-26 20:40:00.862813 | 2026-01-26 20:40:00.862954 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-01-26 20:40:01.500861 | debian-bookworm | changed 2026-01-26 20:40:01.511915 | 2026-01-26 20:40:01.512033 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-01-26 20:40:01.536465 | debian-bookworm | skipping: Conditional result was False 2026-01-26 20:40:01.543001 | 2026-01-26 20:40:01.543112 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-01-26 20:40:02.615041 | debian-bookworm -> localhost | changed 2026-01-26 20:40:02.626212 | 2026-01-26 20:40:02.626340 | TASK [add-build-sshkey : Add back temp key] 2026-01-26 20:40:03.249389 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/6ec0397195a145a88e5cb034be77861b/work/6ec0397195a145a88e5cb034be77861b_id_rsa (zuul-build-sshkey) 2026-01-26 20:40:03.249681 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.014516 2026-01-26 20:40:03.257945 | 2026-01-26 20:40:03.258069 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-01-26 20:40:03.732715 | debian-bookworm | ok 2026-01-26 20:40:03.738158 | 2026-01-26 20:40:03.738273 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-01-26 20:40:03.762252 | debian-bookworm | skipping: Conditional result was False 2026-01-26 20:40:03.782627 | 2026-01-26 20:40:03.782747 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-01-26 20:40:04.231082 | debian-bookworm | ok 2026-01-26 20:40:04.251549 | 2026-01-26 20:40:04.251705 | TASK [validate-host : Define zuul_info_dir fact] 2026-01-26 20:40:04.294298 | debian-bookworm | ok 2026-01-26 20:40:04.301737 | 2026-01-26 20:40:04.301859 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-01-26 20:40:04.622095 | debian-bookworm -> localhost | ok 2026-01-26 20:40:04.633680 | 2026-01-26 20:40:04.633806 | TASK [validate-host : Collect information about the host] 2026-01-26 20:40:05.749788 | debian-bookworm | ok 2026-01-26 20:40:05.761589 | 2026-01-26 20:40:05.761731 | TASK [validate-host : Sanitize hostname] 2026-01-26 20:40:05.885213 | debian-bookworm | ok 2026-01-26 20:40:05.938903 | 2026-01-26 20:40:05.939045 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-01-26 20:40:06.524320 | debian-bookworm -> localhost | changed 2026-01-26 20:40:06.530602 | 2026-01-26 20:40:06.530719 | TASK [validate-host : Collect information about zuul worker] 2026-01-26 20:40:06.974627 | debian-bookworm | ok 2026-01-26 20:40:06.992258 | 2026-01-26 20:40:06.992399 | TASK [validate-host : Write out all zuul information for each host] 2026-01-26 20:40:07.887821 | debian-bookworm -> localhost | changed 2026-01-26 20:40:07.905702 | 2026-01-26 20:40:07.905826 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-01-26 20:40:08.180556 | debian-bookworm | ok 2026-01-26 20:40:08.186369 | 2026-01-26 20:40:08.186523 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-01-26 20:40:09.581276 | debian-bookworm | changed: 2026-01-26 20:40:09.581503 | debian-bookworm | cd+++++++++ src/ 2026-01-26 20:40:09.581541 | debian-bookworm | cd+++++++++ src/github.com/ 2026-01-26 20:40:09.581565 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-01-26 20:40:09.581586 | debian-bookworm | cd+++++++++ src/github.com/osism/python-osism/ 2026-01-26 20:40:09.581607 | debian-bookworm | Containerfile 2026-01-26 20:40:09.581739 | debian-bookworm | Containerfile 2026-01-26 20:40:09.619029 | debian-bookworm | localhost | ok: Runtime: 0:00:00.004896 2026-01-26 20:40:37.742682 | 2026-01-26 20:40:37.742815 | TASK [upload-logs : Upload logs to log server] 2026-01-26 20:40:38.337346 | localhost | Output suppressed because no_log was given 2026-01-26 20:40:38.339692 | 2026-01-26 20:40:38.339815 | LOOP [upload-logs : Compress console log and json output] 2026-01-26 20:40:38.392651 | localhost | skipping: Conditional result was False 2026-01-26 20:40:38.397865 | localhost | skipping: Conditional result was False 2026-01-26 20:40:38.408599 | 2026-01-26 20:40:38.408772 | LOOP [upload-logs : Upload compressed console log and json output] 2026-01-26 20:40:38.455929 | localhost | skipping: Conditional result was False 2026-01-26 20:40:38.456262 | 2026-01-26 20:40:38.463324 | localhost | skipping: Conditional result was False 2026-01-26 20:40:38.479797 | 2026-01-26 20:40:38.480070 | LOOP [upload-logs : Upload console log and json output]