2025-04-26 03:17:24.381693 | Job console starting... 2025-04-26 03:17:24.392410 | Updating repositories 2025-04-26 03:17:24.437155 | Preparing job workspace 2025-04-26 03:17:25.352303 | Running Ansible setup... 2025-04-26 03:17:31.260262 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-04-26 03:17:31.946400 | 2025-04-26 03:17:31.946537 | PLAY [Base pre] 2025-04-26 03:17:31.974670 | 2025-04-26 03:17:31.974818 | TASK [Setup log path fact] 2025-04-26 03:17:31.997501 | ubuntu-noble | ok 2025-04-26 03:17:32.020252 | 2025-04-26 03:17:32.020378 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-04-26 03:17:32.058062 | ubuntu-noble | ok 2025-04-26 03:17:32.077489 | 2025-04-26 03:17:32.077620 | TASK [emit-job-header : Print job information] 2025-04-26 03:17:32.164854 | # Job Information 2025-04-26 03:17:32.165004 | Ansible Version: 2.15.3 2025-04-26 03:17:32.165037 | Job: python-black 2025-04-26 03:17:32.165067 | Pipeline: periodic-daily 2025-04-26 03:17:32.165087 | Executor: 7d211f194f6a 2025-04-26 03:17:32.165106 | Triggered by: https://github.com/osism/node-image 2025-04-26 03:17:32.165125 | Event ID: f8544260538c469583d9839fa4e24c00 2025-04-26 03:17:32.176993 | 2025-04-26 03:17:32.177262 | LOOP [emit-job-header : Print node information] 2025-04-26 03:17:32.588287 | ubuntu-noble | ok: 2025-04-26 03:17:32.588696 | ubuntu-noble | # Node Information 2025-04-26 03:17:32.588755 | ubuntu-noble | Inventory Hostname: ubuntu-noble 2025-04-26 03:17:32.588782 | ubuntu-noble | Hostname: ubuntu 2025-04-26 03:17:32.588805 | ubuntu-noble | Username: zuul 2025-04-26 03:17:32.588826 | ubuntu-noble | Distro: Ubuntu 24.04 2025-04-26 03:17:32.588850 | ubuntu-noble | Provider: regiocloud-a 2025-04-26 03:17:32.588871 | ubuntu-noble | Label: ubuntu-noble 2025-04-26 03:17:32.588892 | ubuntu-noble | Product Name: OpenStack Nova 2025-04-26 03:17:32.588912 | ubuntu-noble | Interface IP: 81.163.192.166 2025-04-26 03:17:32.618807 | 2025-04-26 03:17:32.618923 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-04-26 03:17:34.258909 | ubuntu-noble -> localhost | changed 2025-04-26 03:17:34.267454 | 2025-04-26 03:17:34.267538 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-04-26 03:17:36.799143 | ubuntu-noble -> localhost | changed 2025-04-26 03:17:36.821671 | 2025-04-26 03:17:36.821783 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-04-26 03:17:37.730749 | ubuntu-noble -> localhost | ok 2025-04-26 03:17:37.738882 | 2025-04-26 03:17:37.738983 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-04-26 03:17:37.812505 | ubuntu-noble | ok 2025-04-26 03:17:37.845446 | ubuntu-noble | included: /var/lib/zuul/builds/1061a6cd096e4f6395e32bd075bfbc93/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-04-26 03:17:37.877539 | 2025-04-26 03:17:37.877644 | TASK [add-build-sshkey : Create Temp SSH key] 2025-04-26 03:17:39.395800 | ubuntu-noble -> localhost | Generating public/private rsa key pair. 2025-04-26 03:17:39.396368 | ubuntu-noble -> localhost | Your identification has been saved in /var/lib/zuul/builds/1061a6cd096e4f6395e32bd075bfbc93/work/1061a6cd096e4f6395e32bd075bfbc93_id_rsa 2025-04-26 03:17:39.396485 | ubuntu-noble -> localhost | Your public key has been saved in /var/lib/zuul/builds/1061a6cd096e4f6395e32bd075bfbc93/work/1061a6cd096e4f6395e32bd075bfbc93_id_rsa.pub 2025-04-26 03:17:39.396513 | ubuntu-noble -> localhost | The key fingerprint is: 2025-04-26 03:17:39.396534 | ubuntu-noble -> localhost | SHA256:dqVXgSXqHDAif6ffYJGozE73WLQCDRiHPF8fGWmLySg zuul-build-sshkey 2025-04-26 03:17:39.396553 | ubuntu-noble -> localhost | The key's randomart image is: 2025-04-26 03:17:39.396570 | ubuntu-noble -> localhost | +---[RSA 3072]----+ 2025-04-26 03:17:39.396587 | ubuntu-noble -> localhost | | .o++ o .+.oo | 2025-04-26 03:17:39.396603 | ubuntu-noble -> localhost | | =+ +.+=o.. . | 2025-04-26 03:17:39.396619 | ubuntu-noble -> localhost | | oo++=Bo. . | 2025-04-26 03:17:39.396643 | ubuntu-noble -> localhost | | Eoo++*o* . | 2025-04-26 03:17:39.396659 | ubuntu-noble -> localhost | | .= S X . | 2025-04-26 03:17:39.396675 | ubuntu-noble -> localhost | | o o O + | 2025-04-26 03:17:39.396694 | ubuntu-noble -> localhost | | . . o . | 2025-04-26 03:17:39.396711 | ubuntu-noble -> localhost | | | 2025-04-26 03:17:39.396727 | ubuntu-noble -> localhost | | | 2025-04-26 03:17:39.396755 | ubuntu-noble -> localhost | +----[SHA256]-----+ 2025-04-26 03:17:39.396801 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.556670 2025-04-26 03:17:39.423837 | 2025-04-26 03:17:39.424301 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-04-26 03:17:39.482303 | ubuntu-noble | ok 2025-04-26 03:17:39.518595 | ubuntu-noble | included: /var/lib/zuul/builds/1061a6cd096e4f6395e32bd075bfbc93/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-04-26 03:17:39.556565 | 2025-04-26 03:17:39.556661 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-04-26 03:17:39.667549 | ubuntu-noble | skipping: Conditional result was False 2025-04-26 03:17:39.673518 | 2025-04-26 03:17:39.673600 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-04-26 03:17:41.125346 | ubuntu-noble | changed 2025-04-26 03:17:41.131049 | 2025-04-26 03:17:41.131126 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-04-26 03:17:41.443675 | ubuntu-noble | ok 2025-04-26 03:17:41.449429 | 2025-04-26 03:17:41.449516 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-04-26 03:17:42.316330 | ubuntu-noble | changed 2025-04-26 03:17:42.325452 | 2025-04-26 03:17:42.325538 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-04-26 03:17:43.187669 | ubuntu-noble | changed 2025-04-26 03:17:43.200124 | 2025-04-26 03:17:43.200219 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-04-26 03:17:43.268683 | ubuntu-noble | skipping: Conditional result was False 2025-04-26 03:17:43.275171 | 2025-04-26 03:17:43.275254 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-04-26 03:17:44.354607 | ubuntu-noble -> localhost | changed 2025-04-26 03:17:44.367696 | 2025-04-26 03:17:44.367797 | TASK [add-build-sshkey : Add back temp key] 2025-04-26 03:17:45.324558 | ubuntu-noble -> localhost | Identity added: /var/lib/zuul/builds/1061a6cd096e4f6395e32bd075bfbc93/work/1061a6cd096e4f6395e32bd075bfbc93_id_rsa (zuul-build-sshkey) 2025-04-26 03:17:45.325256 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.030841 2025-04-26 03:17:45.334630 | 2025-04-26 03:17:45.334707 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-04-26 03:17:45.935987 | ubuntu-noble | ok 2025-04-26 03:17:45.943408 | 2025-04-26 03:17:45.943489 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-04-26 03:17:45.992270 | ubuntu-noble | skipping: Conditional result was False 2025-04-26 03:17:46.021644 | 2025-04-26 03:17:46.021746 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-04-26 03:17:46.621932 | ubuntu-noble | ok 2025-04-26 03:17:46.649735 | 2025-04-26 03:17:46.649848 | TASK [validate-host : Define zuul_info_dir fact] 2025-04-26 03:17:46.710785 | ubuntu-noble | ok 2025-04-26 03:17:46.717223 | 2025-04-26 03:17:46.717311 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-04-26 03:17:47.193070 | ubuntu-noble -> localhost | ok 2025-04-26 03:17:47.202296 | 2025-04-26 03:17:47.202499 | TASK [validate-host : Collect information about the host] 2025-04-26 03:17:48.768459 | ubuntu-noble | ok 2025-04-26 03:17:48.824246 | 2025-04-26 03:17:48.824362 | TASK [validate-host : Sanitize hostname] 2025-04-26 03:17:49.058388 | ubuntu-noble | ok 2025-04-26 03:17:49.080656 | 2025-04-26 03:17:49.080776 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-04-26 03:17:50.820576 | ubuntu-noble -> localhost | changed 2025-04-26 03:17:50.826453 | 2025-04-26 03:17:50.826546 | TASK [validate-host : Collect information about zuul worker] 2025-04-26 03:17:51.431819 | ubuntu-noble | ok 2025-04-26 03:17:51.436998 | 2025-04-26 03:17:51.437081 | TASK [validate-host : Write out all zuul information for each host] 2025-04-26 03:17:52.445059 | ubuntu-noble -> localhost | changed 2025-04-26 03:17:52.461793 | 2025-04-26 03:17:52.461893 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-04-26 03:17:52.824015 | ubuntu-noble | ok 2025-04-26 03:17:52.842354 | 2025-04-26 03:17:52.842765 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-04-26 03:17:54.709435 | ubuntu-noble | changed: 2025-04-26 03:17:54.709570 | ubuntu-noble | cd+++++++++ src/ 2025-04-26 03:17:54.709600 | ubuntu-noble | cd+++++++++ src/github.com/ 2025-04-26 03:17:54.709621 | ubuntu-noble | cd+++++++++ src/github.com/osism/ 2025-04-26 03:17:54.709640 | ubuntu-noble | cd+++++++++ src/github.com/osism/node-image/ 2025-04-26 03:17:54.709657 | ubuntu-noble | Containerfile 2025-04-26 03:17:54.709792 | ubuntu-noble | localhost | ok: Runtime: 0:00:00.006066 2025-04-26 03:18:29.866364 | 2025-04-26 03:18:29.866548 | TASK [upload-logs : Upload logs to log server] 2025-04-26 03:18:30.480018 | localhost | Output suppressed because no_log was given 2025-04-26 03:18:30.484283 | 2025-04-26 03:18:30.484419 | LOOP [upload-logs : Compress console log and json output] 2025-04-26 03:18:30.549627 | localhost | skipping: Conditional result was False 2025-04-26 03:18:30.568952 | localhost | skipping: Conditional result was False 2025-04-26 03:18:30.575324 | 2025-04-26 03:18:30.575552 | LOOP [upload-logs : Upload compressed console log and json output] 2025-04-26 03:18:30.655075 | localhost | skipping: Conditional result was False 2025-04-26 03:18:30.655397 | 2025-04-26 03:18:30.671279 | localhost | skipping: Conditional result was False 2025-04-26 03:18:30.676817 | 2025-04-26 03:18:30.676938 | LOOP [upload-logs : Upload console log and json output]