2026-10-01 03:08:29.068442 | Job console starting 2026-10-01 03:08:29.080867 | Updating git repos 2026-10-01 03:08:29.120482 | Cloning repos into workspace 2026-10-01 03:08:29.174502 | Restoring repo states 2026-10-01 03:08:29.181231 | Merging changes 2026-10-01 03:08:29.181243 | Checking out repos 2026-10-01 03:08:29.326744 | Preparing playbooks 2026-10-01 03:08:30.372836 | Running Ansible setup 2026-10-01 03:08:34.908782 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-10-01 03:08:35.704356 | 2026-10-01 03:08:35.704477 | PLAY [Base pre] 2026-10-01 03:08:35.733739 | 2026-10-01 03:08:35.733856 | TASK [Setup log path fact] 2026-10-01 03:08:35.751972 | debian-bookworm | ok 2026-10-01 03:08:35.776107 | 2026-10-01 03:08:35.776229 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-10-01 03:08:35.804263 | debian-bookworm | ok 2026-10-01 03:08:35.815135 | 2026-10-01 03:08:35.815232 | TASK [emit-job-header : Print job information] 2026-10-01 03:08:35.855382 | # Job Information 2026-10-01 03:08:35.855540 | Ansible Version: 2.16.14 2026-10-01 03:08:35.855576 | Job: python-osism-test-setup 2026-10-01 03:08:35.855632 | Pipeline: periodic-daily 2026-10-01 03:08:35.855658 | Executor: 521e9411259a 2026-10-01 03:08:35.855679 | Triggered by: https://github.com/osism/python-osism 2026-10-01 03:08:35.855701 | Event ID: 754ba8e07fec4c56ad0f81066397cb57 2026-10-01 03:08:35.861177 | 2026-10-01 03:08:35.861270 | LOOP [emit-job-header : Print node information] 2026-10-01 03:08:36.017474 | debian-bookworm | ok: 2026-10-01 03:08:36.022179 | debian-bookworm | # Node Information 2026-10-01 03:08:36.022249 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-10-01 03:08:36.022278 | debian-bookworm | Hostname: debian 2026-10-01 03:08:36.022301 | debian-bookworm | Username: zuul 2026-10-01 03:08:36.022322 | debian-bookworm | Distro: Debian 12.15 2026-10-01 03:08:36.022345 | debian-bookworm | Provider: regiocloud-a 2026-10-01 03:08:36.022365 | debian-bookworm | Region: 2026-10-01 03:08:36.022386 | debian-bookworm | Label: debian-bookworm 2026-10-01 03:08:36.022406 | debian-bookworm | Product Name: OpenStack Nova 2026-10-01 03:08:36.022425 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe0e:63f6 2026-10-01 03:08:36.040856 | 2026-10-01 03:08:36.040967 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-10-01 03:08:36.809408 | debian-bookworm -> localhost | changed 2026-10-01 03:08:36.817153 | 2026-10-01 03:08:36.817262 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-10-01 03:08:37.994800 | debian-bookworm -> localhost | changed 2026-10-01 03:08:38.004402 | 2026-10-01 03:08:38.005663 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-10-01 03:08:38.382666 | debian-bookworm -> localhost | ok 2026-10-01 03:08:38.389310 | 2026-10-01 03:08:38.389453 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-10-01 03:08:38.408541 | debian-bookworm | ok 2026-10-01 03:08:38.423079 | debian-bookworm | included: /var/lib/zuul/builds/8fce969ccdbf4e4fa1ef919f2dc5129b/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-10-01 03:08:38.429640 | 2026-10-01 03:08:38.429726 | TASK [add-build-sshkey : Create Temp SSH key] 2026-10-01 03:08:40.465159 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-10-01 03:08:40.465330 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/8fce969ccdbf4e4fa1ef919f2dc5129b/work/8fce969ccdbf4e4fa1ef919f2dc5129b_id_rsa 2026-10-01 03:08:40.465361 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/8fce969ccdbf4e4fa1ef919f2dc5129b/work/8fce969ccdbf4e4fa1ef919f2dc5129b_id_rsa.pub 2026-10-01 03:08:40.465382 | debian-bookworm -> localhost | The key fingerprint is: 2026-10-01 03:08:40.465401 | debian-bookworm -> localhost | SHA256:psNs23WdSfPV8SF1g8+QhFjjWPVvoK0D41fo0Fip7V0 zuul-build-sshkey 2026-10-01 03:08:40.465419 | debian-bookworm -> localhost | The key's randomart image is: 2026-10-01 03:08:40.465446 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-10-01 03:08:40.465464 | debian-bookworm -> localhost | | o++ooo.| 2026-10-01 03:08:40.465482 | debian-bookworm -> localhost | | .+..=o o| 2026-10-01 03:08:40.465499 | debian-bookworm -> localhost | | . .o.=+ | 2026-10-01 03:08:40.465515 | debian-bookworm -> localhost | | * +.+*| 2026-10-01 03:08:40.465531 | debian-bookworm -> localhost | | S * = = E| 2026-10-01 03:08:40.465562 | debian-bookworm -> localhost | | o o . * * B.| 2026-10-01 03:08:40.465581 | debian-bookworm -> localhost | | * o B = .| 2026-10-01 03:08:40.465598 | debian-bookworm -> localhost | | . + . o . | 2026-10-01 03:08:40.465638 | debian-bookworm -> localhost | | . . | 2026-10-01 03:08:40.465659 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-10-01 03:08:40.465709 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.555388 2026-10-01 03:08:40.470819 | 2026-10-01 03:08:40.470910 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-10-01 03:08:40.507908 | debian-bookworm | ok 2026-10-01 03:08:40.519026 | debian-bookworm | included: /var/lib/zuul/builds/8fce969ccdbf4e4fa1ef919f2dc5129b/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-10-01 03:08:40.536496 | 2026-10-01 03:08:40.536583 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-10-01 03:08:40.569316 | debian-bookworm | skipping: Conditional result was False 2026-10-01 03:08:40.574450 | 2026-10-01 03:08:40.574528 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-10-01 03:08:41.291964 | debian-bookworm | changed 2026-10-01 03:08:41.298726 | 2026-10-01 03:08:41.298811 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-10-01 03:08:41.603206 | debian-bookworm | ok 2026-10-01 03:08:41.608082 | 2026-10-01 03:08:41.608179 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-10-01 03:08:42.344130 | debian-bookworm | changed 2026-10-01 03:08:42.368863 | 2026-10-01 03:08:42.369052 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-10-01 03:08:43.133886 | debian-bookworm | changed 2026-10-01 03:08:43.138496 | 2026-10-01 03:08:43.138577 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-10-01 03:08:43.171307 | debian-bookworm | skipping: Conditional result was False 2026-10-01 03:08:43.178860 | 2026-10-01 03:08:43.178961 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-10-01 03:08:43.748360 | debian-bookworm -> localhost | changed 2026-10-01 03:08:43.759178 | 2026-10-01 03:08:43.759277 | TASK [add-build-sshkey : Add back temp key] 2026-10-01 03:08:44.095308 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/8fce969ccdbf4e4fa1ef919f2dc5129b/work/8fce969ccdbf4e4fa1ef919f2dc5129b_id_rsa (zuul-build-sshkey) 2026-10-01 03:08:44.095526 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.025853 2026-10-01 03:08:44.102780 | 2026-10-01 03:08:44.102871 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-10-01 03:08:44.605261 | debian-bookworm | ok 2026-10-01 03:08:44.621168 | 2026-10-01 03:08:44.621263 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-10-01 03:08:44.654308 | debian-bookworm | skipping: Conditional result was False 2026-10-01 03:08:44.663111 | 2026-10-01 03:08:44.663193 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-10-01 03:08:45.095930 | debian-bookworm | ok 2026-10-01 03:08:45.104573 | 2026-10-01 03:08:45.104675 | TASK [validate-host : Define zuul_info_dir fact] 2026-10-01 03:08:45.146100 | debian-bookworm | ok 2026-10-01 03:08:45.150096 | 2026-10-01 03:08:45.150168 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-10-01 03:08:45.377832 | debian-bookworm -> localhost | ok 2026-10-01 03:08:45.385314 | 2026-10-01 03:08:45.385422 | TASK [validate-host : Collect information about the host] 2026-10-01 03:08:46.504416 | debian-bookworm | ok 2026-10-01 03:08:46.527794 | 2026-10-01 03:08:46.527902 | TASK [validate-host : Sanitize hostname] 2026-10-01 03:08:46.758845 | debian-bookworm | ok 2026-10-01 03:08:46.764183 | 2026-10-01 03:08:46.764285 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-10-01 03:08:47.327684 | debian-bookworm -> localhost | changed 2026-10-01 03:08:47.333048 | 2026-10-01 03:08:47.333146 | TASK [validate-host : Collect information about zuul worker] 2026-10-01 03:08:47.723400 | debian-bookworm | ok 2026-10-01 03:08:47.728105 | 2026-10-01 03:08:47.728193 | TASK [validate-host : Write out all zuul information for each host] 2026-10-01 03:08:48.154484 | debian-bookworm -> localhost | changed 2026-10-01 03:08:48.163649 | 2026-10-01 03:08:48.163741 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-10-01 03:08:48.456916 | debian-bookworm | ok 2026-10-01 03:08:48.463610 | 2026-10-01 03:08:48.463855 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-10-01 03:08:50.119837 | debian-bookworm | changed: 2026-10-01 03:08:50.120041 | debian-bookworm | cd+++++++++ src/ 2026-10-01 03:08:50.120078 | debian-bookworm | cd+++++++++ src/github.com/ 2026-10-01 03:08:50.120144 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-10-01 03:08:50.120169 | debian-bookworm | cd+++++++++ src/github.com/osism/python-osism/ 2026-10-01 03:08:50.120190 | debian-bookworm | Containerfile 2026-10-01 03:08:50.120401 | debian-bookworm | Containerfile 2026-10-01 03:08:50.138523 | debian-bookworm | localhost | ok: "/var/lib/zuul/builds/8fce969ccdbf4e4fa1ef919f2dc5129b/work/logs" 2026-10-01 03:11:31.407868 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/8fce969ccdbf4e4fa1ef919f2dc5129b/work/artifacts" 2026-10-01 03:11:31.660675 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/8fce969ccdbf4e4fa1ef919f2dc5129b/work/docs" 2026-10-01 03:11:31.682437 | 2026-10-01 03:11:31.682596 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-10-01 03:11:32.490968 | debian-bookworm | changed: 2026-10-01 03:11:32.491221 | debian-bookworm | .d..t...... ./ 2026-10-01 03:11:32.491259 | debian-bookworm | >f+++++++++ net-debug.post.txt 2026-10-01 03:11:32.491284 | debian-bookworm | >f+++++++++ net-debug.pre.txt 2026-10-01 03:11:32.491306 | debian-bookworm | >f+++++++++ sudo-debug.txt 2026-10-01 03:11:32.491327 | debian-bookworm | >f+++++++++ sudo-strace.log 2026-10-01 03:11:32.491347 | debian-bookworm | >f+++++++++ sudo-strace.log.time 2026-10-01 03:11:32.491382 | debian-bookworm | changed: All items complete 2026-10-01 03:11:32.491406 | 2026-10-01 03:11:33.160625 | debian-bookworm | changed: .d..t...... ./ 2026-10-01 03:11:33.771357 | debian-bookworm | changed: .d..t...... ./ 2026-10-01 03:11:33.793897 | 2026-10-01 03:11:33.794023 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-10-01 03:11:33.817498 | debian-bookworm | skipping: Conditional result was False 2026-10-01 03:11:33.821423 | debian-bookworm | skipping: Conditional result was False 2026-10-01 03:11:33.845324 | 2026-10-01 03:11:33.845412 | PLAY RECAP 2026-10-01 03:11:33.845465 | debian-bookworm | ok: 7 changed: 2 unreachable: 0 failed: 0 skipped: 4 rescued: 0 ignored: 0 2026-10-01 03:11:33.845491 | 2026-10-01 03:11:33.984909 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post-fetch.yaml@main] 2026-10-01 03:11:33.986181 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-10-01 03:11:34.814961 | 2026-10-01 03:11:34.815122 | PLAY [Base post] 2026-10-01 03:11:34.830310 | 2026-10-01 03:11:34.830460 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-10-01 03:11:35.674105 | debian-bookworm | changed 2026-10-01 03:11:35.680713 | 2026-10-01 03:11:35.680833 | PLAY RECAP 2026-10-01 03:11:35.680960 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-10-01 03:11:35.681024 | 2026-10-01 03:11:35.808508 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-10-01 03:11:35.809308 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-10-01 03:11:36.549252 | 2026-10-01 03:11:36.549361 | PLAY [Base post-logs] 2026-10-01 03:11:36.557331 | 2026-10-01 03:11:36.557423 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-10-01 03:11:37.007842 | localhost | changed 2026-10-01 03:11:37.016785 | 2026-10-01 03:11:37.016910 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-10-01 03:11:37.041173 | localhost | ok 2026-10-01 03:11:37.049295 | 2026-10-01 03:11:37.049379 | TASK [Set zuul-log-path fact] 2026-10-01 03:11:37.063720 | localhost | ok 2026-10-01 03:11:37.072188 | 2026-10-01 03:11:37.072280 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-10-01 03:11:37.090826 | localhost | ok 2026-10-01 03:11:37.093480 | 2026-10-01 03:11:37.093599 | TASK [upload-logs : Create log directories] 2026-10-01 03:11:37.725535 | localhost | changed 2026-10-01 03:11:37.730668 | 2026-10-01 03:11:37.730891 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-10-01 03:11:38.173115 | localhost -> localhost | ok: Runtime: 0:00:00.003115 2026-10-01 03:11:38.185651 | 2026-10-01 03:11:38.185774 | TASK [upload-logs : Upload logs to log server] 2026-10-01 03:11:38.674684 | localhost | Output suppressed because no_log was given 2026-10-01 03:11:38.676633 | 2026-10-01 03:11:38.676721 | LOOP [upload-logs : Compress console log and json output] 2026-10-01 03:11:38.721260 | localhost | skipping: Conditional result was False 2026-10-01 03:11:38.726962 | localhost | skipping: Conditional result was False 2026-10-01 03:11:38.734247 | 2026-10-01 03:11:38.734333 | LOOP [upload-logs : Upload compressed console log and json output] 2026-10-01 03:11:38.771358 | localhost | skipping: Conditional result was False 2026-10-01 03:11:38.771562 | 2026-10-01 03:11:38.776013 | localhost | skipping: Conditional result was False 2026-10-01 03:11:38.779109 | 2026-10-01 03:11:38.779195 | LOOP [upload-logs : Upload console log and json output]