2025-09-13 03:15:20.922515 | Job console starting 2025-09-13 03:15:20.953695 | Updating git repos 2025-09-13 03:15:20.998108 | Cloning repos into workspace 2025-09-13 03:15:21.037707 | Restoring repo states 2025-09-13 03:15:21.044594 | Merging changes 2025-09-13 03:15:21.044610 | Checking out repos 2025-09-13 03:15:21.115343 | Preparing playbooks 2025-09-13 03:15:22.263867 | Running Ansible setup 2025-09-13 03:15:26.820126 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-09-13 03:15:27.533526 | 2025-09-13 03:15:27.533651 | PLAY [Base pre] 2025-09-13 03:15:27.550072 | 2025-09-13 03:15:27.550185 | TASK [Setup log path fact] 2025-09-13 03:15:27.572271 | debian-bookworm | ok 2025-09-13 03:15:27.586526 | 2025-09-13 03:15:27.586641 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-09-13 03:15:27.608377 | debian-bookworm | ok 2025-09-13 03:15:27.617748 | 2025-09-13 03:15:27.617841 | TASK [emit-job-header : Print job information] 2025-09-13 03:15:27.657662 | # Job Information 2025-09-13 03:15:27.657811 | Ansible Version: 2.16.14 2025-09-13 03:15:27.657846 | Job: python-black 2025-09-13 03:15:27.657878 | Pipeline: periodic-daily 2025-09-13 03:15:27.657900 | Executor: 521e9411259a 2025-09-13 03:15:27.657921 | Triggered by: https://github.com/osism/sonic-manager 2025-09-13 03:15:27.657944 | Event ID: 95e3bcd1f55543c89a763a5c51cfef6d 2025-09-13 03:15:27.662717 | 2025-09-13 03:15:27.662809 | LOOP [emit-job-header : Print node information] 2025-09-13 03:15:27.762079 | debian-bookworm | ok: 2025-09-13 03:15:27.762239 | debian-bookworm | # Node Information 2025-09-13 03:15:27.762273 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-09-13 03:15:27.762299 | debian-bookworm | Hostname: debian 2025-09-13 03:15:27.762320 | debian-bookworm | Username: zuul 2025-09-13 03:15:27.762340 | debian-bookworm | Distro: Debian 12.12 2025-09-13 03:15:27.762364 | debian-bookworm | Provider: regiocloud-a 2025-09-13 03:15:27.762385 | debian-bookworm | Region: 2025-09-13 03:15:27.762406 | debian-bookworm | Label: debian-bookworm 2025-09-13 03:15:27.762436 | debian-bookworm | Product Name: OpenStack Nova 2025-09-13 03:15:27.762455 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe0a:7a4b 2025-09-13 03:15:27.777703 | 2025-09-13 03:15:27.777807 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-09-13 03:15:28.239688 | debian-bookworm -> localhost | changed 2025-09-13 03:15:28.246936 | 2025-09-13 03:15:28.247037 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-09-13 03:15:29.477345 | debian-bookworm -> localhost | changed 2025-09-13 03:15:29.508049 | 2025-09-13 03:15:29.508154 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-09-13 03:15:29.820031 | debian-bookworm -> localhost | ok 2025-09-13 03:15:29.826427 | 2025-09-13 03:15:29.826513 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-09-13 03:15:29.862280 | debian-bookworm | ok 2025-09-13 03:15:29.890276 | debian-bookworm | included: /var/lib/zuul/builds/39e5713e96054fe687f97a1ce7d42cac/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-09-13 03:15:29.898080 | 2025-09-13 03:15:29.898168 | TASK [add-build-sshkey : Create Temp SSH key] 2025-09-13 03:15:31.688608 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-09-13 03:15:31.688793 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/39e5713e96054fe687f97a1ce7d42cac/work/39e5713e96054fe687f97a1ce7d42cac_id_rsa 2025-09-13 03:15:31.688831 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/39e5713e96054fe687f97a1ce7d42cac/work/39e5713e96054fe687f97a1ce7d42cac_id_rsa.pub 2025-09-13 03:15:31.688858 | debian-bookworm -> localhost | The key fingerprint is: 2025-09-13 03:15:31.688886 | debian-bookworm -> localhost | SHA256:4n9H+suBI3qE/TObU2aejsnx3aeKKsdLzGLkGfN4L00 zuul-build-sshkey 2025-09-13 03:15:31.688909 | debian-bookworm -> localhost | The key's randomart image is: 2025-09-13 03:15:31.688938 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-09-13 03:15:31.688960 | debian-bookworm -> localhost | | | 2025-09-13 03:15:31.688982 | debian-bookworm -> localhost | | | 2025-09-13 03:15:31.689003 | debian-bookworm -> localhost | | | 2025-09-13 03:15:31.689023 | debian-bookworm -> localhost | | | 2025-09-13 03:15:31.689043 | debian-bookworm -> localhost | | =oS | 2025-09-13 03:15:31.689069 | debian-bookworm -> localhost | | +.Xo E.= | 2025-09-13 03:15:31.689089 | debian-bookworm -> localhost | | BoB++B.. | 2025-09-13 03:15:31.689109 | debian-bookworm -> localhost | | ..*=+OX+o ..| 2025-09-13 03:15:31.689130 | debian-bookworm -> localhost | | .++=OOBoo.o| 2025-09-13 03:15:31.689149 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-09-13 03:15:31.689200 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.082590 2025-09-13 03:15:31.695177 | 2025-09-13 03:15:31.695266 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-09-13 03:15:31.713036 | debian-bookworm | ok 2025-09-13 03:15:31.722520 | debian-bookworm | included: /var/lib/zuul/builds/39e5713e96054fe687f97a1ce7d42cac/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-09-13 03:15:31.733686 | 2025-09-13 03:15:31.733774 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-09-13 03:15:31.746540 | debian-bookworm | skipping: Conditional result was False 2025-09-13 03:15:31.751945 | 2025-09-13 03:15:31.752030 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-09-13 03:15:32.416541 | debian-bookworm | changed 2025-09-13 03:15:32.427355 | 2025-09-13 03:15:32.427801 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-09-13 03:15:32.681544 | debian-bookworm | ok 2025-09-13 03:15:32.688091 | 2025-09-13 03:15:32.688187 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-09-13 03:15:33.378312 | debian-bookworm | changed 2025-09-13 03:15:33.391765 | 2025-09-13 03:15:33.391864 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-09-13 03:15:34.148165 | debian-bookworm | changed 2025-09-13 03:15:34.160740 | 2025-09-13 03:15:34.160843 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-09-13 03:15:34.192488 | debian-bookworm | skipping: Conditional result was False 2025-09-13 03:15:34.201356 | 2025-09-13 03:15:34.201473 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-09-13 03:15:35.536148 | debian-bookworm -> localhost | changed 2025-09-13 03:15:35.545465 | 2025-09-13 03:15:35.545550 | TASK [add-build-sshkey : Add back temp key] 2025-09-13 03:15:36.207891 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/39e5713e96054fe687f97a1ce7d42cac/work/39e5713e96054fe687f97a1ce7d42cac_id_rsa (zuul-build-sshkey) 2025-09-13 03:15:36.208079 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.010632 2025-09-13 03:15:36.214225 | 2025-09-13 03:15:36.214301 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-09-13 03:15:36.680182 | debian-bookworm | ok 2025-09-13 03:15:36.684313 | 2025-09-13 03:15:36.684392 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-09-13 03:15:36.723533 | debian-bookworm | skipping: Conditional result was False 2025-09-13 03:15:36.731785 | 2025-09-13 03:15:36.731867 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-09-13 03:15:37.238422 | debian-bookworm | ok 2025-09-13 03:15:37.259500 | 2025-09-13 03:15:37.259593 | TASK [validate-host : Define zuul_info_dir fact] 2025-09-13 03:15:37.342129 | debian-bookworm | ok 2025-09-13 03:15:37.348777 | 2025-09-13 03:15:37.348860 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-09-13 03:15:37.933151 | debian-bookworm -> localhost | ok 2025-09-13 03:15:37.938703 | 2025-09-13 03:15:37.938793 | TASK [validate-host : Collect information about the host] 2025-09-13 03:15:39.181111 | debian-bookworm | ok 2025-09-13 03:15:39.195263 | 2025-09-13 03:15:39.195350 | TASK [validate-host : Sanitize hostname] 2025-09-13 03:15:39.296786 | debian-bookworm | ok 2025-09-13 03:15:39.356314 | 2025-09-13 03:15:39.356439 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-09-13 03:15:40.117000 | debian-bookworm -> localhost | changed 2025-09-13 03:15:40.122252 | 2025-09-13 03:15:40.122336 | TASK [validate-host : Collect information about zuul worker] 2025-09-13 03:15:40.524264 | debian-bookworm | ok 2025-09-13 03:15:40.528682 | 2025-09-13 03:15:40.528778 | TASK [validate-host : Write out all zuul information for each host] 2025-09-13 03:15:41.332125 | debian-bookworm -> localhost | changed 2025-09-13 03:15:41.341035 | 2025-09-13 03:15:41.341136 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-09-13 03:15:41.617312 | debian-bookworm | ok 2025-09-13 03:15:41.623671 | 2025-09-13 03:15:41.623754 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-09-13 03:15:42.579972 | debian-bookworm | changed: 2025-09-13 03:15:42.580126 | debian-bookworm | cd+++++++++ src/ 2025-09-13 03:15:42.580154 | debian-bookworm | cd+++++++++ src/github.com/ 2025-09-13 03:15:42.580174 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-09-13 03:15:42.580192 | debian-bookworm | cd+++++++++ src/github.com/osism/sonic-manager/ 2025-09-13 03:15:42.580208 | debian-bookworm | localhost | ok: Runtime: 0:00:00.006845 2025-09-13 03:16:10.166562 | 2025-09-13 03:16:10.166658 | TASK [upload-logs : Upload logs to log server] 2025-09-13 03:16:10.894796 | localhost | Output suppressed because no_log was given 2025-09-13 03:16:10.896566 | 2025-09-13 03:16:10.896644 | LOOP [upload-logs : Compress console log and json output] 2025-09-13 03:16:11.002783 | localhost | skipping: Conditional result was False 2025-09-13 03:16:11.023525 | localhost | skipping: Conditional result was False 2025-09-13 03:16:11.036117 | 2025-09-13 03:16:11.036212 | LOOP [upload-logs : Upload compressed console log and json output] 2025-09-13 03:16:11.180382 | localhost | skipping: Conditional result was False 2025-09-13 03:16:11.180644 | 2025-09-13 03:16:11.192789 | localhost | skipping: Conditional result was False 2025-09-13 03:16:11.203453 | 2025-09-13 03:16:11.203557 | LOOP [upload-logs : Upload console log and json output]