2025-12-04 15:34:15.037775 | Job console starting 2025-12-04 15:34:15.069315 | Updating git repos 2025-12-04 15:34:15.103666 | Cloning repos into workspace 2025-12-04 15:34:15.160426 | Restoring repo states 2025-12-04 15:34:15.169553 | Merging changes 2025-12-04 15:34:15.730723 | Checking out repos 2025-12-04 15:34:15.808205 | Preparing playbooks 2025-12-04 15:34:16.677018 | Running Ansible setup 2025-12-04 15:34:21.358743 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-12-04 15:34:22.162701 | 2025-12-04 15:34:22.162924 | PLAY [Base pre] 2025-12-04 15:34:22.179222 | 2025-12-04 15:34:22.179384 | TASK [Setup log path fact] 2025-12-04 15:34:22.210240 | debian-bookworm | ok 2025-12-04 15:34:22.229799 | 2025-12-04 15:34:22.229985 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-12-04 15:34:22.260702 | debian-bookworm | ok 2025-12-04 15:34:22.270872 | 2025-12-04 15:34:22.271041 | TASK [emit-job-header : Print job information] 2025-12-04 15:34:22.309981 | # Job Information 2025-12-04 15:34:22.310168 | Ansible Version: 2.16.14 2025-12-04 15:34:22.310204 | Job: python-black 2025-12-04 15:34:22.310237 | Pipeline: check 2025-12-04 15:34:22.310260 | Executor: 521e9411259a 2025-12-04 15:34:22.310281 | Triggered by: https://github.com/osism/testbed/pull/2791 2025-12-04 15:34:22.310310 | Event ID: ab8778b0-d126-11f0-85a0-a97e662d796f 2025-12-04 15:34:22.315977 | 2025-12-04 15:34:22.319726 | LOOP [emit-job-header : Print node information] 2025-12-04 15:34:22.448235 | debian-bookworm | ok: 2025-12-04 15:34:22.448492 | debian-bookworm | # Node Information 2025-12-04 15:34:22.448528 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-12-04 15:34:22.448553 | debian-bookworm | Hostname: debian 2025-12-04 15:34:22.448575 | debian-bookworm | Username: zuul 2025-12-04 15:34:22.448595 | debian-bookworm | Distro: Debian 12.12 2025-12-04 15:34:22.448618 | debian-bookworm | Provider: regiocloud-a 2025-12-04 15:34:22.448639 | debian-bookworm | Region: 2025-12-04 15:34:22.448659 | debian-bookworm | Label: debian-bookworm 2025-12-04 15:34:22.448678 | debian-bookworm | Product Name: OpenStack Nova 2025-12-04 15:34:22.448697 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe1e:b031 2025-12-04 15:34:22.470472 | 2025-12-04 15:34:22.470623 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-12-04 15:34:23.035536 | debian-bookworm -> localhost | changed 2025-12-04 15:34:23.050109 | 2025-12-04 15:34:23.050314 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-12-04 15:34:24.238551 | debian-bookworm -> localhost | changed 2025-12-04 15:34:24.250826 | 2025-12-04 15:34:24.252830 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-12-04 15:34:24.574734 | debian-bookworm -> localhost | ok 2025-12-04 15:34:24.581402 | 2025-12-04 15:34:24.581535 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-12-04 15:34:24.617216 | debian-bookworm | ok 2025-12-04 15:34:24.658551 | debian-bookworm | included: /var/lib/zuul/builds/29ec8f278ae8413daa9152457b9ee1a0/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-12-04 15:34:24.672010 | 2025-12-04 15:34:24.672195 | TASK [add-build-sshkey : Create Temp SSH key] 2025-12-04 15:34:25.923401 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-12-04 15:34:25.923749 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/29ec8f278ae8413daa9152457b9ee1a0/work/29ec8f278ae8413daa9152457b9ee1a0_id_rsa 2025-12-04 15:34:25.923802 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/29ec8f278ae8413daa9152457b9ee1a0/work/29ec8f278ae8413daa9152457b9ee1a0_id_rsa.pub 2025-12-04 15:34:25.923829 | debian-bookworm -> localhost | The key fingerprint is: 2025-12-04 15:34:25.923856 | debian-bookworm -> localhost | SHA256:IMIuhcJ4E5RQBoEx0VG7PaycOPueH5q6lBh9NGKvKU0 zuul-build-sshkey 2025-12-04 15:34:25.923879 | debian-bookworm -> localhost | The key's randomart image is: 2025-12-04 15:34:25.923930 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-12-04 15:34:25.923954 | debian-bookworm -> localhost | |OX*+. | 2025-12-04 15:34:25.923976 | debian-bookworm -> localhost | |+=o. . | 2025-12-04 15:34:25.923995 | debian-bookworm -> localhost | |+.O = . | 2025-12-04 15:34:25.924015 | debian-bookworm -> localhost | |.* * * . | 2025-12-04 15:34:25.924036 | debian-bookworm -> localhost | |o E + + S | 2025-12-04 15:34:25.924060 | debian-bookworm -> localhost | | * B o . | 2025-12-04 15:34:25.924082 | debian-bookworm -> localhost | |o O + . | 2025-12-04 15:34:25.924103 | debian-bookworm -> localhost | | o o + . | 2025-12-04 15:34:25.924124 | debian-bookworm -> localhost | | +=*.. | 2025-12-04 15:34:25.924145 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-12-04 15:34:25.924199 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.666741 2025-12-04 15:34:25.934754 | 2025-12-04 15:34:25.935022 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-12-04 15:34:25.964860 | debian-bookworm | ok 2025-12-04 15:34:25.974803 | debian-bookworm | included: /var/lib/zuul/builds/29ec8f278ae8413daa9152457b9ee1a0/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-12-04 15:34:25.985360 | 2025-12-04 15:34:25.985498 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-12-04 15:34:26.009729 | debian-bookworm | skipping: Conditional result was False 2025-12-04 15:34:26.016048 | 2025-12-04 15:34:26.016179 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-12-04 15:34:26.667339 | debian-bookworm | changed 2025-12-04 15:34:26.674809 | 2025-12-04 15:34:26.674985 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-12-04 15:34:26.940435 | debian-bookworm | ok 2025-12-04 15:34:26.946961 | 2025-12-04 15:34:26.947096 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-12-04 15:34:27.605665 | debian-bookworm | changed 2025-12-04 15:34:27.618458 | 2025-12-04 15:34:27.618673 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-12-04 15:34:28.255355 | debian-bookworm | changed 2025-12-04 15:34:28.263859 | 2025-12-04 15:34:28.264038 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-12-04 15:34:28.293040 | debian-bookworm | skipping: Conditional result was False 2025-12-04 15:34:28.299745 | 2025-12-04 15:34:28.299872 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-12-04 15:34:28.783341 | debian-bookworm -> localhost | changed 2025-12-04 15:34:28.794662 | 2025-12-04 15:34:28.794791 | TASK [add-build-sshkey : Add back temp key] 2025-12-04 15:34:29.163520 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/29ec8f278ae8413daa9152457b9ee1a0/work/29ec8f278ae8413daa9152457b9ee1a0_id_rsa (zuul-build-sshkey) 2025-12-04 15:34:29.163777 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.016090 2025-12-04 15:34:29.172430 | 2025-12-04 15:34:29.172558 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-12-04 15:34:29.596389 | debian-bookworm | ok 2025-12-04 15:34:29.601717 | 2025-12-04 15:34:29.601829 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-12-04 15:34:29.645801 | debian-bookworm | skipping: Conditional result was False 2025-12-04 15:34:29.657377 | 2025-12-04 15:34:29.657507 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-12-04 15:34:30.104281 | debian-bookworm | ok 2025-12-04 15:34:30.117264 | 2025-12-04 15:34:30.117408 | TASK [validate-host : Define zuul_info_dir fact] 2025-12-04 15:34:30.147383 | debian-bookworm | ok 2025-12-04 15:34:30.153062 | 2025-12-04 15:34:30.153181 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-12-04 15:34:30.471423 | debian-bookworm -> localhost | ok 2025-12-04 15:34:30.478687 | 2025-12-04 15:34:30.478830 | TASK [validate-host : Collect information about the host] 2025-12-04 15:34:31.621451 | debian-bookworm | ok 2025-12-04 15:34:31.634793 | 2025-12-04 15:34:31.635009 | TASK [validate-host : Sanitize hostname] 2025-12-04 15:34:31.774677 | debian-bookworm | ok 2025-12-04 15:34:31.822204 | 2025-12-04 15:34:31.822355 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-12-04 15:34:32.438797 | debian-bookworm -> localhost | changed 2025-12-04 15:34:32.445212 | 2025-12-04 15:34:32.445348 | TASK [validate-host : Collect information about zuul worker] 2025-12-04 15:34:32.865222 | debian-bookworm | ok 2025-12-04 15:34:32.872832 | 2025-12-04 15:34:32.873050 | TASK [validate-host : Write out all zuul information for each host] 2025-12-04 15:34:33.454670 | debian-bookworm -> localhost | changed 2025-12-04 15:34:33.464789 | 2025-12-04 15:34:33.464962 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-12-04 15:34:33.734438 | debian-bookworm | ok 2025-12-04 15:34:33.742193 | 2025-12-04 15:34:33.742337 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-12-04 15:34:35.027419 | debian-bookworm | changed: 2025-12-04 15:34:35.027682 | debian-bookworm | cd+++++++++ src/ 2025-12-04 15:34:35.027720 | debian-bookworm | cd+++++++++ src/github.com/ 2025-12-04 15:34:35.027746 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-12-04 15:34:35.027769 | debian-bookworm | cd+++++++++ src/github.com/osism/testbed/ 2025-12-04 15:34:35.027789 | debian-bookworm | localhost | ok: Runtime: 0:00:00.005574 2025-12-04 15:35:00.388164 | 2025-12-04 15:35:00.388285 | TASK [upload-logs : Upload logs to log server] 2025-12-04 15:35:01.032366 | localhost | Output suppressed because no_log was given 2025-12-04 15:35:01.035382 | 2025-12-04 15:35:01.035538 | LOOP [upload-logs : Compress console log and json output] 2025-12-04 15:35:01.107982 | localhost | skipping: Conditional result was False 2025-12-04 15:35:01.114663 | localhost | skipping: Conditional result was False 2025-12-04 15:35:01.127301 | 2025-12-04 15:35:01.127466 | LOOP [upload-logs : Upload compressed console log and json output] 2025-12-04 15:35:01.176034 | localhost | skipping: Conditional result was False 2025-12-04 15:35:01.176327 | 2025-12-04 15:35:01.181102 | localhost | skipping: Conditional result was False 2025-12-04 15:35:01.184922 | 2025-12-04 15:35:01.185093 | LOOP [upload-logs : Upload console log and json output]