2025-10-22 03:02:23.966222 | Job console starting 2025-10-22 03:02:23.979452 | Updating git repos 2025-10-22 03:02:23.999024 | Cloning repos into workspace 2025-10-22 03:02:24.030488 | Restoring repo states 2025-10-22 03:02:24.050011 | Merging changes 2025-10-22 03:02:24.050031 | Checking out repos 2025-10-22 03:02:24.109681 | Preparing playbooks 2025-10-22 03:02:24.673032 | Running Ansible setup 2025-10-22 03:02:29.361186 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-10-22 03:02:30.196890 | 2025-10-22 03:02:30.197043 | PLAY [Base pre] 2025-10-22 03:02:30.212572 | 2025-10-22 03:02:30.212699 | TASK [Setup log path fact] 2025-10-22 03:02:30.241601 | debian-bookworm | ok 2025-10-22 03:02:30.257835 | 2025-10-22 03:02:30.257978 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-10-22 03:02:30.298478 | debian-bookworm | ok 2025-10-22 03:02:30.315471 | 2025-10-22 03:02:30.315608 | TASK [emit-job-header : Print job information] 2025-10-22 03:02:30.416325 | # Job Information 2025-10-22 03:02:30.416511 | Ansible Version: 2.16.14 2025-10-22 03:02:30.416546 | Job: python-black 2025-10-22 03:02:30.416579 | Pipeline: periodic-daily 2025-10-22 03:02:30.416603 | Executor: 521e9411259a 2025-10-22 03:02:30.416624 | Triggered by: https://github.com/osism/sonic-manager 2025-10-22 03:02:30.416647 | Event ID: c27ed590b91a4c58848cbb51fe48c877 2025-10-22 03:02:30.422597 | 2025-10-22 03:02:30.422735 | LOOP [emit-job-header : Print node information] 2025-10-22 03:02:30.563253 | debian-bookworm | ok: 2025-10-22 03:02:30.563452 | debian-bookworm | # Node Information 2025-10-22 03:02:30.563494 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-10-22 03:02:30.563526 | debian-bookworm | Hostname: debian 2025-10-22 03:02:30.563555 | debian-bookworm | Username: zuul 2025-10-22 03:02:30.563582 | debian-bookworm | Distro: Debian 12.12 2025-10-22 03:02:30.563612 | debian-bookworm | Provider: regiocloud-a 2025-10-22 03:02:30.563639 | debian-bookworm | Region: 2025-10-22 03:02:30.563667 | debian-bookworm | Label: debian-bookworm 2025-10-22 03:02:30.563693 | debian-bookworm | Product Name: OpenStack Nova 2025-10-22 03:02:30.563737 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fec2:520a 2025-10-22 03:02:30.586946 | 2025-10-22 03:02:30.590334 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-10-22 03:02:31.154035 | debian-bookworm -> localhost | changed 2025-10-22 03:02:31.167599 | 2025-10-22 03:02:31.167793 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-10-22 03:02:32.234146 | debian-bookworm -> localhost | changed 2025-10-22 03:02:32.245118 | 2025-10-22 03:02:32.245244 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-10-22 03:02:32.522341 | debian-bookworm -> localhost | ok 2025-10-22 03:02:32.528873 | 2025-10-22 03:02:32.529005 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-10-22 03:02:32.558711 | debian-bookworm | ok 2025-10-22 03:02:32.577425 | debian-bookworm | included: /var/lib/zuul/builds/c736f85b004d420e8c8ba50a0db2c92c/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-10-22 03:02:32.584230 | 2025-10-22 03:02:32.584345 | TASK [add-build-sshkey : Create Temp SSH key] 2025-10-22 03:02:33.636643 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-10-22 03:02:33.636878 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/c736f85b004d420e8c8ba50a0db2c92c/work/c736f85b004d420e8c8ba50a0db2c92c_id_rsa 2025-10-22 03:02:33.636918 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/c736f85b004d420e8c8ba50a0db2c92c/work/c736f85b004d420e8c8ba50a0db2c92c_id_rsa.pub 2025-10-22 03:02:33.636944 | debian-bookworm -> localhost | The key fingerprint is: 2025-10-22 03:02:33.636970 | debian-bookworm -> localhost | SHA256:3nBwNPYxBxfQI43aawqnuDweK70k2PXQw3hwubQ88JI zuul-build-sshkey 2025-10-22 03:02:33.636993 | debian-bookworm -> localhost | The key's randomart image is: 2025-10-22 03:02:33.637026 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-10-22 03:02:33.637049 | debian-bookworm -> localhost | | + =*+. | 2025-10-22 03:02:33.637071 | debian-bookworm -> localhost | | + oo=+ | 2025-10-22 03:02:33.637091 | debian-bookworm -> localhost | | o = .o.. . | 2025-10-22 03:02:33.637111 | debian-bookworm -> localhost | | % =. . | 2025-10-22 03:02:33.637130 | debian-bookworm -> localhost | | E S . . | 2025-10-22 03:02:33.637156 | debian-bookworm -> localhost | | o . *.*. o | 2025-10-22 03:02:33.637176 | debian-bookworm -> localhost | | . o.o.o+.o | 2025-10-22 03:02:33.637196 | debian-bookworm -> localhost | | .++o. . | 2025-10-22 03:02:33.637216 | debian-bookworm -> localhost | | o*+ | 2025-10-22 03:02:33.637236 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-10-22 03:02:33.637286 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.514456 2025-10-22 03:02:33.643972 | 2025-10-22 03:02:33.644077 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-10-22 03:02:33.672282 | debian-bookworm | ok 2025-10-22 03:02:33.681648 | debian-bookworm | included: /var/lib/zuul/builds/c736f85b004d420e8c8ba50a0db2c92c/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-10-22 03:02:33.693460 | 2025-10-22 03:02:33.693592 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-10-22 03:02:33.718410 | debian-bookworm | skipping: Conditional result was False 2025-10-22 03:02:33.724374 | 2025-10-22 03:02:33.724478 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-10-22 03:02:34.462223 | debian-bookworm | changed 2025-10-22 03:02:34.471989 | 2025-10-22 03:02:34.472138 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-10-22 03:02:34.763079 | debian-bookworm | ok 2025-10-22 03:02:34.777166 | 2025-10-22 03:02:34.777347 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-10-22 03:02:35.494346 | debian-bookworm | changed 2025-10-22 03:02:35.503955 | 2025-10-22 03:02:35.504084 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-10-22 03:02:36.227511 | debian-bookworm | changed 2025-10-22 03:02:36.235191 | 2025-10-22 03:02:36.235315 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-10-22 03:02:36.259554 | debian-bookworm | skipping: Conditional result was False 2025-10-22 03:02:36.269904 | 2025-10-22 03:02:36.270054 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-10-22 03:02:36.700287 | debian-bookworm -> localhost | changed 2025-10-22 03:02:36.711369 | 2025-10-22 03:02:36.711483 | TASK [add-build-sshkey : Add back temp key] 2025-10-22 03:02:37.049770 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/c736f85b004d420e8c8ba50a0db2c92c/work/c736f85b004d420e8c8ba50a0db2c92c_id_rsa (zuul-build-sshkey) 2025-10-22 03:02:37.050093 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.021960 2025-10-22 03:02:37.059126 | 2025-10-22 03:02:37.059245 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-10-22 03:02:37.483567 | debian-bookworm | ok 2025-10-22 03:02:37.493284 | 2025-10-22 03:02:37.493433 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-10-22 03:02:37.528169 | debian-bookworm | skipping: Conditional result was False 2025-10-22 03:02:37.548241 | 2025-10-22 03:02:37.548433 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-10-22 03:02:38.044513 | debian-bookworm | ok 2025-10-22 03:02:38.055551 | 2025-10-22 03:02:38.055679 | TASK [validate-host : Define zuul_info_dir fact] 2025-10-22 03:02:38.095117 | debian-bookworm | ok 2025-10-22 03:02:38.100199 | 2025-10-22 03:02:38.100305 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-10-22 03:02:38.432390 | debian-bookworm -> localhost | ok 2025-10-22 03:02:38.443664 | 2025-10-22 03:02:38.443878 | TASK [validate-host : Collect information about the host] 2025-10-22 03:02:39.626879 | debian-bookworm | ok 2025-10-22 03:02:39.640796 | 2025-10-22 03:02:39.640982 | TASK [validate-host : Sanitize hostname] 2025-10-22 03:02:39.741620 | debian-bookworm | ok 2025-10-22 03:02:39.781630 | 2025-10-22 03:02:39.781777 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-10-22 03:02:40.367079 | debian-bookworm -> localhost | changed 2025-10-22 03:02:40.373338 | 2025-10-22 03:02:40.373450 | TASK [validate-host : Collect information about zuul worker] 2025-10-22 03:02:40.802367 | debian-bookworm | ok 2025-10-22 03:02:40.810070 | 2025-10-22 03:02:40.810225 | TASK [validate-host : Write out all zuul information for each host] 2025-10-22 03:02:41.350472 | debian-bookworm -> localhost | changed 2025-10-22 03:02:41.360239 | 2025-10-22 03:02:41.360345 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-10-22 03:02:41.688274 | debian-bookworm | ok 2025-10-22 03:02:41.698209 | 2025-10-22 03:02:41.698370 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-10-22 03:02:42.552696 | debian-bookworm | changed: 2025-10-22 03:02:42.552908 | debian-bookworm | cd+++++++++ src/ 2025-10-22 03:02:42.552942 | debian-bookworm | cd+++++++++ src/github.com/ 2025-10-22 03:02:42.552966 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-10-22 03:02:42.552988 | debian-bookworm | cd+++++++++ src/github.com/osism/sonic-manager/ 2025-10-22 03:02:42.553008 | debian-bookworm | localhost | ok: Runtime: 0:00:00.006648 2025-10-22 03:03:08.416761 | 2025-10-22 03:03:08.416895 | TASK [upload-logs : Upload logs to log server] 2025-10-22 03:03:08.949460 | localhost | Output suppressed because no_log was given 2025-10-22 03:03:08.952414 | 2025-10-22 03:03:08.952551 | LOOP [upload-logs : Compress console log and json output] 2025-10-22 03:03:09.012147 | localhost | skipping: Conditional result was False 2025-10-22 03:03:09.019957 | localhost | skipping: Conditional result was False 2025-10-22 03:03:09.034220 | 2025-10-22 03:03:09.034417 | LOOP [upload-logs : Upload compressed console log and json output] 2025-10-22 03:03:09.078634 | localhost | skipping: Conditional result was False 2025-10-22 03:03:09.078984 | 2025-10-22 03:03:09.085723 | localhost | skipping: Conditional result was False 2025-10-22 03:03:09.095897 | 2025-10-22 03:03:09.096153 | LOOP [upload-logs : Upload console log and json output]