2026-04-27 04:28:57.813688 | Job console starting 2026-04-27 04:28:57.836035 | Updating git repos 2026-04-27 04:28:57.873099 | Cloning repos into workspace 2026-04-27 04:28:57.953711 | Restoring repo states 2026-04-27 04:28:57.961214 | Merging changes 2026-04-27 04:28:58.556118 | Checking out repos 2026-04-27 04:28:58.623397 | Preparing playbooks 2026-04-27 04:28:59.350130 | Running Ansible setup 2026-04-27 04:29:04.200912 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-04-27 04:29:05.406348 | 2026-04-27 04:29:05.406526 | PLAY [Base pre] 2026-04-27 04:29:05.424719 | 2026-04-27 04:29:05.424899 | TASK [Setup log path fact] 2026-04-27 04:29:05.444262 | debian-bookworm | ok 2026-04-27 04:29:05.468688 | 2026-04-27 04:29:05.468922 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-27 04:29:05.499405 | debian-bookworm | ok 2026-04-27 04:29:05.509869 | 2026-04-27 04:29:05.510077 | TASK [emit-job-header : Print job information] 2026-04-27 04:29:05.549855 | # Job Information 2026-04-27 04:29:05.550045 | Ansible Version: 2.16.14 2026-04-27 04:29:05.550080 | Job: python-black 2026-04-27 04:29:05.550113 | Pipeline: check 2026-04-27 04:29:05.550137 | Executor: 521e9411259a 2026-04-27 04:29:05.550158 | Triggered by: https://github.com/osism/testbed/pull/2879 2026-04-27 04:29:05.550180 | Event ID: 95df87b4-41f1-11f1-98c6-7484ba32167f 2026-04-27 04:29:05.555302 | 2026-04-27 04:29:05.555427 | LOOP [emit-job-header : Print node information] 2026-04-27 04:29:05.668690 | debian-bookworm | ok: 2026-04-27 04:29:05.668895 | debian-bookworm | # Node Information 2026-04-27 04:29:05.668930 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-04-27 04:29:05.668954 | debian-bookworm | Hostname: debian 2026-04-27 04:29:05.668976 | debian-bookworm | Username: zuul 2026-04-27 04:29:05.668997 | debian-bookworm | Distro: Debian 12.13 2026-04-27 04:29:05.669020 | debian-bookworm | Provider: regiocloud-a 2026-04-27 04:29:05.669041 | debian-bookworm | Region: 2026-04-27 04:29:05.669062 | debian-bookworm | Label: debian-bookworm 2026-04-27 04:29:05.669082 | debian-bookworm | Product Name: OpenStack Nova 2026-04-27 04:29:05.669101 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:feb7:77c9 2026-04-27 04:29:05.688104 | 2026-04-27 04:29:05.688255 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-04-27 04:29:06.269951 | debian-bookworm -> localhost | changed 2026-04-27 04:29:06.291604 | 2026-04-27 04:29:06.291780 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-04-27 04:29:07.407249 | debian-bookworm -> localhost | changed 2026-04-27 04:29:07.418952 | 2026-04-27 04:29:07.419101 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-04-27 04:29:07.717309 | debian-bookworm -> localhost | ok 2026-04-27 04:29:07.723910 | 2026-04-27 04:29:07.724036 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-04-27 04:29:07.752525 | debian-bookworm | ok 2026-04-27 04:29:07.771251 | debian-bookworm | included: /var/lib/zuul/builds/ccc5fcff11d74c29bc1d040129d7a516/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-04-27 04:29:07.792903 | 2026-04-27 04:29:07.793025 | TASK [add-build-sshkey : Create Temp SSH key] 2026-04-27 04:29:10.063944 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-04-27 04:29:10.064470 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/ccc5fcff11d74c29bc1d040129d7a516/work/ccc5fcff11d74c29bc1d040129d7a516_id_rsa 2026-04-27 04:29:10.064556 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/ccc5fcff11d74c29bc1d040129d7a516/work/ccc5fcff11d74c29bc1d040129d7a516_id_rsa.pub 2026-04-27 04:29:10.064610 | debian-bookworm -> localhost | The key fingerprint is: 2026-04-27 04:29:10.064657 | debian-bookworm -> localhost | SHA256:xHx0/7tw240AszX83f2vh7rJ8m7intU+V+ahahN/mvo zuul-build-sshkey 2026-04-27 04:29:10.064702 | debian-bookworm -> localhost | The key's randomart image is: 2026-04-27 04:29:10.064765 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-04-27 04:29:10.064826 | debian-bookworm -> localhost | | . . | 2026-04-27 04:29:10.064874 | debian-bookworm -> localhost | | o . . . | 2026-04-27 04:29:10.064917 | debian-bookworm -> localhost | | + . . | 2026-04-27 04:29:10.064957 | debian-bookworm -> localhost | | . . . . | 2026-04-27 04:29:10.064998 | debian-bookworm -> localhost | | S o + .| 2026-04-27 04:29:10.065049 | debian-bookworm -> localhost | | * + o*| 2026-04-27 04:29:10.065093 | debian-bookworm -> localhost | | . =.+**| 2026-04-27 04:29:10.065134 | debian-bookworm -> localhost | | o*.**oX| 2026-04-27 04:29:10.065177 | debian-bookworm -> localhost | | o=O%E*B*| 2026-04-27 04:29:10.065218 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-04-27 04:29:10.065323 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.758742 2026-04-27 04:29:10.078243 | 2026-04-27 04:29:10.078393 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-04-27 04:29:10.126758 | debian-bookworm | ok 2026-04-27 04:29:10.141242 | debian-bookworm | included: /var/lib/zuul/builds/ccc5fcff11d74c29bc1d040129d7a516/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-04-27 04:29:10.151440 | 2026-04-27 04:29:10.151563 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-04-27 04:29:10.175772 | debian-bookworm | skipping: Conditional result was False 2026-04-27 04:29:10.182343 | 2026-04-27 04:29:10.182458 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-04-27 04:29:10.865670 | debian-bookworm | changed 2026-04-27 04:29:10.873720 | 2026-04-27 04:29:10.873885 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-04-27 04:29:11.139683 | debian-bookworm | ok 2026-04-27 04:29:11.145674 | 2026-04-27 04:29:11.145795 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-04-27 04:29:11.858445 | debian-bookworm | changed 2026-04-27 04:29:11.868087 | 2026-04-27 04:29:11.868241 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-04-27 04:29:12.522236 | debian-bookworm | changed 2026-04-27 04:29:12.528976 | 2026-04-27 04:29:12.529101 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-04-27 04:29:12.553150 | debian-bookworm | skipping: Conditional result was False 2026-04-27 04:29:12.559632 | 2026-04-27 04:29:12.559745 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-04-27 04:29:13.011317 | debian-bookworm -> localhost | changed 2026-04-27 04:29:13.023857 | 2026-04-27 04:29:13.024001 | TASK [add-build-sshkey : Add back temp key] 2026-04-27 04:29:13.369017 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/ccc5fcff11d74c29bc1d040129d7a516/work/ccc5fcff11d74c29bc1d040129d7a516_id_rsa (zuul-build-sshkey) 2026-04-27 04:29:13.369302 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.011189 2026-04-27 04:29:13.378911 | 2026-04-27 04:29:13.379028 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-04-27 04:29:13.805043 | debian-bookworm | ok 2026-04-27 04:29:13.818782 | 2026-04-27 04:29:13.818966 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-04-27 04:29:13.854287 | debian-bookworm | skipping: Conditional result was False 2026-04-27 04:29:13.865434 | 2026-04-27 04:29:13.865570 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-04-27 04:29:14.332800 | debian-bookworm | ok 2026-04-27 04:29:14.344428 | 2026-04-27 04:29:14.344562 | TASK [validate-host : Define zuul_info_dir fact] 2026-04-27 04:29:14.393926 | debian-bookworm | ok 2026-04-27 04:29:14.399387 | 2026-04-27 04:29:14.399496 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-04-27 04:29:14.699527 | debian-bookworm -> localhost | ok 2026-04-27 04:29:14.711710 | 2026-04-27 04:29:14.711909 | TASK [validate-host : Collect information about the host] 2026-04-27 04:29:15.949336 | debian-bookworm | ok 2026-04-27 04:29:15.959788 | 2026-04-27 04:29:15.959926 | TASK [validate-host : Sanitize hostname] 2026-04-27 04:29:16.068062 | debian-bookworm | ok 2026-04-27 04:29:16.132063 | 2026-04-27 04:29:16.132269 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-04-27 04:29:16.793731 | debian-bookworm -> localhost | changed 2026-04-27 04:29:16.800275 | 2026-04-27 04:29:16.800400 | TASK [validate-host : Collect information about zuul worker] 2026-04-27 04:29:17.278406 | debian-bookworm | ok 2026-04-27 04:29:17.284346 | 2026-04-27 04:29:17.284481 | TASK [validate-host : Write out all zuul information for each host] 2026-04-27 04:29:17.951289 | debian-bookworm -> localhost | changed 2026-04-27 04:29:17.964179 | 2026-04-27 04:29:17.964324 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-04-27 04:29:18.232608 | debian-bookworm | ok 2026-04-27 04:29:18.242878 | 2026-04-27 04:29:18.243033 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-04-27 04:29:19.427300 | debian-bookworm | changed: 2026-04-27 04:29:19.427546 | debian-bookworm | cd+++++++++ src/ 2026-04-27 04:29:19.427595 | debian-bookworm | cd+++++++++ src/github.com/ 2026-04-27 04:29:19.427630 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-04-27 04:29:19.427662 | debian-bookworm | cd+++++++++ src/github.com/osism/testbed/ 2026-04-27 04:29:19.427690 | debian-bookworm | localhost | ok: Runtime: 0:00:00.007416 2026-04-27 04:29:46.128219 | 2026-04-27 04:29:46.128433 | TASK [upload-logs : Upload logs to log server] 2026-04-27 04:29:46.758772 | localhost | Output suppressed because no_log was given 2026-04-27 04:29:46.760976 | 2026-04-27 04:29:46.761086 | LOOP [upload-logs : Compress console log and json output] 2026-04-27 04:29:46.820373 | localhost | skipping: Conditional result was False 2026-04-27 04:29:46.829843 | localhost | skipping: Conditional result was False 2026-04-27 04:29:46.842374 | 2026-04-27 04:29:46.842606 | LOOP [upload-logs : Upload compressed console log and json output] 2026-04-27 04:29:46.900789 | localhost | skipping: Conditional result was False 2026-04-27 04:29:46.901107 | 2026-04-27 04:29:46.910705 | localhost | skipping: Conditional result was False 2026-04-27 04:29:46.926044 | 2026-04-27 04:29:46.926282 | LOOP [upload-logs : Upload console log and json output]