2026-03-06 21:56:50.747018 | Job console starting 2026-03-06 21:56:50.785747 | Updating git repos 2026-03-06 21:56:51.255697 | Cloning repos into workspace 2026-03-06 21:56:51.324602 | Restoring repo states 2026-03-06 21:56:51.354037 | Merging changes 2026-03-06 21:56:52.121188 | Checking out repos 2026-03-06 21:56:52.298115 | Preparing playbooks 2026-03-06 21:56:53.378436 | Running Ansible setup 2026-03-06 21:56:59.399150 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-03-06 21:57:00.547035 | 2026-03-06 21:57:00.547161 | PLAY [Base pre] 2026-03-06 21:57:00.585200 | 2026-03-06 21:57:00.585312 | TASK [Setup log path fact] 2026-03-06 21:57:00.613926 | debian-bookworm | ok 2026-03-06 21:57:00.638578 | 2026-03-06 21:57:00.638691 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-03-06 21:57:00.676252 | debian-bookworm | ok 2026-03-06 21:57:00.683906 | 2026-03-06 21:57:00.683990 | TASK [emit-job-header : Print job information] 2026-03-06 21:57:00.750994 | # Job Information 2026-03-06 21:57:00.751141 | Ansible Version: 2.16.14 2026-03-06 21:57:00.751171 | Job: python-black 2026-03-06 21:57:00.751199 | Pipeline: check 2026-03-06 21:57:00.751218 | Executor: 521e9411259a 2026-03-06 21:57:00.751235 | Triggered by: https://github.com/osism/python-osism/pull/2084 2026-03-06 21:57:00.751254 | Event ID: 5b43f850-19a7-11f1-8834-05ac7b8ebc99 2026-03-06 21:57:00.755154 | 2026-03-06 21:57:00.755234 | LOOP [emit-job-header : Print node information] 2026-03-06 21:57:00.963066 | debian-bookworm | ok: 2026-03-06 21:57:00.963209 | debian-bookworm | # Node Information 2026-03-06 21:57:00.963238 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-03-06 21:57:00.963258 | debian-bookworm | Hostname: debian 2026-03-06 21:57:00.963276 | debian-bookworm | Username: zuul 2026-03-06 21:57:00.963293 | debian-bookworm | Distro: Debian 12.13 2026-03-06 21:57:00.963313 | debian-bookworm | Provider: regiocloud-a 2026-03-06 21:57:00.963330 | debian-bookworm | Region: 2026-03-06 21:57:00.963347 | debian-bookworm | Label: debian-bookworm 2026-03-06 21:57:00.963363 | debian-bookworm | Product Name: OpenStack Nova 2026-03-06 21:57:00.963380 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe37:c83c 2026-03-06 21:57:00.979704 | 2026-03-06 21:57:00.979798 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-03-06 21:57:02.042019 | debian-bookworm -> localhost | changed 2026-03-06 21:57:02.048069 | 2026-03-06 21:57:02.048191 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-03-06 21:57:04.323944 | debian-bookworm -> localhost | changed 2026-03-06 21:57:04.336841 | 2026-03-06 21:57:04.338094 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-03-06 21:57:05.171963 | debian-bookworm -> localhost | ok 2026-03-06 21:57:05.177181 | 2026-03-06 21:57:05.177269 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-03-06 21:57:05.213794 | debian-bookworm | ok 2026-03-06 21:57:05.237808 | debian-bookworm | included: /var/lib/zuul/builds/0c47298f96304c9fb20f8d356d1db857/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-03-06 21:57:05.248930 | 2026-03-06 21:57:05.249022 | TASK [add-build-sshkey : Create Temp SSH key] 2026-03-06 21:57:09.995930 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-03-06 21:57:09.996104 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/0c47298f96304c9fb20f8d356d1db857/work/0c47298f96304c9fb20f8d356d1db857_id_rsa 2026-03-06 21:57:09.996162 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/0c47298f96304c9fb20f8d356d1db857/work/0c47298f96304c9fb20f8d356d1db857_id_rsa.pub 2026-03-06 21:57:09.996184 | debian-bookworm -> localhost | The key fingerprint is: 2026-03-06 21:57:09.996204 | debian-bookworm -> localhost | SHA256:G72CK86CB7uAoU1II+MSyK3AylLwU71bUTYTy18n7X8 zuul-build-sshkey 2026-03-06 21:57:09.996223 | debian-bookworm -> localhost | The key's randomart image is: 2026-03-06 21:57:09.996253 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-03-06 21:57:09.996272 | debian-bookworm -> localhost | |. .. .*. | 2026-03-06 21:57:09.996290 | debian-bookworm -> localhost | |+o.. . .o + . | 2026-03-06 21:57:09.996307 | debian-bookworm -> localhost | |*=+. . .o o o| 2026-03-06 21:57:09.996324 | debian-bookworm -> localhost | |B=o. . .. . . + | 2026-03-06 21:57:09.996340 | debian-bookworm -> localhost | |*+. oS . . .| 2026-03-06 21:57:09.996362 | debian-bookworm -> localhost | |*+ .. o . .| 2026-03-06 21:57:09.996379 | debian-bookworm -> localhost | |++. . o . E| 2026-03-06 21:57:09.996395 | debian-bookworm -> localhost | |+ o.. . . .| 2026-03-06 21:57:09.996412 | debian-bookworm -> localhost | |.o oo.. | 2026-03-06 21:57:09.996428 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-03-06 21:57:09.996474 | debian-bookworm -> localhost | ok: Runtime: 0:00:02.774439 2026-03-06 21:57:10.002314 | 2026-03-06 21:57:10.002403 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-03-06 21:57:10.019750 | debian-bookworm | ok 2026-03-06 21:57:10.031547 | debian-bookworm | included: /var/lib/zuul/builds/0c47298f96304c9fb20f8d356d1db857/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-03-06 21:57:10.052779 | 2026-03-06 21:57:10.052877 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-03-06 21:57:10.085775 | debian-bookworm | skipping: Conditional result was False 2026-03-06 21:57:10.090976 | 2026-03-06 21:57:10.091075 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-03-06 21:57:10.846449 | debian-bookworm | changed 2026-03-06 21:57:10.852050 | 2026-03-06 21:57:10.852145 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-03-06 21:57:11.134024 | debian-bookworm | ok 2026-03-06 21:57:11.138527 | 2026-03-06 21:57:11.138601 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-03-06 21:57:11.815249 | debian-bookworm | changed 2026-03-06 21:57:11.820821 | 2026-03-06 21:57:11.820916 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-03-06 21:57:12.523144 | debian-bookworm | changed 2026-03-06 21:57:12.528349 | 2026-03-06 21:57:12.528436 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-03-06 21:57:12.553163 | debian-bookworm | skipping: Conditional result was False 2026-03-06 21:57:12.574729 | 2026-03-06 21:57:12.574829 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-03-06 21:57:13.327703 | debian-bookworm -> localhost | changed 2026-03-06 21:57:13.337056 | 2026-03-06 21:57:13.337166 | TASK [add-build-sshkey : Add back temp key] 2026-03-06 21:57:14.176323 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/0c47298f96304c9fb20f8d356d1db857/work/0c47298f96304c9fb20f8d356d1db857_id_rsa (zuul-build-sshkey) 2026-03-06 21:57:14.176510 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.026529 2026-03-06 21:57:14.182775 | 2026-03-06 21:57:14.189579 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-03-06 21:57:14.728785 | debian-bookworm | ok 2026-03-06 21:57:14.734076 | 2026-03-06 21:57:14.734173 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-03-06 21:57:14.791430 | debian-bookworm | skipping: Conditional result was False 2026-03-06 21:57:14.799947 | 2026-03-06 21:57:14.800032 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-03-06 21:57:15.459759 | debian-bookworm | ok 2026-03-06 21:57:15.477053 | 2026-03-06 21:57:15.477175 | TASK [validate-host : Define zuul_info_dir fact] 2026-03-06 21:57:15.590102 | debian-bookworm | ok 2026-03-06 21:57:15.595030 | 2026-03-06 21:57:15.595133 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-03-06 21:57:16.445026 | debian-bookworm -> localhost | ok 2026-03-06 21:57:16.450286 | 2026-03-06 21:57:16.450367 | TASK [validate-host : Collect information about the host] 2026-03-06 21:57:18.505859 | debian-bookworm | ok 2026-03-06 21:57:18.521935 | 2026-03-06 21:57:18.522034 | TASK [validate-host : Sanitize hostname] 2026-03-06 21:57:18.731580 | debian-bookworm | ok 2026-03-06 21:57:18.822627 | 2026-03-06 21:57:18.822725 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-03-06 21:57:20.375663 | debian-bookworm -> localhost | changed 2026-03-06 21:57:20.380464 | 2026-03-06 21:57:20.380553 | TASK [validate-host : Collect information about zuul worker] 2026-03-06 21:57:21.026188 | debian-bookworm | ok 2026-03-06 21:57:21.030094 | 2026-03-06 21:57:21.030209 | TASK [validate-host : Write out all zuul information for each host] 2026-03-06 21:57:22.305055 | debian-bookworm -> localhost | changed 2026-03-06 21:57:22.312652 | 2026-03-06 21:57:22.312736 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-03-06 21:57:22.550092 | debian-bookworm | ok 2026-03-06 21:57:22.556953 | 2026-03-06 21:57:22.557057 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-03-06 21:57:24.006578 | debian-bookworm | changed: 2026-03-06 21:57:24.006752 | debian-bookworm | cd+++++++++ src/ 2026-03-06 21:57:24.006786 | debian-bookworm | cd+++++++++ src/github.com/ 2026-03-06 21:57:24.006811 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-03-06 21:57:24.006850 | debian-bookworm | cd+++++++++ src/github.com/osism/python-osism/ 2026-03-06 21:57:24.006873 | debian-bookworm | Containerfile 2026-03-06 21:57:24.007003 | debian-bookworm | Containerfile 2026-03-06 21:57:24.034022 | debian-bookworm | localhost | ok: Runtime: 0:00:00.007603 2026-03-06 21:57:51.959203 | 2026-03-06 21:57:51.959350 | TASK [upload-logs : Upload logs to log server] 2026-03-06 21:57:52.734322 | localhost | Output suppressed because no_log was given 2026-03-06 21:57:52.740379 | 2026-03-06 21:57:52.740558 | LOOP [upload-logs : Compress console log and json output] 2026-03-06 21:57:52.797588 | localhost | skipping: Conditional result was False 2026-03-06 21:57:52.802394 | localhost | skipping: Conditional result was False 2026-03-06 21:57:52.810630 | 2026-03-06 21:57:52.810761 | LOOP [upload-logs : Upload compressed console log and json output] 2026-03-06 21:57:52.869313 | localhost | skipping: Conditional result was False 2026-03-06 21:57:52.869616 | 2026-03-06 21:57:52.875464 | localhost | skipping: Conditional result was False 2026-03-06 21:57:52.879141 | 2026-03-06 21:57:52.879291 | LOOP [upload-logs : Upload console log and json output]