2025-10-27 03:01:19.772222 | Job console starting 2025-10-27 03:01:19.791073 | Updating git repos 2025-10-27 03:01:19.994790 | Cloning repos into workspace 2025-10-27 03:01:20.092154 | Restoring repo states 2025-10-27 03:01:20.106510 | Merging changes 2025-10-27 03:01:20.106529 | Checking out repos 2025-10-27 03:01:20.229964 | Preparing playbooks 2025-10-27 03:01:22.004136 | Running Ansible setup 2025-10-27 03:01:30.705016 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-10-27 03:01:31.696186 | 2025-10-27 03:01:31.696303 | PLAY [Base pre] 2025-10-27 03:01:31.729424 | 2025-10-27 03:01:31.729542 | TASK [Setup log path fact] 2025-10-27 03:01:31.756613 | debian-bookworm | ok 2025-10-27 03:01:31.798920 | 2025-10-27 03:01:31.799054 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-10-27 03:01:31.848634 | debian-bookworm | ok 2025-10-27 03:01:31.856422 | 2025-10-27 03:01:31.856517 | TASK [emit-job-header : Print job information] 2025-10-27 03:01:31.927969 | # Job Information 2025-10-27 03:01:31.928162 | Ansible Version: 2.16.14 2025-10-27 03:01:31.928192 | Job: python-black 2025-10-27 03:01:31.928220 | Pipeline: periodic-daily 2025-10-27 03:01:31.928243 | Executor: 521e9411259a 2025-10-27 03:01:31.928259 | Triggered by: https://github.com/osism/netbox-manager 2025-10-27 03:01:31.928276 | Event ID: 3383b9391430490ea1fa98e63b6f2c61 2025-10-27 03:01:31.932642 | 2025-10-27 03:01:31.932738 | LOOP [emit-job-header : Print node information] 2025-10-27 03:01:32.153544 | debian-bookworm | ok: 2025-10-27 03:01:32.153848 | debian-bookworm | # Node Information 2025-10-27 03:01:32.153892 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-10-27 03:01:32.153918 | debian-bookworm | Hostname: debian 2025-10-27 03:01:32.153941 | debian-bookworm | Username: zuul 2025-10-27 03:01:32.153962 | debian-bookworm | Distro: Debian 12.12 2025-10-27 03:01:32.153985 | debian-bookworm | Provider: regiocloud-a 2025-10-27 03:01:32.154006 | debian-bookworm | Region: 2025-10-27 03:01:32.154027 | debian-bookworm | Label: debian-bookworm 2025-10-27 03:01:32.154046 | debian-bookworm | Product Name: OpenStack Nova 2025-10-27 03:01:32.154065 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe2f:484e 2025-10-27 03:01:32.166869 | 2025-10-27 03:01:32.166966 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-10-27 03:01:32.963450 | debian-bookworm -> localhost | changed 2025-10-27 03:01:32.969167 | 2025-10-27 03:01:32.969262 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-10-27 03:01:34.680431 | debian-bookworm -> localhost | changed 2025-10-27 03:01:34.689922 | 2025-10-27 03:01:34.690010 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-10-27 03:01:35.561525 | debian-bookworm -> localhost | ok 2025-10-27 03:01:35.566397 | 2025-10-27 03:01:35.566481 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-10-27 03:01:35.592883 | debian-bookworm | ok 2025-10-27 03:01:35.625006 | debian-bookworm | included: /var/lib/zuul/builds/6b932529a3944c1b9035ef925738bd94/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-10-27 03:01:35.629918 | 2025-10-27 03:01:35.629990 | TASK [add-build-sshkey : Create Temp SSH key] 2025-10-27 03:01:39.373433 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-10-27 03:01:39.373629 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/6b932529a3944c1b9035ef925738bd94/work/6b932529a3944c1b9035ef925738bd94_id_rsa 2025-10-27 03:01:39.373664 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/6b932529a3944c1b9035ef925738bd94/work/6b932529a3944c1b9035ef925738bd94_id_rsa.pub 2025-10-27 03:01:39.373686 | debian-bookworm -> localhost | The key fingerprint is: 2025-10-27 03:01:39.373706 | debian-bookworm -> localhost | SHA256:CDdsTaaRAr0wOtR67U/vj0g5P8G32dpfrECZGKvGHeU zuul-build-sshkey 2025-10-27 03:01:39.373725 | debian-bookworm -> localhost | The key's randomart image is: 2025-10-27 03:01:39.373748 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-10-27 03:01:39.373766 | debian-bookworm -> localhost | | oo ..o | 2025-10-27 03:01:39.373785 | debian-bookworm -> localhost | | .o.o..* | 2025-10-27 03:01:39.373802 | debian-bookworm -> localhost | |...ooo* . . . | 2025-10-27 03:01:39.373818 | debian-bookworm -> localhost | |o. ..= o * o | 2025-10-27 03:01:39.373834 | debian-bookworm -> localhost | | .. . . S + E | 2025-10-27 03:01:39.373856 | debian-bookworm -> localhost | | . o.= + . | 2025-10-27 03:01:39.373874 | debian-bookworm -> localhost | | o+= + = o| 2025-10-27 03:01:39.373891 | debian-bookworm -> localhost | | .o+o.o.o ..| 2025-10-27 03:01:39.373908 | debian-bookworm -> localhost | | ..+oo..o. | 2025-10-27 03:01:39.373924 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-10-27 03:01:39.373966 | debian-bookworm -> localhost | ok: Runtime: 0:00:02.552937 2025-10-27 03:01:39.379122 | 2025-10-27 03:01:39.379194 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-10-27 03:01:39.418200 | debian-bookworm | ok 2025-10-27 03:01:39.450443 | debian-bookworm | included: /var/lib/zuul/builds/6b932529a3944c1b9035ef925738bd94/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-10-27 03:01:39.486038 | 2025-10-27 03:01:39.486136 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-10-27 03:01:39.534033 | debian-bookworm | skipping: Conditional result was False 2025-10-27 03:01:39.538766 | 2025-10-27 03:01:39.538856 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-10-27 03:01:40.491944 | debian-bookworm | changed 2025-10-27 03:01:40.496759 | 2025-10-27 03:01:40.496834 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-10-27 03:01:40.742814 | debian-bookworm | ok 2025-10-27 03:01:40.748472 | 2025-10-27 03:01:40.748574 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-10-27 03:01:41.393109 | debian-bookworm | changed 2025-10-27 03:01:41.398511 | 2025-10-27 03:01:41.398592 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-10-27 03:01:42.195325 | debian-bookworm | changed 2025-10-27 03:01:42.199813 | 2025-10-27 03:01:42.199890 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-10-27 03:01:42.243110 | debian-bookworm | skipping: Conditional result was False 2025-10-27 03:01:42.248340 | 2025-10-27 03:01:42.248426 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-10-27 03:01:43.838362 | debian-bookworm -> localhost | changed 2025-10-27 03:01:43.847339 | 2025-10-27 03:01:43.847429 | TASK [add-build-sshkey : Add back temp key] 2025-10-27 03:01:44.573634 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/6b932529a3944c1b9035ef925738bd94/work/6b932529a3944c1b9035ef925738bd94_id_rsa (zuul-build-sshkey) 2025-10-27 03:01:44.573818 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.019080 2025-10-27 03:01:44.580263 | 2025-10-27 03:01:44.580352 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-10-27 03:01:45.348387 | debian-bookworm | ok 2025-10-27 03:01:45.352556 | 2025-10-27 03:01:45.352635 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-10-27 03:01:45.435713 | debian-bookworm | skipping: Conditional result was False 2025-10-27 03:01:45.444305 | 2025-10-27 03:01:45.444390 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-10-27 03:01:46.151189 | debian-bookworm | ok 2025-10-27 03:01:46.164907 | 2025-10-27 03:01:46.164994 | TASK [validate-host : Define zuul_info_dir fact] 2025-10-27 03:01:46.339640 | debian-bookworm | ok 2025-10-27 03:01:46.362098 | 2025-10-27 03:01:46.362193 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-10-27 03:01:47.563895 | debian-bookworm -> localhost | ok 2025-10-27 03:01:47.569225 | 2025-10-27 03:01:47.569306 | TASK [validate-host : Collect information about the host] 2025-10-27 03:01:49.435189 | debian-bookworm | ok 2025-10-27 03:01:49.469999 | 2025-10-27 03:01:49.470099 | TASK [validate-host : Sanitize hostname] 2025-10-27 03:01:49.726850 | debian-bookworm | ok 2025-10-27 03:01:49.819222 | 2025-10-27 03:01:49.819343 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-10-27 03:01:51.586621 | debian-bookworm -> localhost | changed 2025-10-27 03:01:51.591404 | 2025-10-27 03:01:51.591516 | TASK [validate-host : Collect information about zuul worker] 2025-10-27 03:01:52.397299 | debian-bookworm | ok 2025-10-27 03:01:52.401356 | 2025-10-27 03:01:52.401438 | TASK [validate-host : Write out all zuul information for each host] 2025-10-27 03:01:54.089188 | debian-bookworm -> localhost | changed 2025-10-27 03:01:54.096665 | 2025-10-27 03:01:54.096743 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-10-27 03:01:54.358790 | debian-bookworm | ok 2025-10-27 03:01:54.363202 | 2025-10-27 03:01:54.363282 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-10-27 03:01:56.069644 | debian-bookworm | changed: 2025-10-27 03:01:56.069796 | debian-bookworm | cd+++++++++ src/ 2025-10-27 03:01:56.069823 | debian-bookworm | cd+++++++++ src/github.com/ 2025-10-27 03:01:56.069843 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-10-27 03:01:56.069861 | debian-bookworm | cd+++++++++ src/github.com/osism/netbox-manager/ 2025-10-27 03:01:56.069878 | debian-bookworm | netbox_manager/requirements.yml 2025-10-27 03:01:56.070074 | debian-bookworm | cL+++++++++ src/github.com/osism/netbox-manager/settings.toml.sample -> netbox_manager/settings.toml.sample 2025-10-27 03:01:56.070089 | debian-bookworm | cd+++++++++ src/github.com/osism/netbox-manager/.git/ 2025-10-27 03:01:56.070104 | debian-bookworm | localhost | ok: Runtime: 0:00:00.009508 2025-10-27 03:02:27.944817 | 2025-10-27 03:02:27.944953 | TASK [upload-logs : Upload logs to log server] 2025-10-27 03:02:29.143303 | localhost | Output suppressed because no_log was given 2025-10-27 03:02:29.144694 | 2025-10-27 03:02:29.144767 | LOOP [upload-logs : Compress console log and json output] 2025-10-27 03:02:29.240797 | localhost | skipping: Conditional result was False 2025-10-27 03:02:29.245479 | localhost | skipping: Conditional result was False 2025-10-27 03:02:29.250429 | 2025-10-27 03:02:29.250533 | LOOP [upload-logs : Upload compressed console log and json output] 2025-10-27 03:02:29.442985 | localhost | skipping: Conditional result was False 2025-10-27 03:02:29.443203 | 2025-10-27 03:02:29.454439 | localhost | skipping: Conditional result was False 2025-10-27 03:02:29.463013 | 2025-10-27 03:02:29.463118 | LOOP [upload-logs : Upload console log and json output]