2026-05-03 00:23:43.360010 | Job console starting 2026-05-03 00:23:43.378402 | Updating git repos 2026-05-03 00:23:43.399431 | Cloning repos into workspace 2026-05-03 00:23:43.432827 | Restoring repo states 2026-05-03 00:23:43.439765 | Merging changes 2026-05-03 00:23:44.009911 | Checking out repos 2026-05-03 00:23:44.107199 | Preparing playbooks 2026-05-03 00:23:45.120197 | Running Ansible setup 2026-05-03 00:23:50.149248 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-05-03 00:23:50.989430 | 2026-05-03 00:23:50.989612 | PLAY [Base pre] 2026-05-03 00:23:51.007659 | 2026-05-03 00:23:51.007836 | TASK [Setup log path fact] 2026-05-03 00:23:51.041590 | debian-bookworm | ok 2026-05-03 00:23:51.060316 | 2026-05-03 00:23:51.060495 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-05-03 00:23:51.101192 | debian-bookworm | ok 2026-05-03 00:23:51.112209 | 2026-05-03 00:23:51.112361 | TASK [emit-job-header : Print job information] 2026-05-03 00:23:51.186358 | # Job Information 2026-05-03 00:23:51.186749 | Ansible Version: 2.16.14 2026-05-03 00:23:51.186810 | Job: python-black 2026-05-03 00:23:51.186868 | Pipeline: check 2026-05-03 00:23:51.186893 | Executor: 521e9411259a 2026-05-03 00:23:51.186915 | Triggered by: https://github.com/osism/mappings/pull/175 2026-05-03 00:23:51.186938 | Event ID: 50d62710-4686-11f1-8b2c-52ca1f978964 2026-05-03 00:23:51.201529 | 2026-05-03 00:23:51.201697 | LOOP [emit-job-header : Print node information] 2026-05-03 00:23:51.316570 | debian-bookworm | ok: 2026-05-03 00:23:51.316780 | debian-bookworm | # Node Information 2026-05-03 00:23:51.316815 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-05-03 00:23:51.316841 | debian-bookworm | Hostname: debian 2026-05-03 00:23:51.316863 | debian-bookworm | Username: zuul 2026-05-03 00:23:51.316884 | debian-bookworm | Distro: Debian 12.13 2026-05-03 00:23:51.316907 | debian-bookworm | Provider: regiocloud-a 2026-05-03 00:23:51.316928 | debian-bookworm | Region: 2026-05-03 00:23:51.316949 | debian-bookworm | Label: debian-bookworm 2026-05-03 00:23:51.316969 | debian-bookworm | Product Name: OpenStack Nova 2026-05-03 00:23:51.316989 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fed9:60b4 2026-05-03 00:23:51.334679 | 2026-05-03 00:23:51.334938 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-05-03 00:23:52.014166 | debian-bookworm -> localhost | changed 2026-05-03 00:23:52.023080 | 2026-05-03 00:23:52.023238 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-05-03 00:23:53.308378 | debian-bookworm -> localhost | changed 2026-05-03 00:23:53.325095 | 2026-05-03 00:23:53.325258 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-05-03 00:23:53.777066 | debian-bookworm -> localhost | ok 2026-05-03 00:23:53.790215 | 2026-05-03 00:23:53.790394 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-05-03 00:23:53.822369 | debian-bookworm | ok 2026-05-03 00:23:53.838498 | debian-bookworm | included: /var/lib/zuul/builds/ac38a84e01d5465b95e2e036aa927e92/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-05-03 00:23:53.845170 | 2026-05-03 00:23:53.845283 | TASK [add-build-sshkey : Create Temp SSH key] 2026-05-03 00:23:54.875843 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-05-03 00:23:54.876099 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/ac38a84e01d5465b95e2e036aa927e92/work/ac38a84e01d5465b95e2e036aa927e92_id_rsa 2026-05-03 00:23:54.876138 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/ac38a84e01d5465b95e2e036aa927e92/work/ac38a84e01d5465b95e2e036aa927e92_id_rsa.pub 2026-05-03 00:23:54.876164 | debian-bookworm -> localhost | The key fingerprint is: 2026-05-03 00:23:54.876188 | debian-bookworm -> localhost | SHA256:QkRa17UvA5AtRGDYytrK/ZHQp4h5to4eA/t2/1+0QSc zuul-build-sshkey 2026-05-03 00:23:54.876210 | debian-bookworm -> localhost | The key's randomart image is: 2026-05-03 00:23:54.876243 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-05-03 00:23:54.876265 | debian-bookworm -> localhost | | +*+=+ .. | 2026-05-03 00:23:54.876287 | debian-bookworm -> localhost | | .=..o.o . | 2026-05-03 00:23:54.876307 | debian-bookworm -> localhost | | .... .. E . | 2026-05-03 00:23:54.876327 | debian-bookworm -> localhost | | oo o + | 2026-05-03 00:23:54.876346 | debian-bookworm -> localhost | |. o. o S = . | 2026-05-03 00:23:54.876372 | debian-bookworm -> localhost | | o.o.o = . = | 2026-05-03 00:23:54.876394 | debian-bookworm -> localhost | |..=o+ + o | 2026-05-03 00:23:54.876414 | debian-bookworm -> localhost | | .+*o. . . | 2026-05-03 00:23:54.876435 | debian-bookworm -> localhost | | o+oooo.... | 2026-05-03 00:23:54.876455 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-05-03 00:23:54.876511 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.511014 2026-05-03 00:23:54.887103 | 2026-05-03 00:23:54.887232 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-05-03 00:23:54.923576 | debian-bookworm | ok 2026-05-03 00:23:54.939096 | debian-bookworm | included: /var/lib/zuul/builds/ac38a84e01d5465b95e2e036aa927e92/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-05-03 00:23:54.949460 | 2026-05-03 00:23:54.949587 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-05-03 00:23:54.973599 | debian-bookworm | skipping: Conditional result was False 2026-05-03 00:23:54.979963 | 2026-05-03 00:23:54.980078 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-05-03 00:23:55.630586 | debian-bookworm | changed 2026-05-03 00:23:55.638287 | 2026-05-03 00:23:55.638431 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-05-03 00:23:55.929850 | debian-bookworm | ok 2026-05-03 00:23:55.939408 | 2026-05-03 00:23:55.939576 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-05-03 00:23:56.635229 | debian-bookworm | changed 2026-05-03 00:23:56.643929 | 2026-05-03 00:23:56.644094 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-05-03 00:23:57.286910 | debian-bookworm | changed 2026-05-03 00:23:57.293357 | 2026-05-03 00:23:57.293485 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-05-03 00:23:57.322380 | debian-bookworm | skipping: Conditional result was False 2026-05-03 00:23:57.329433 | 2026-05-03 00:23:57.329589 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-05-03 00:23:57.897661 | debian-bookworm -> localhost | changed 2026-05-03 00:23:57.917542 | 2026-05-03 00:23:57.917731 | TASK [add-build-sshkey : Add back temp key] 2026-05-03 00:23:58.347251 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/ac38a84e01d5465b95e2e036aa927e92/work/ac38a84e01d5465b95e2e036aa927e92_id_rsa (zuul-build-sshkey) 2026-05-03 00:23:58.347516 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.010788 2026-05-03 00:23:58.356971 | 2026-05-03 00:23:58.357095 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-05-03 00:23:58.819989 | debian-bookworm | ok 2026-05-03 00:23:58.839086 | 2026-05-03 00:23:58.839924 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-05-03 00:23:58.865753 | debian-bookworm | skipping: Conditional result was False 2026-05-03 00:23:58.879927 | 2026-05-03 00:23:58.880094 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-05-03 00:23:59.362240 | debian-bookworm | ok 2026-05-03 00:23:59.374974 | 2026-05-03 00:23:59.375113 | TASK [validate-host : Define zuul_info_dir fact] 2026-05-03 00:23:59.420022 | debian-bookworm | ok 2026-05-03 00:23:59.430536 | 2026-05-03 00:23:59.430713 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-05-03 00:23:59.741929 | debian-bookworm -> localhost | ok 2026-05-03 00:23:59.754763 | 2026-05-03 00:23:59.755080 | TASK [validate-host : Collect information about the host] 2026-05-03 00:24:00.965286 | debian-bookworm | ok 2026-05-03 00:24:00.979863 | 2026-05-03 00:24:00.980012 | TASK [validate-host : Sanitize hostname] 2026-05-03 00:24:01.116543 | debian-bookworm | ok 2026-05-03 00:24:01.176730 | 2026-05-03 00:24:01.176892 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-05-03 00:24:01.849538 | debian-bookworm -> localhost | changed 2026-05-03 00:24:01.856148 | 2026-05-03 00:24:01.856288 | TASK [validate-host : Collect information about zuul worker] 2026-05-03 00:24:02.304196 | debian-bookworm | ok 2026-05-03 00:24:02.309510 | 2026-05-03 00:24:02.309664 | TASK [validate-host : Write out all zuul information for each host] 2026-05-03 00:24:02.911944 | debian-bookworm -> localhost | changed 2026-05-03 00:24:02.925599 | 2026-05-03 00:24:02.925794 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-05-03 00:24:03.229269 | debian-bookworm | ok 2026-05-03 00:24:03.235938 | 2026-05-03 00:24:03.236117 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-05-03 00:24:04.250163 | debian-bookworm | changed: 2026-05-03 00:24:04.250430 | debian-bookworm | cd+++++++++ src/ 2026-05-03 00:24:04.250468 | debian-bookworm | cd+++++++++ src/github.com/ 2026-05-03 00:24:04.250590 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-05-03 00:24:04.250615 | debian-bookworm | cd+++++++++ src/github.com/osism/mappings/ 2026-05-03 00:24:04.250676 | debian-bookworm | Containerfile 2026-05-03 00:24:04.250758 | debian-bookworm | localhost | ok: "/var/lib/zuul/builds/ac38a84e01d5465b95e2e036aa927e92/work/logs" 2026-05-03 00:24:30.528559 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/ac38a84e01d5465b95e2e036aa927e92/work/artifacts" 2026-05-03 00:24:30.792278 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/ac38a84e01d5465b95e2e036aa927e92/work/docs" 2026-05-03 00:24:30.820342 | 2026-05-03 00:24:30.820507 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-05-03 00:24:31.639707 | debian-bookworm | changed: 2026-05-03 00:24:31.640026 | debian-bookworm | >f+++++++++ sudo-debug.txt 2026-05-03 00:24:31.640069 | debian-bookworm | >f+++++++++ sudo-strace.log 2026-05-03 00:24:31.640100 | debian-bookworm | >f+++++++++ sudo-strace.log.time 2026-05-03 00:24:31.640150 | debian-bookworm | changed: All items complete 2026-05-03 00:24:31.640177 | 2026-05-03 00:24:32.244149 | debian-bookworm | changed: .d..t...... ./ 2026-05-03 00:24:32.862527 | debian-bookworm | changed: .d..t...... ./ 2026-05-03 00:24:32.882385 | 2026-05-03 00:24:32.882570 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-05-03 00:24:33.425234 | debian-bookworm -> localhost | ok: Item: artifacts Runtime: 0:00:00.005616 2026-05-03 00:24:33.767912 | debian-bookworm -> localhost | ok: Item: docs Runtime: 0:00:00.010690 2026-05-03 00:24:33.780973 | 2026-05-03 00:24:33.781105 | PLAY RECAP 2026-05-03 00:24:33.781160 | debian-bookworm | ok: 4 changed: 3 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-05-03 00:24:33.781186 | 2026-05-03 00:24:33.926442 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post-fetch.yaml@main] 2026-05-03 00:24:33.927362 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-05-03 00:24:34.716351 | 2026-05-03 00:24:34.716541 | PLAY [Base post] 2026-05-03 00:24:34.731230 | 2026-05-03 00:24:34.731396 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-05-03 00:24:35.380767 | debian-bookworm | changed 2026-05-03 00:24:35.390783 | 2026-05-03 00:24:35.391016 | PLAY RECAP 2026-05-03 00:24:35.391206 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-05-03 00:24:35.391277 | 2026-05-03 00:24:35.525468 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-05-03 00:24:35.526347 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-05-03 00:24:36.437341 | 2026-05-03 00:24:36.437508 | PLAY [Base post-logs] 2026-05-03 00:24:36.453452 | 2026-05-03 00:24:36.453611 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-05-03 00:24:36.965361 | localhost | changed 2026-05-03 00:24:36.976298 | 2026-05-03 00:24:36.976483 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-05-03 00:24:37.013425 | localhost | ok 2026-05-03 00:24:37.016716 | 2026-05-03 00:24:37.016833 | TASK [Set zuul-log-path fact] 2026-05-03 00:24:37.033319 | localhost | ok 2026-05-03 00:24:37.044449 | 2026-05-03 00:24:37.044608 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-05-03 00:24:37.071178 | localhost | ok 2026-05-03 00:24:37.074360 | 2026-05-03 00:24:37.074484 | TASK [upload-logs : Create log directories] 2026-05-03 00:24:37.610389 | localhost | changed 2026-05-03 00:24:37.613874 | 2026-05-03 00:24:37.613999 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-05-03 00:24:38.180319 | localhost -> localhost | ok: Runtime: 0:00:00.009872 2026-05-03 00:24:38.185695 | 2026-05-03 00:24:38.185851 | TASK [upload-logs : Upload logs to log server] 2026-05-03 00:24:38.820058 | localhost | Output suppressed because no_log was given 2026-05-03 00:24:38.822825 | 2026-05-03 00:24:38.822979 | LOOP [upload-logs : Compress console log and json output] 2026-05-03 00:24:38.891846 | localhost | skipping: Conditional result was False 2026-05-03 00:24:38.900357 | localhost | skipping: Conditional result was False 2026-05-03 00:24:38.910091 | 2026-05-03 00:24:38.910365 | LOOP [upload-logs : Upload compressed console log and json output] 2026-05-03 00:24:38.963207 | localhost | skipping: Conditional result was False 2026-05-03 00:24:38.963512 | 2026-05-03 00:24:38.970631 | localhost | skipping: Conditional result was False 2026-05-03 00:24:38.983901 | 2026-05-03 00:24:38.984157 | LOOP [upload-logs : Upload console log and json output]