2026-04-10 11:32:11.704080 | Job console starting 2026-04-10 11:32:11.716709 | Updating git repos 2026-04-10 11:32:11.751671 | Cloning repos into workspace 2026-04-10 11:32:11.839400 | Restoring repo states 2026-04-10 11:32:11.847712 | Merging changes 2026-04-10 11:32:12.377991 | Checking out repos 2026-04-10 11:32:12.437481 | Preparing playbooks 2026-04-10 11:32:13.175490 | Running Ansible setup 2026-04-10 11:32:17.706942 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-04-10 11:32:18.551073 | 2026-04-10 11:32:18.551236 | PLAY [Base pre] 2026-04-10 11:32:18.573274 | 2026-04-10 11:32:18.573424 | TASK [Setup log path fact] 2026-04-10 11:32:18.600287 | debian-bookworm | ok 2026-04-10 11:32:18.620231 | 2026-04-10 11:32:18.620401 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-10 11:32:18.653045 | debian-bookworm | ok 2026-04-10 11:32:18.663480 | 2026-04-10 11:32:18.663609 | TASK [emit-job-header : Print job information] 2026-04-10 11:32:18.705563 | # Job Information 2026-04-10 11:32:18.705771 | Ansible Version: 2.16.14 2026-04-10 11:32:18.705807 | Job: python-black 2026-04-10 11:32:18.705840 | Pipeline: check 2026-04-10 11:32:18.705862 | Executor: 521e9411259a 2026-04-10 11:32:18.705884 | Triggered by: https://github.com/osism/testbed/pull/2864 2026-04-10 11:32:18.705906 | Event ID: e55f8380-34d0-11f1-9c00-1f926a4a5cda 2026-04-10 11:32:18.711264 | 2026-04-10 11:32:18.711416 | LOOP [emit-job-header : Print node information] 2026-04-10 11:32:18.817913 | debian-bookworm | ok: 2026-04-10 11:32:18.818148 | debian-bookworm | # Node Information 2026-04-10 11:32:18.818193 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-04-10 11:32:18.818227 | debian-bookworm | Hostname: debian 2026-04-10 11:32:18.818255 | debian-bookworm | Username: zuul 2026-04-10 11:32:18.818282 | debian-bookworm | Distro: Debian 12.13 2026-04-10 11:32:18.818314 | debian-bookworm | Provider: regiocloud-a 2026-04-10 11:32:18.818343 | debian-bookworm | Region: 2026-04-10 11:32:18.818372 | debian-bookworm | Label: debian-bookworm 2026-04-10 11:32:18.818398 | debian-bookworm | Product Name: OpenStack Nova 2026-04-10 11:32:18.818424 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe87:4ea 2026-04-10 11:32:18.830295 | 2026-04-10 11:32:18.830433 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-04-10 11:32:19.306855 | debian-bookworm -> localhost | changed 2026-04-10 11:32:19.314364 | 2026-04-10 11:32:19.314503 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-04-10 11:32:20.496938 | debian-bookworm -> localhost | changed 2026-04-10 11:32:20.509442 | 2026-04-10 11:32:20.509591 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-04-10 11:32:20.879391 | debian-bookworm -> localhost | ok 2026-04-10 11:32:20.887206 | 2026-04-10 11:32:20.887372 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-04-10 11:32:20.940524 | debian-bookworm | ok 2026-04-10 11:32:20.961886 | debian-bookworm | included: /var/lib/zuul/builds/4fcee30450c540a9bc98f2d16c7afc39/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-04-10 11:32:20.968962 | 2026-04-10 11:32:20.969097 | TASK [add-build-sshkey : Create Temp SSH key] 2026-04-10 11:32:22.745921 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-04-10 11:32:22.746461 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/4fcee30450c540a9bc98f2d16c7afc39/work/4fcee30450c540a9bc98f2d16c7afc39_id_rsa 2026-04-10 11:32:22.746572 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/4fcee30450c540a9bc98f2d16c7afc39/work/4fcee30450c540a9bc98f2d16c7afc39_id_rsa.pub 2026-04-10 11:32:22.746650 | debian-bookworm -> localhost | The key fingerprint is: 2026-04-10 11:32:22.746717 | debian-bookworm -> localhost | SHA256:OSbEAjcJreOyDGX/mp/TPw/gUsFZmmf3MEJ0XIsBOXg zuul-build-sshkey 2026-04-10 11:32:22.746781 | debian-bookworm -> localhost | The key's randomart image is: 2026-04-10 11:32:22.746922 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-04-10 11:32:22.747015 | debian-bookworm -> localhost | | ooo. o=+o.. | 2026-04-10 11:32:22.747083 | debian-bookworm -> localhost | | ooo ..*E..o . | 2026-04-10 11:32:22.747142 | debian-bookworm -> localhost | | .. o *.+.= . | 2026-04-10 11:32:22.747198 | debian-bookworm -> localhost | | = o = o + | 2026-04-10 11:32:22.747257 | debian-bookworm -> localhost | | + o . S . | 2026-04-10 11:32:22.747323 | debian-bookworm -> localhost | |o . . = o | 2026-04-10 11:32:22.747382 | debian-bookworm -> localhost | |oo .... . | 2026-04-10 11:32:22.747437 | debian-bookworm -> localhost | |.. .oo. .. | 2026-04-10 11:32:22.747497 | debian-bookworm -> localhost | | ooo. ..o. | 2026-04-10 11:32:22.747552 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-04-10 11:32:22.747705 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.178499 2026-04-10 11:32:22.763798 | 2026-04-10 11:32:22.764134 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-04-10 11:32:22.797415 | debian-bookworm | ok 2026-04-10 11:32:22.808823 | debian-bookworm | included: /var/lib/zuul/builds/4fcee30450c540a9bc98f2d16c7afc39/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-04-10 11:32:22.817943 | 2026-04-10 11:32:22.818090 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-04-10 11:32:22.842064 | debian-bookworm | skipping: Conditional result was False 2026-04-10 11:32:22.852400 | 2026-04-10 11:32:22.852534 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-04-10 11:32:23.479775 | debian-bookworm | changed 2026-04-10 11:32:23.488282 | 2026-04-10 11:32:23.488417 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-04-10 11:32:23.771749 | debian-bookworm | ok 2026-04-10 11:32:23.777920 | 2026-04-10 11:32:23.778065 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-04-10 11:32:24.518811 | debian-bookworm | changed 2026-04-10 11:32:24.527524 | 2026-04-10 11:32:24.527660 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-04-10 11:32:25.134952 | debian-bookworm | changed 2026-04-10 11:32:25.144918 | 2026-04-10 11:32:25.145080 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-04-10 11:32:25.177646 | debian-bookworm | skipping: Conditional result was False 2026-04-10 11:32:25.184532 | 2026-04-10 11:32:25.184671 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-04-10 11:32:25.635397 | debian-bookworm -> localhost | changed 2026-04-10 11:32:25.654030 | 2026-04-10 11:32:25.654187 | TASK [add-build-sshkey : Add back temp key] 2026-04-10 11:32:26.046187 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/4fcee30450c540a9bc98f2d16c7afc39/work/4fcee30450c540a9bc98f2d16c7afc39_id_rsa (zuul-build-sshkey) 2026-04-10 11:32:26.046444 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.033299 2026-04-10 11:32:26.055412 | 2026-04-10 11:32:26.055536 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-04-10 11:32:26.463198 | debian-bookworm | ok 2026-04-10 11:32:26.472172 | 2026-04-10 11:32:26.472318 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-04-10 11:32:26.526153 | debian-bookworm | skipping: Conditional result was False 2026-04-10 11:32:26.537137 | 2026-04-10 11:32:26.537269 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-04-10 11:32:26.971720 | debian-bookworm | ok 2026-04-10 11:32:26.983069 | 2026-04-10 11:32:26.983212 | TASK [validate-host : Define zuul_info_dir fact] 2026-04-10 11:32:27.023393 | debian-bookworm | ok 2026-04-10 11:32:27.028676 | 2026-04-10 11:32:27.028806 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-04-10 11:32:27.337413 | debian-bookworm -> localhost | ok 2026-04-10 11:32:27.346796 | 2026-04-10 11:32:27.346956 | TASK [validate-host : Collect information about the host] 2026-04-10 11:32:28.460703 | debian-bookworm | ok 2026-04-10 11:32:28.481403 | 2026-04-10 11:32:28.481542 | TASK [validate-host : Sanitize hostname] 2026-04-10 11:32:28.582674 | debian-bookworm | ok 2026-04-10 11:32:28.625578 | 2026-04-10 11:32:28.625796 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-04-10 11:32:29.218155 | debian-bookworm -> localhost | changed 2026-04-10 11:32:29.224209 | 2026-04-10 11:32:29.224348 | TASK [validate-host : Collect information about zuul worker] 2026-04-10 11:32:29.640070 | debian-bookworm | ok 2026-04-10 11:32:29.645117 | 2026-04-10 11:32:29.645240 | TASK [validate-host : Write out all zuul information for each host] 2026-04-10 11:32:30.206911 | debian-bookworm -> localhost | changed 2026-04-10 11:32:30.216849 | 2026-04-10 11:32:30.217071 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-04-10 11:32:30.480877 | debian-bookworm | ok 2026-04-10 11:32:30.487390 | 2026-04-10 11:32:30.487556 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-04-10 11:32:31.720804 | debian-bookworm | changed: 2026-04-10 11:32:31.721066 | debian-bookworm | cd+++++++++ src/ 2026-04-10 11:32:31.721107 | debian-bookworm | cd+++++++++ src/github.com/ 2026-04-10 11:32:31.721132 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-04-10 11:32:31.721153 | debian-bookworm | cd+++++++++ src/github.com/osism/testbed/ 2026-04-10 11:32:31.721173 | debian-bookworm | localhost | ok: Runtime: 0:00:00.012356 2026-04-10 11:32:57.414092 | 2026-04-10 11:32:57.414221 | TASK [upload-logs : Upload logs to log server] 2026-04-10 11:32:57.937451 | localhost | Output suppressed because no_log was given 2026-04-10 11:32:57.939931 | 2026-04-10 11:32:57.940067 | LOOP [upload-logs : Compress console log and json output] 2026-04-10 11:32:57.987079 | localhost | skipping: Conditional result was False 2026-04-10 11:32:58.000531 | localhost | skipping: Conditional result was False 2026-04-10 11:32:58.004835 | 2026-04-10 11:32:58.004978 | LOOP [upload-logs : Upload compressed console log and json output] 2026-04-10 11:32:58.050969 | localhost | skipping: Conditional result was False 2026-04-10 11:32:58.051257 | 2026-04-10 11:32:58.056591 | localhost | skipping: Conditional result was False 2026-04-10 11:32:58.062227 | 2026-04-10 11:32:58.062344 | LOOP [upload-logs : Upload console log and json output]