2025-10-16 03:02:14.147130 | Job console starting 2025-10-16 03:02:14.153008 | Updating git repos 2025-10-16 03:02:14.171365 | Cloning repos into workspace 2025-10-16 03:02:14.190965 | Restoring repo states 2025-10-16 03:02:14.193817 | Merging changes 2025-10-16 03:02:14.193828 | Checking out repos 2025-10-16 03:02:14.226869 | Preparing playbooks 2025-10-16 03:02:15.163431 | Running Ansible setup 2025-10-16 03:02:19.849471 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-10-16 03:02:21.271677 | 2025-10-16 03:02:21.271815 | PLAY [Base pre] 2025-10-16 03:02:21.292258 | 2025-10-16 03:02:21.292358 | TASK [Setup log path fact] 2025-10-16 03:02:21.319512 | debian-bookworm | ok 2025-10-16 03:02:21.364561 | 2025-10-16 03:02:21.364681 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-10-16 03:02:21.405203 | debian-bookworm | ok 2025-10-16 03:02:21.416458 | 2025-10-16 03:02:21.416553 | TASK [emit-job-header : Print job information] 2025-10-16 03:02:21.473579 | # Job Information 2025-10-16 03:02:21.473720 | Ansible Version: 2.16.14 2025-10-16 03:02:21.473750 | Job: python-black 2025-10-16 03:02:21.473787 | Pipeline: periodic-daily 2025-10-16 03:02:21.473806 | Executor: 521e9411259a 2025-10-16 03:02:21.473823 | Triggered by: https://github.com/osism/node-image 2025-10-16 03:02:21.473841 | Event ID: 771b049cc4af4fa0bdc02093b458ce93 2025-10-16 03:02:21.477778 | 2025-10-16 03:02:21.477861 | LOOP [emit-job-header : Print node information] 2025-10-16 03:02:21.621797 | debian-bookworm | ok: 2025-10-16 03:02:21.621977 | debian-bookworm | # Node Information 2025-10-16 03:02:21.622005 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-10-16 03:02:21.622027 | debian-bookworm | Hostname: debian 2025-10-16 03:02:21.622045 | debian-bookworm | Username: zuul 2025-10-16 03:02:21.622062 | debian-bookworm | Distro: Debian 12.12 2025-10-16 03:02:21.622082 | debian-bookworm | Provider: regiocloud-a 2025-10-16 03:02:21.622099 | debian-bookworm | Region: 2025-10-16 03:02:21.622117 | debian-bookworm | Label: debian-bookworm 2025-10-16 03:02:21.622133 | debian-bookworm | Product Name: OpenStack Nova 2025-10-16 03:02:21.622149 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe48:84fb 2025-10-16 03:02:21.641680 | 2025-10-16 03:02:21.641802 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-10-16 03:02:22.347018 | debian-bookworm -> localhost | changed 2025-10-16 03:02:22.352624 | 2025-10-16 03:02:22.352710 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-10-16 03:02:26.210377 | debian-bookworm -> localhost | changed 2025-10-16 03:02:26.228618 | 2025-10-16 03:02:26.228716 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-10-16 03:02:27.457051 | debian-bookworm -> localhost | ok 2025-10-16 03:02:27.462182 | 2025-10-16 03:02:27.462265 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-10-16 03:02:27.518974 | debian-bookworm | ok 2025-10-16 03:02:27.582385 | debian-bookworm | included: /var/lib/zuul/builds/e8dbb04cfac34f95bddcc88889c707ca/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-10-16 03:02:27.601500 | 2025-10-16 03:02:27.601601 | TASK [add-build-sshkey : Create Temp SSH key] 2025-10-16 03:02:29.755202 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-10-16 03:02:29.755369 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/e8dbb04cfac34f95bddcc88889c707ca/work/e8dbb04cfac34f95bddcc88889c707ca_id_rsa 2025-10-16 03:02:29.755401 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/e8dbb04cfac34f95bddcc88889c707ca/work/e8dbb04cfac34f95bddcc88889c707ca_id_rsa.pub 2025-10-16 03:02:29.755423 | debian-bookworm -> localhost | The key fingerprint is: 2025-10-16 03:02:29.755443 | debian-bookworm -> localhost | SHA256:sewetnyeCHXyP7W1pz5oO0c57JLS2bJCTNjGChrWlDs zuul-build-sshkey 2025-10-16 03:02:29.755461 | debian-bookworm -> localhost | The key's randomart image is: 2025-10-16 03:02:29.755487 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-10-16 03:02:29.755506 | debian-bookworm -> localhost | | . | 2025-10-16 03:02:29.755524 | debian-bookworm -> localhost | | o | 2025-10-16 03:02:29.755541 | debian-bookworm -> localhost | | o ..+ | 2025-10-16 03:02:29.755557 | debian-bookworm -> localhost | | o E..o= | 2025-10-16 03:02:29.755574 | debian-bookworm -> localhost | | . o oS=. . . | 2025-10-16 03:02:29.755595 | debian-bookworm -> localhost | | . o.+o * .| 2025-10-16 03:02:29.755612 | debian-bookworm -> localhost | | . +... O +.| 2025-10-16 03:02:29.755628 | debian-bookworm -> localhost | | = ++o@ *..| 2025-10-16 03:02:29.755645 | debian-bookworm -> localhost | | =oo++Xoo.| 2025-10-16 03:02:29.755661 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-10-16 03:02:29.755702 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.950268 2025-10-16 03:02:29.767668 | 2025-10-16 03:02:29.767754 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-10-16 03:02:29.796796 | debian-bookworm | ok 2025-10-16 03:02:29.852398 | debian-bookworm | included: /var/lib/zuul/builds/e8dbb04cfac34f95bddcc88889c707ca/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-10-16 03:02:29.902093 | 2025-10-16 03:02:29.902189 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-10-16 03:02:29.929167 | debian-bookworm | skipping: Conditional result was False 2025-10-16 03:02:29.947984 | 2025-10-16 03:02:29.948079 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-10-16 03:02:31.059339 | debian-bookworm | changed 2025-10-16 03:02:31.067849 | 2025-10-16 03:02:31.067933 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-10-16 03:02:31.451898 | debian-bookworm | ok 2025-10-16 03:02:31.456516 | 2025-10-16 03:02:31.456605 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-10-16 03:02:32.427383 | debian-bookworm | changed 2025-10-16 03:02:32.443474 | 2025-10-16 03:02:32.443573 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-10-16 03:02:33.202095 | debian-bookworm | changed 2025-10-16 03:02:33.207610 | 2025-10-16 03:02:33.207692 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-10-16 03:02:33.257813 | debian-bookworm | skipping: Conditional result was False 2025-10-16 03:02:33.264075 | 2025-10-16 03:02:33.264237 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-10-16 03:02:34.523265 | debian-bookworm -> localhost | changed 2025-10-16 03:02:34.531813 | 2025-10-16 03:02:34.531897 | TASK [add-build-sshkey : Add back temp key] 2025-10-16 03:02:35.386873 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/e8dbb04cfac34f95bddcc88889c707ca/work/e8dbb04cfac34f95bddcc88889c707ca_id_rsa (zuul-build-sshkey) 2025-10-16 03:02:35.387068 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.018154 2025-10-16 03:02:35.393267 | 2025-10-16 03:02:35.393354 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-10-16 03:02:35.929655 | debian-bookworm | ok 2025-10-16 03:02:35.951904 | 2025-10-16 03:02:35.952009 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-10-16 03:02:35.995515 | debian-bookworm | skipping: Conditional result was False 2025-10-16 03:02:36.004607 | 2025-10-16 03:02:36.004697 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-10-16 03:02:36.893757 | debian-bookworm | ok 2025-10-16 03:02:36.922170 | 2025-10-16 03:02:36.922269 | TASK [validate-host : Define zuul_info_dir fact] 2025-10-16 03:02:36.960348 | debian-bookworm | ok 2025-10-16 03:02:36.965739 | 2025-10-16 03:02:36.965846 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-10-16 03:02:37.882192 | debian-bookworm -> localhost | ok 2025-10-16 03:02:37.887727 | 2025-10-16 03:02:37.887815 | TASK [validate-host : Collect information about the host] 2025-10-16 03:02:39.628034 | debian-bookworm | ok 2025-10-16 03:02:39.642984 | 2025-10-16 03:02:39.643077 | TASK [validate-host : Sanitize hostname] 2025-10-16 03:02:39.862680 | debian-bookworm | ok 2025-10-16 03:02:39.935102 | 2025-10-16 03:02:39.935207 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-10-16 03:02:40.924435 | debian-bookworm -> localhost | changed 2025-10-16 03:02:40.929015 | 2025-10-16 03:02:40.929095 | TASK [validate-host : Collect information about zuul worker] 2025-10-16 03:02:41.329969 | debian-bookworm | ok 2025-10-16 03:02:41.341454 | 2025-10-16 03:02:41.341544 | TASK [validate-host : Write out all zuul information for each host] 2025-10-16 03:02:42.721132 | debian-bookworm -> localhost | changed 2025-10-16 03:02:42.733071 | 2025-10-16 03:02:42.733157 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-10-16 03:02:43.067818 | debian-bookworm | ok 2025-10-16 03:02:43.073693 | 2025-10-16 03:02:43.073783 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-10-16 03:02:45.215553 | debian-bookworm | changed: 2025-10-16 03:02:45.215757 | debian-bookworm | cd+++++++++ src/ 2025-10-16 03:02:45.215805 | debian-bookworm | cd+++++++++ src/github.com/ 2025-10-16 03:02:45.215830 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-10-16 03:02:45.215851 | debian-bookworm | cd+++++++++ src/github.com/osism/node-image/ 2025-10-16 03:02:45.215870 | debian-bookworm | Containerfile 2025-10-16 03:02:45.215997 | debian-bookworm | localhost | ok: Runtime: 0:00:00.008882 2025-10-16 03:03:10.351471 | 2025-10-16 03:03:10.352702 | TASK [upload-logs : Upload logs to log server] 2025-10-16 03:03:11.309362 | localhost | Output suppressed because no_log was given 2025-10-16 03:03:11.311373 | 2025-10-16 03:03:11.311485 | LOOP [upload-logs : Compress console log and json output] 2025-10-16 03:03:11.381733 | localhost | skipping: Conditional result was False 2025-10-16 03:03:11.391159 | localhost | skipping: Conditional result was False 2025-10-16 03:03:11.400438 | 2025-10-16 03:03:11.400598 | LOOP [upload-logs : Upload compressed console log and json output] 2025-10-16 03:03:11.510420 | localhost | skipping: Conditional result was False 2025-10-16 03:03:11.510703 | 2025-10-16 03:03:11.541170 | localhost | skipping: Conditional result was False 2025-10-16 03:03:11.548029 | 2025-10-16 03:03:11.548163 | LOOP [upload-logs : Upload console log and json output]