2025-12-03 03:16:20.817572 | Job console starting 2025-12-03 03:16:20.863904 | Updating git repos 2025-12-03 03:16:20.925721 | Cloning repos into workspace 2025-12-03 03:16:20.971027 | Restoring repo states 2025-12-03 03:16:20.985182 | Merging changes 2025-12-03 03:16:20.985201 | Checking out repos 2025-12-03 03:16:21.119338 | Preparing playbooks 2025-12-03 03:16:22.601328 | Running Ansible setup 2025-12-03 03:16:29.231139 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-12-03 03:16:30.519793 | 2025-12-03 03:16:30.519964 | PLAY [Base pre] 2025-12-03 03:16:30.574081 | 2025-12-03 03:16:30.574238 | TASK [Setup log path fact] 2025-12-03 03:16:30.603941 | debian-bookworm | ok 2025-12-03 03:16:30.629489 | 2025-12-03 03:16:30.629662 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-12-03 03:16:30.660003 | debian-bookworm | ok 2025-12-03 03:16:30.673698 | 2025-12-03 03:16:30.679139 | TASK [emit-job-header : Print job information] 2025-12-03 03:16:30.778423 | # Job Information 2025-12-03 03:16:30.778628 | Ansible Version: 2.16.14 2025-12-03 03:16:30.778665 | Job: python-black 2025-12-03 03:16:30.778698 | Pipeline: periodic-daily 2025-12-03 03:16:30.778721 | Executor: 521e9411259a 2025-12-03 03:16:30.778742 | Triggered by: https://github.com/osism/cinder-driver-dm-clone 2025-12-03 03:16:30.778765 | Event ID: af07d4e4d3c54e8e9c919a3f1c76a492 2025-12-03 03:16:30.784191 | 2025-12-03 03:16:30.784317 | LOOP [emit-job-header : Print node information] 2025-12-03 03:16:30.925812 | debian-bookworm | ok: 2025-12-03 03:16:30.926894 | debian-bookworm | # Node Information 2025-12-03 03:16:30.926980 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-12-03 03:16:30.927007 | debian-bookworm | Hostname: debian 2025-12-03 03:16:30.927030 | debian-bookworm | Username: zuul 2025-12-03 03:16:30.927051 | debian-bookworm | Distro: Debian 12.12 2025-12-03 03:16:30.927075 | debian-bookworm | Provider: regiocloud-a 2025-12-03 03:16:30.927307 | debian-bookworm | Region: 2025-12-03 03:16:30.927338 | debian-bookworm | Label: debian-bookworm 2025-12-03 03:16:30.927397 | debian-bookworm | Product Name: OpenStack Nova 2025-12-03 03:16:30.927419 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe87:b674 2025-12-03 03:16:30.953882 | 2025-12-03 03:16:30.954047 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-12-03 03:16:32.134246 | debian-bookworm -> localhost | changed 2025-12-03 03:16:32.142421 | 2025-12-03 03:16:32.142641 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-12-03 03:16:34.279753 | debian-bookworm -> localhost | changed 2025-12-03 03:16:34.302310 | 2025-12-03 03:16:34.302504 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-12-03 03:16:34.977954 | debian-bookworm -> localhost | ok 2025-12-03 03:16:34.985210 | 2025-12-03 03:16:34.985346 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-12-03 03:16:35.033030 | debian-bookworm | ok 2025-12-03 03:16:35.076148 | debian-bookworm | included: /var/lib/zuul/builds/0171d7cf655c44dc9d453f56d5c439d5/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-12-03 03:16:35.096449 | 2025-12-03 03:16:35.096590 | TASK [add-build-sshkey : Create Temp SSH key] 2025-12-03 03:16:36.813764 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-12-03 03:16:36.813924 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/0171d7cf655c44dc9d453f56d5c439d5/work/0171d7cf655c44dc9d453f56d5c439d5_id_rsa 2025-12-03 03:16:36.813955 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/0171d7cf655c44dc9d453f56d5c439d5/work/0171d7cf655c44dc9d453f56d5c439d5_id_rsa.pub 2025-12-03 03:16:36.813976 | debian-bookworm -> localhost | The key fingerprint is: 2025-12-03 03:16:36.813996 | debian-bookworm -> localhost | SHA256:VgrXZqq5UvmVdNx7yccw0XwBirXFrjMcC4G1+BEnLHo zuul-build-sshkey 2025-12-03 03:16:36.814015 | debian-bookworm -> localhost | The key's randomart image is: 2025-12-03 03:16:36.814041 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-12-03 03:16:36.814059 | debian-bookworm -> localhost | | ++ o.o.+.| 2025-12-03 03:16:36.814076 | debian-bookworm -> localhost | | o.+B +.. +| 2025-12-03 03:16:36.814105 | debian-bookworm -> localhost | | o.o+*+.. ..| 2025-12-03 03:16:36.814121 | debian-bookworm -> localhost | | . E.Bo.o.+ | 2025-12-03 03:16:36.814137 | debian-bookworm -> localhost | | ..Sooo+ .=.| 2025-12-03 03:16:36.814157 | debian-bookworm -> localhost | | o+ o* .o+| 2025-12-03 03:16:36.814174 | debian-bookworm -> localhost | | .o. . o ..| 2025-12-03 03:16:36.814191 | debian-bookworm -> localhost | | . .. | 2025-12-03 03:16:36.814208 | debian-bookworm -> localhost | | .. | 2025-12-03 03:16:36.814224 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-12-03 03:16:36.814277 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.834603 2025-12-03 03:16:36.819488 | 2025-12-03 03:16:36.819571 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-12-03 03:16:36.848941 | debian-bookworm | ok 2025-12-03 03:16:36.868878 | debian-bookworm | included: /var/lib/zuul/builds/0171d7cf655c44dc9d453f56d5c439d5/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-12-03 03:16:36.878497 | 2025-12-03 03:16:36.878582 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-12-03 03:16:36.903322 | debian-bookworm | skipping: Conditional result was False 2025-12-03 03:16:36.908209 | 2025-12-03 03:16:36.908292 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-12-03 03:16:37.667214 | debian-bookworm | changed 2025-12-03 03:16:37.682095 | 2025-12-03 03:16:37.682199 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-12-03 03:16:37.934425 | debian-bookworm | ok 2025-12-03 03:16:37.942608 | 2025-12-03 03:16:37.942721 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-12-03 03:16:38.555240 | debian-bookworm | changed 2025-12-03 03:16:38.569471 | 2025-12-03 03:16:38.569582 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-12-03 03:16:39.173076 | debian-bookworm | changed 2025-12-03 03:16:39.181002 | 2025-12-03 03:16:39.181127 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-12-03 03:16:39.205086 | debian-bookworm | skipping: Conditional result was False 2025-12-03 03:16:39.213101 | 2025-12-03 03:16:39.213232 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-12-03 03:16:39.625944 | debian-bookworm -> localhost | changed 2025-12-03 03:16:39.655650 | 2025-12-03 03:16:39.655832 | TASK [add-build-sshkey : Add back temp key] 2025-12-03 03:16:40.223720 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/0171d7cf655c44dc9d453f56d5c439d5/work/0171d7cf655c44dc9d453f56d5c439d5_id_rsa (zuul-build-sshkey) 2025-12-03 03:16:40.223933 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.027414 2025-12-03 03:16:40.235610 | 2025-12-03 03:16:40.235711 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-12-03 03:16:40.634706 | debian-bookworm | ok 2025-12-03 03:16:40.641853 | 2025-12-03 03:16:40.641993 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-12-03 03:16:40.681959 | debian-bookworm | skipping: Conditional result was False 2025-12-03 03:16:40.706640 | 2025-12-03 03:16:40.706794 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-12-03 03:16:41.215868 | debian-bookworm | ok 2025-12-03 03:16:41.232337 | 2025-12-03 03:16:41.232519 | TASK [validate-host : Define zuul_info_dir fact] 2025-12-03 03:16:41.284763 | debian-bookworm | ok 2025-12-03 03:16:41.310544 | 2025-12-03 03:16:41.311810 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-12-03 03:16:41.911736 | debian-bookworm -> localhost | ok 2025-12-03 03:16:41.924459 | 2025-12-03 03:16:41.924604 | TASK [validate-host : Collect information about the host] 2025-12-03 03:16:44.291060 | debian-bookworm | ok 2025-12-03 03:16:44.306313 | 2025-12-03 03:16:44.306480 | TASK [validate-host : Sanitize hostname] 2025-12-03 03:16:44.418037 | debian-bookworm | ok 2025-12-03 03:16:44.464670 | 2025-12-03 03:16:44.464810 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-12-03 03:16:45.144605 | debian-bookworm -> localhost | changed 2025-12-03 03:16:45.150571 | 2025-12-03 03:16:45.150691 | TASK [validate-host : Collect information about zuul worker] 2025-12-03 03:16:45.601376 | debian-bookworm | ok 2025-12-03 03:16:45.606466 | 2025-12-03 03:16:45.606595 | TASK [validate-host : Write out all zuul information for each host] 2025-12-03 03:16:46.293376 | debian-bookworm -> localhost | changed 2025-12-03 03:16:46.309993 | 2025-12-03 03:16:46.310138 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-12-03 03:16:46.618617 | debian-bookworm | ok 2025-12-03 03:16:46.624848 | 2025-12-03 03:16:46.624973 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-12-03 03:16:47.449524 | debian-bookworm | changed: 2025-12-03 03:16:47.449880 | debian-bookworm | cd+++++++++ src/ 2025-12-03 03:16:47.449941 | debian-bookworm | cd+++++++++ src/github.com/ 2025-12-03 03:16:47.449984 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-12-03 03:16:47.450026 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/ 2025-12-03 03:16:47.450071 | debian-bookworm | localhost | ok: Runtime: 0:00:00.021454 2025-12-03 03:17:17.931295 | 2025-12-03 03:17:17.931425 | TASK [upload-logs : Upload logs to log server] 2025-12-03 03:17:18.593372 | localhost | Output suppressed because no_log was given 2025-12-03 03:17:18.595025 | 2025-12-03 03:17:18.595113 | LOOP [upload-logs : Compress console log and json output] 2025-12-03 03:17:18.651638 | localhost | skipping: Conditional result was False 2025-12-03 03:17:18.657810 | localhost | skipping: Conditional result was False 2025-12-03 03:17:18.660939 | 2025-12-03 03:17:18.661045 | LOOP [upload-logs : Upload compressed console log and json output] 2025-12-03 03:17:18.721039 | localhost | skipping: Conditional result was False 2025-12-03 03:17:18.721449 | 2025-12-03 03:17:18.726954 | localhost | skipping: Conditional result was False 2025-12-03 03:17:18.730063 | 2025-12-03 03:17:18.730155 | LOOP [upload-logs : Upload console log and json output]