2026-07-26 00:59:44.030416 | Job console starting 2026-07-26 00:59:44.053795 | Updating git repos 2026-07-26 00:59:44.089289 | Cloning repos into workspace 2026-07-26 00:59:44.158466 | Restoring repo states 2026-07-26 00:59:44.168464 | Merging changes 2026-07-26 00:59:44.675982 | Checking out repos 2026-07-26 00:59:44.739109 | Preparing playbooks 2026-07-26 00:59:46.331284 | Running Ansible setup 2026-07-26 00:59:51.492508 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-07-26 00:59:52.116600 | 2026-07-26 00:59:52.116749 | PLAY [localhost] 2026-07-26 00:59:52.124595 | 2026-07-26 00:59:52.124692 | TASK [Gathering Facts] 2026-07-26 00:59:52.982887 | localhost | ok 2026-07-26 00:59:52.993953 | 2026-07-26 00:59:52.994381 | TASK [Setup log path fact] 2026-07-26 00:59:53.013427 | localhost | ok 2026-07-26 00:59:53.026639 | 2026-07-26 00:59:53.026759 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-07-26 00:59:53.055471 | localhost | ok 2026-07-26 00:59:53.064077 | 2026-07-26 00:59:53.064186 | TASK [emit-job-header : Print job information] 2026-07-26 00:59:53.106372 | # Job Information 2026-07-26 00:59:53.106598 | Ansible Version: 2.16.18 2026-07-26 00:59:53.106668 | Job: ansible-collection-containers-molecule-containerd-debian-trixie 2026-07-26 00:59:53.106719 | Pipeline: check 2026-07-26 00:59:53.106764 | Executor: 2d72f0692154 2026-07-26 00:59:53.106808 | Triggered by: https://github.com/vexxhost/ansible-collection-containers/pull/143 2026-07-26 00:59:53.106858 | Event ID: 8666f790-888c-11f1-818d-f8ec3d49f744 2026-07-26 00:59:53.111204 | 2026-07-26 00:59:53.111268 | LOOP [emit-job-header : Print node information] 2026-07-26 00:59:53.198781 | localhost | ok: 2026-07-26 00:59:53.199052 | localhost | # Node Information 2026-07-26 00:59:53.199095 | localhost | Inventory Hostname: debian-trixie 2026-07-26 00:59:53.199126 | localhost | Hostname: np0000186927 2026-07-26 00:59:53.199154 | localhost | Username: zuul 2026-07-26 00:59:53.199188 | localhost | Distro: Debian 13.6 2026-07-26 00:59:53.199217 | localhost | Provider: yul1 2026-07-26 00:59:53.199245 | localhost | Region: ca-ymq-1 2026-07-26 00:59:53.199271 | localhost | Label: debian-trixie 2026-07-26 00:59:53.199298 | localhost | Product Name: OpenStack Nova 2026-07-26 00:59:53.199324 | localhost | Interface IP: 199.204.45.144 2026-07-26 00:59:53.216069 | 2026-07-26 00:59:53.216155 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-07-26 00:59:53.600180 | localhost -> localhost | changed 2026-07-26 00:59:53.606810 | 2026-07-26 00:59:53.606955 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-07-26 00:59:54.596109 | localhost -> localhost | changed 2026-07-26 00:59:54.602916 | 2026-07-26 00:59:54.602969 | PLAY [all] 2026-07-26 00:59:54.609897 | 2026-07-26 00:59:54.609961 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-07-26 00:59:54.870344 | debian-trixie -> localhost | ok 2026-07-26 00:59:54.875080 | 2026-07-26 00:59:54.875158 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-07-26 00:59:54.895473 | debian-trixie | ok 2026-07-26 00:59:54.909564 | debian-trixie | included: /var/lib/zuul/builds/92eaf86348fc4d8c8b8e0a2452a12b77/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-07-26 00:59:54.914337 | 2026-07-26 00:59:54.914410 | TASK [add-build-sshkey : Create Temp SSH key] 2026-07-26 00:59:55.676809 | debian-trixie -> localhost | Generating public/private rsa key pair. 2026-07-26 00:59:55.677031 | debian-trixie -> localhost | Your identification has been saved in /var/lib/zuul/builds/92eaf86348fc4d8c8b8e0a2452a12b77/work/92eaf86348fc4d8c8b8e0a2452a12b77_id_rsa 2026-07-26 00:59:55.677078 | debian-trixie -> localhost | Your public key has been saved in /var/lib/zuul/builds/92eaf86348fc4d8c8b8e0a2452a12b77/work/92eaf86348fc4d8c8b8e0a2452a12b77_id_rsa.pub 2026-07-26 00:59:55.677113 | debian-trixie -> localhost | The key fingerprint is: 2026-07-26 00:59:55.677145 | debian-trixie -> localhost | SHA256:Qg4To9KJ8BWzCtb8RKdTzv+1sr3bxhrb5yrqABALLH8 zuul-build-sshkey 2026-07-26 00:59:55.677192 | debian-trixie -> localhost | The key's randomart image is: 2026-07-26 00:59:55.677224 | debian-trixie -> localhost | +---[RSA 3072]----+ 2026-07-26 00:59:55.677261 | debian-trixie -> localhost | |... Bo o | 2026-07-26 00:59:55.677293 | debian-trixie -> localhost | |o++=.B* | 2026-07-26 00:59:55.677324 | debian-trixie -> localhost | |++=o*+.o | 2026-07-26 00:59:55.677354 | debian-trixie -> localhost | |.o..E*. . | 2026-07-26 00:59:55.677384 | debian-trixie -> localhost | | .. .+ S. . | 2026-07-26 00:59:55.677414 | debian-trixie -> localhost | | o . . . | 2026-07-26 00:59:55.677442 | debian-trixie -> localhost | | . o o. | 2026-07-26 00:59:55.677471 | debian-trixie -> localhost | | . = =o.| 2026-07-26 00:59:55.677504 | debian-trixie -> localhost | | .oo B*=o| 2026-07-26 00:59:55.677534 | debian-trixie -> localhost | +----[SHA256]-----+ 2026-07-26 00:59:55.677601 | debian-trixie -> localhost | ok: Runtime: 0:00:00.350582 2026-07-26 00:59:55.682795 | 2026-07-26 00:59:55.682855 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-07-26 00:59:55.705223 | debian-trixie | ok 2026-07-26 00:59:55.712967 | debian-trixie | included: /var/lib/zuul/builds/92eaf86348fc4d8c8b8e0a2452a12b77/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-07-26 00:59:55.719912 | 2026-07-26 00:59:55.719979 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-07-26 00:59:55.744845 | debian-trixie | skipping: Conditional result was False 2026-07-26 00:59:55.753796 | 2026-07-26 00:59:55.753928 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-07-26 00:59:56.318426 | debian-trixie | changed 2026-07-26 00:59:56.322570 | 2026-07-26 00:59:56.322632 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-07-26 00:59:56.545721 | debian-trixie | ok 2026-07-26 00:59:56.550849 | 2026-07-26 00:59:56.550919 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-07-26 00:59:57.118370 | debian-trixie | changed 2026-07-26 00:59:57.122438 | 2026-07-26 00:59:57.122502 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-07-26 00:59:57.668218 | debian-trixie | changed 2026-07-26 00:59:57.680145 | 2026-07-26 00:59:57.680251 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-07-26 00:59:57.708752 | debian-trixie | skipping: Conditional result was False 2026-07-26 00:59:57.728406 | 2026-07-26 00:59:57.728611 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-07-26 00:59:58.200402 | debian-trixie -> localhost | changed 2026-07-26 00:59:58.211945 | 2026-07-26 00:59:58.212084 | TASK [add-build-sshkey : Add back temp key] 2026-07-26 00:59:58.516308 | debian-trixie -> localhost | Identity added: /var/lib/zuul/builds/92eaf86348fc4d8c8b8e0a2452a12b77/work/92eaf86348fc4d8c8b8e0a2452a12b77_id_rsa (zuul-build-sshkey) 2026-07-26 00:59:58.516494 | debian-trixie -> localhost | ok: Runtime: 0:00:00.011007 2026-07-26 00:59:58.521770 | 2026-07-26 00:59:58.521834 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-07-26 00:59:58.848677 | debian-trixie | ok 2026-07-26 00:59:58.852424 | 2026-07-26 00:59:58.852487 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-07-26 00:59:58.876613 | debian-trixie | skipping: Conditional result was False 2026-07-26 00:59:58.883917 | 2026-07-26 00:59:58.883986 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-07-26 00:59:59.259572 | debian-trixie | ok 2026-07-26 00:59:59.266417 | 2026-07-26 00:59:59.266481 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-07-26 01:00:00.192868 | debian-trixie | Output suppressed because no_log was given 2026-07-26 01:00:00.203615 | 2026-07-26 01:00:00.203735 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-07-26 01:00:00.433829 | debian-trixie | ok: "logs" 2026-07-26 01:00:00.434116 | debian-trixie | ok: All items complete 2026-07-26 01:00:00.434331 | 2026-07-26 01:00:00.610500 | debian-trixie | ok: "artifacts" 2026-07-26 01:00:00.802485 | debian-trixie | ok: "docs" 2026-07-26 01:00:00.815343 | 2026-07-26 01:00:00.815500 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-07-26 01:00:01.023560 | debian-trixie | changed: "logs" 2026-07-26 01:00:01.201673 | debian-trixie | changed: "artifacts" 2026-07-26 01:00:01.383010 | debian-trixie | changed: "docs" 2026-07-26 01:00:01.413802 | 2026-07-26 01:00:01.413925 | PLAY RECAP 2026-07-26 01:00:01.413993 | debian-trixie | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-07-26 01:00:01.414037 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-07-26 01:00:01.414070 | 2026-07-26 01:00:01.579627 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-07-26 01:00:01.581097 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-07-26 01:00:02.207115 | 2026-07-26 01:00:02.207575 | PLAY [all] 2026-07-26 01:00:02.220634 | 2026-07-26 01:00:02.220783 | TASK [setup-uv : Extract archive] 2026-07-26 01:00:04.657510 | debian-trixie | changed 2026-07-26 01:00:04.774568 | 2026-07-26 01:00:04.774678 | TASK [setup-uv : Print version] 2026-07-26 01:00:05.177874 | debian-trixie | uv 0.8.13 2026-07-26 01:00:05.303195 | debian-trixie | ok: Runtime: 0:00:00.015079 2026-07-26 01:00:05.321367 | 2026-07-26 01:00:05.321978 | TASK [Install Ansible collection siblings] 2026-07-26 01:00:05.720827 | debian-trixie | ok: 2026-07-26 01:00:05.721064 | debian-trixie | Skipping ansible.posix: no checked-out sibling 2026-07-26 01:00:05.721108 | debian-trixie | Skipping community.general: no checked-out sibling 2026-07-26 01:00:05.733204 | 2026-07-26 01:00:05.733295 | PLAY RECAP 2026-07-26 01:00:05.733367 | debian-trixie | ok: 3 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-07-26 01:00:05.733403 | 2026-07-26 01:00:05.877662 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-07-26 01:00:05.878938 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-07-26 01:00:06.458595 | 2026-07-26 01:00:06.458719 | PLAY [all] 2026-07-26 01:00:06.468960 | 2026-07-26 01:00:06.469053 | LOOP [Check inventory directories] 2026-07-26 01:00:06.770304 | debian-trixie | ok: "src/github.com/vexxhost/ansible-collection-containers" 2026-07-26 01:00:06.946688 | debian-trixie | ok: "src/github.com/vexxhost/ansible-collection-containers/molecule/containerd/inventory" 2026-07-26 01:00:07.134987 | debian-trixie | ok: "src/github.com/vexxhost/ansible-collection-containers/extensions/molecule/containerd/inventory" 2026-07-26 01:00:07.145626 | 2026-07-26 01:00:07.145804 | LOOP [Copy inventory file for Zuul] 2026-07-26 01:00:08.012156 | debian-trixie | changed: 2026-07-26 01:00:08.012451 | debian-trixie | { 2026-07-26 01:00:08.012505 | debian-trixie | "ansible_loop_var": "item", 2026-07-26 01:00:08.012564 | debian-trixie | "changed": false, 2026-07-26 01:00:08.012617 | debian-trixie | "failed": false, 2026-07-26 01:00:08.012663 | debian-trixie | "invocation": { 2026-07-26 01:00:08.012697 | debian-trixie | "module_args": { 2026-07-26 01:00:08.012723 | debian-trixie | "checksum_algorithm": "sha1", 2026-07-26 01:00:08.012753 | debian-trixie | "follow": true, 2026-07-26 01:00:08.012808 | debian-trixie | "get_attributes": true, 2026-07-26 01:00:08.012842 | debian-trixie | "get_checksum": true, 2026-07-26 01:00:08.012872 | debian-trixie | "get_mime": true, 2026-07-26 01:00:08.012902 | debian-trixie | "path": "src/github.com/vexxhost/ansible-collection-containers" 2026-07-26 01:00:08.012932 | debian-trixie | } 2026-07-26 01:00:08.012963 | debian-trixie | }, 2026-07-26 01:00:08.013020 | debian-trixie | "item": "src/github.com/vexxhost/ansible-collection-containers", 2026-07-26 01:00:08.013129 | debian-trixie | "stat": { 2026-07-26 01:00:08.013167 | debian-trixie | "atime": 1785027600.0437655, 2026-07-26 01:00:08.013193 | debian-trixie | "attr_flags": "e", 2026-07-26 01:00:08.013217 | debian-trixie | "attributes": [ 2026-07-26 01:00:08.013241 | debian-trixie | "extents" 2026-07-26 01:00:08.013264 | debian-trixie | ], 2026-07-26 01:00:08.013287 | debian-trixie | "block_size": 4096, 2026-07-26 01:00:08.013310 | debian-trixie | "blocks": 8, 2026-07-26 01:00:08.013334 | debian-trixie | "charset": "unknown", 2026-07-26 01:00:08.013359 | debian-trixie | "ctime": 1785027600.0677686, 2026-07-26 01:00:08.013383 | debian-trixie | "dev": 65025, 2026-07-26 01:00:08.013406 | debian-trixie | "device_type": 0, 2026-07-26 01:00:08.013429 | debian-trixie | "executable": true, 2026-07-26 01:00:08.013452 | debian-trixie | "exists": true, 2026-07-26 01:00:08.013475 | debian-trixie | "gid": 1000, 2026-07-26 01:00:08.013498 | debian-trixie | "gr_name": "zuul", 2026-07-26 01:00:08.013520 | debian-trixie | "inode": 518935, 2026-07-26 01:00:08.013543 | debian-trixie | "isblk": false, 2026-07-26 01:00:08.013567 | debian-trixie | "ischr": false, 2026-07-26 01:00:08.013590 | debian-trixie | "isdir": true, 2026-07-26 01:00:08.013614 | debian-trixie | "isfifo": false, 2026-07-26 01:00:08.013648 | debian-trixie | "isgid": false, 2026-07-26 01:00:08.013681 | debian-trixie | "islnk": false, 2026-07-26 01:00:08.013706 | debian-trixie | "isreg": false, 2026-07-26 01:00:08.013730 | debian-trixie | "issock": false, 2026-07-26 01:00:08.013753 | debian-trixie | "isuid": false, 2026-07-26 01:00:08.013776 | debian-trixie | "mimetype": "unknown", 2026-07-26 01:00:08.013799 | debian-trixie | "mode": "0755", 2026-07-26 01:00:08.013821 | debian-trixie | "mtime": 1785027584.3534386, 2026-07-26 01:00:08.013844 | debian-trixie | "nlink": 11, 2026-07-26 01:00:08.013867 | debian-trixie | "path": "src/github.com/vexxhost/ansible-collection-containers", 2026-07-26 01:00:08.013890 | debian-trixie | "pw_name": "zuul", 2026-07-26 01:00:08.013914 | debian-trixie | "readable": true, 2026-07-26 01:00:08.013938 | debian-trixie | "rgrp": true, 2026-07-26 01:00:08.013961 | debian-trixie | "roth": true, 2026-07-26 01:00:08.013984 | debian-trixie | "rusr": true, 2026-07-26 01:00:08.014008 | debian-trixie | "size": 4096, 2026-07-26 01:00:08.014031 | debian-trixie | "uid": 1000, 2026-07-26 01:00:08.014054 | debian-trixie | "version": "1118901961", 2026-07-26 01:00:08.014078 | debian-trixie | "wgrp": false, 2026-07-26 01:00:08.014103 | debian-trixie | "woth": false, 2026-07-26 01:00:08.014127 | debian-trixie | "writeable": true, 2026-07-26 01:00:08.014150 | debian-trixie | "wusr": true, 2026-07-26 01:00:08.014174 | debian-trixie | "xgrp": true, 2026-07-26 01:00:08.014197 | debian-trixie | "xoth": true, 2026-07-26 01:00:08.014219 | debian-trixie | "xusr": true 2026-07-26 01:00:08.014241 | debian-trixie | } 2026-07-26 01:00:08.014264 | debian-trixie | } 2026-07-26 01:00:08.014315 | debian-trixie | ok: All items complete 2026-07-26 01:00:08.014346 | 2026-07-26 01:00:08.016140 | debian-trixie | skipping: Conditional result was False 2026-07-26 01:00:08.017119 | debian-trixie | skipping: Conditional result was False 2026-07-26 01:00:08.036594 | 2026-07-26 01:00:08.036823 | LOOP [Switch "ansible_host" to private IP] 2026-07-26 01:00:08.425225 | debian-trixie | changed: 1 replacements made 2026-07-26 01:00:08.427125 | debian-trixie | skipping: Conditional result was False 2026-07-26 01:00:08.428314 | debian-trixie | skipping: Conditional result was False 2026-07-26 01:00:08.445900 | 2026-07-26 01:00:08.446115 | TASK [Run Molecule scenario] 2026-07-26 01:00:08.945214 | debian-trixie | Using CPython 3.13.5 interpreter at: /usr/bin/python3 2026-07-26 01:00:08.945336 | debian-trixie | Creating virtual environment at: .venv 2026-07-26 01:00:09.307948 | debian-trixie | Downloading cryptography (4.3MiB) 2026-07-26 01:00:09.308167 | debian-trixie | Downloading pygments (1.2MiB) 2026-07-26 01:00:09.310095 | debian-trixie | Downloading ansible-core (2.3MiB) 2026-07-26 01:00:09.463804 | debian-trixie | Downloading cryptography 2026-07-26 01:00:09.516239 | debian-trixie | Downloading pygments 2026-07-26 01:00:09.660268 | debian-trixie | Downloading ansible-core 2026-07-26 01:00:09.707981 | debian-trixie | Installed 36 packages in 47ms 2026-07-26 01:00:10.374698 | debian-trixie | INFO Collection 'vexxhost.containers' detected. 2026-07-26 01:00:10.374767 | debian-trixie | INFO Scenarios will be used from 'extensions/molecule' 2026-07-26 01:00:11.202093 | debian-trixie | CRITICAL 'extensions/molecule/default/molecule.yml' glob failed. Exiting. 2026-07-26 01:00:11.202163 | debian-trixie | INFO default scenario not found, disabling shared state. 2026-07-26 01:00:11.202184 | debian-trixie | INFO [containerd > discovery] scenario test matrix: dependency, cleanup, destroy, syntax, create, prepare, converge, idempotence, side_effect, verify, cleanup, destroy 2026-07-26 01:00:11.202193 | debian-trixie | INFO [containerd > prerun] Performing prerun with role_name_check=0... 2026-07-26 01:01:28.930743 | debian-trixie | WARNING Retrying execution failure 1 of: ansible-galaxy collection install -vvv community.general:>=4.5.0 2026-07-26 01:01:28.930841 | debian-trixie | ERROR Command ansible-galaxy collection install -vvv community.general:>=4.5.0, returned 1 code: 2026-07-26 01:01:28.930888 | debian-trixie | Starting galaxy collection install process 2026-07-26 01:01:28.930897 | debian-trixie | Process install dependency map 2026-07-26 01:01:28.930906 | debian-trixie | Starting collection install process 2026-07-26 01:01:28.930927 | debian-trixie | Downloading https://galaxy.ansible.com/api/v3/plugin/ansible/content/published/collections/artifacts/community-general-13.2.0.tar.gz to /home/zuul/.ansible/tmp/ansible-local-1323vjr__vai/tmpl2qixgpo/community-general-13.2.0-zutpczn1 2026-07-26 01:01:28.930936 | debian-trixie | Installing 'community.general:13.2.0' to '/home/zuul/.ansible/collections/ansible_collections/community/general' 2026-07-26 01:01:28.930943 | debian-trixie | community.general:13.2.0 was installed successfully 2026-07-26 01:01:28.930955 | debian-trixie | Downloading https://galaxy.ansible.com/api/v3/plugin/ansible/content/published/collections/artifacts/community-library_inventory_filtering_v1-1.1.5.tar.gz to /home/zuul/.ansible/tmp/ansible-local-1323vjr__vai/tmpl2qixgpo/community-library_inventory_filtering_v1-1.1.5-sb7i1ono 2026-07-26 01:01:28.930968 | debian-trixie | 2026-07-26 01:01:28.930976 | debian-trixie | ansible-galaxy 2026-07-26 01:01:28.930988 | debian-trixie | config file = None 2026-07-26 01:01:28.930996 | debian-trixie | configured module search path = 2026-07-26 01:01:28.931004 | debian-trixie | ansible python module location = /home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/ansible 2026-07-26 01:01:28.931014 | debian-trixie | ansible collection location = /home/zuul/.ansible/collections:/usr/share/ansible/collections:/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/dist-packages:/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3/dist-packages:/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/local/lib/python3.13/dist-packages:/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages 2026-07-26 01:01:28.931029 | debian-trixie | executable location = /home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/bin/ansible-galaxy 2026-07-26 01:01:28.931037 | debian-trixie | python version = 3.13.5 (main, Jul 15 2026, 20:25:40) (/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/bin/python) 2026-07-26 01:01:28.931044 | debian-trixie | jinja version = 3.1.6 2026-07-26 01:01:28.931051 | debian-trixie | pyyaml version = 6.0.2 (with libyaml v0.2.5) 2026-07-26 01:01:28.931058 | debian-trixie | No config file found; using defaults 2026-07-26 01:01:28.931066 | debian-trixie | Found installed collection ansible.posix:2.2.2 at '/home/zuul/.ansible/collections/ansible_collections/ansible/posix' 2026-07-26 01:01:28.931074 | debian-trixie | Found installed collection ansible._protomatter:2.19.1 at '/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/ansible/_internal/ansible_collections/ansible/_protomatter' 2026-07-26 01:01:28.931107 | debian-trixie | Opened /home/zuul/.ansible/galaxy_token 2026-07-26 01:01:28.931115 | debian-trixie | Collection 'community.general:13.2.0' obtained from server default https://galaxy.ansible.com/api/ 2026-07-26 01:01:28.931122 | debian-trixie | : Failed to download collection tar from 'default': HTTP Error 502: Bad Gateway 2026-07-26 01:01:28.931129 | debian-trixie | 2026-07-26 01:01:28.933384 | debian-trixie | Traceback (most recent call last): 2026-07-26 01:01:28.936784 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/bin/molecule", line 10, in 2026-07-26 01:01:28.936793 | debian-trixie | sys.exit(main()) 2026-07-26 01:01:28.936798 | debian-trixie | ~~~~^^ 2026-07-26 01:01:28.937129 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/click/core.py", line 1442, in __call__ 2026-07-26 01:01:28.937136 | debian-trixie | return self.main(*args, **kwargs) 2026-07-26 01:01:28.937140 | debian-trixie | ~~~~~~~~~^^^^^^^^^^^^^^^^^ 2026-07-26 01:01:28.937417 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/click/core.py", line 1363, in main 2026-07-26 01:01:28.937425 | debian-trixie | rv = self.invoke(ctx) 2026-07-26 01:01:28.937762 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/click/core.py", line 1830, in invoke 2026-07-26 01:01:28.937768 | debian-trixie | return _process_result(sub_ctx.command.invoke(sub_ctx)) 2026-07-26 01:01:28.937773 | debian-trixie | ~~~~~~~~~~~~~~~~~~~~~~^^^^^^^^^ 2026-07-26 01:01:28.938075 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/click/core.py", line 1226, in invoke 2026-07-26 01:01:28.938080 | debian-trixie | return ctx.invoke(self.callback, **ctx.params) 2026-07-26 01:01:28.938085 | debian-trixie | ~~~~~~~~~~^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ 2026-07-26 01:01:28.938348 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/click/core.py", line 794, in invoke 2026-07-26 01:01:28.938354 | debian-trixie | return callback(*args, **kwargs) 2026-07-26 01:01:28.938613 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/molecule/click_cfg.py", line 583, in wrapper 2026-07-26 01:01:28.938618 | debian-trixie | return func(*args, **kwargs) 2026-07-26 01:01:28.938882 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/click/decorators.py", line 34, in new_func 2026-07-26 01:01:28.938888 | debian-trixie | return f(get_current_context(), *args, **kwargs) 2026-07-26 01:01:28.939144 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/molecule/click_cfg.py", line 418, in wrapper 2026-07-26 01:01:28.939149 | debian-trixie | return func(ctx) 2026-07-26 01:01:28.939460 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/molecule/command/test.py", line 81, in test 2026-07-26 01:01:28.939466 | debian-trixie | base.execute_cmdline_scenarios(scenario_name, args, command_args, ansible_args, exclude) 2026-07-26 01:01:28.939471 | debian-trixie | ~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ 2026-07-26 01:01:28.939806 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/molecule/command/base.py", line 169, in execute_cmdline_scenarios 2026-07-26 01:01:28.939813 | debian-trixie | _run_scenarios(scenarios, command_args, default_config) 2026-07-26 01:01:28.939818 | debian-trixie | ~~~~~~~~~~~~~~^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ 2026-07-26 01:01:28.940346 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/molecule/command/base.py", line 240, in _run_scenarios 2026-07-26 01:01:28.940360 | debian-trixie | scenario.config.runtime.prepare_environment( 2026-07-26 01:01:28.940368 | debian-trixie | ~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~^ 2026-07-26 01:01:28.940387 | debian-trixie | install_local=True, 2026-07-26 01:01:28.940394 | debian-trixie | ^^^^^^^^^^^^^^^^^^^ 2026-07-26 01:01:28.940401 | debian-trixie | role_name_check=role_name_check, 2026-07-26 01:01:28.940408 | debian-trixie | ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ 2026-07-26 01:01:28.940415 | debian-trixie | ) 2026-07-26 01:01:28.940423 | debian-trixie | ^ 2026-07-26 01:01:28.940845 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/ansible_compat/runtime.py", line 752, in prepare_environment 2026-07-26 01:01:28.940862 | debian-trixie | self.install_collection( 2026-07-26 01:01:28.940870 | debian-trixie | ~~~~~~~~~~~~~~~~~~~~~~~^ 2026-07-26 01:01:28.940877 | debian-trixie | f"{name}{',' if is_url(name) else ':'}{required_version}", 2026-07-26 01:01:28.940884 | debian-trixie | ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ 2026-07-26 01:01:28.940891 | debian-trixie | destination=destination, 2026-07-26 01:01:28.940898 | debian-trixie | ^^^^^^^^^^^^^^^^^^^^^^^^ 2026-07-26 01:01:28.940905 | debian-trixie | ) 2026-07-26 01:01:28.940912 | debian-trixie | ^ 2026-07-26 01:01:28.941129 | debian-trixie | File "/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/ansible_compat/runtime.py", line 609, in install_collection 2026-07-26 01:01:28.941138 | debian-trixie | raise InvalidPrerequisiteError(msg) 2026-07-26 01:01:28.941757 | debian-trixie | ansible_compat.errors.InvalidPrerequisiteError: Command ansible-galaxy collection install -vvv community.general:>=4.5.0, returned 1 code: 2026-07-26 01:01:28.941769 | debian-trixie | Starting galaxy collection install process 2026-07-26 01:01:28.941776 | debian-trixie | Process install dependency map 2026-07-26 01:01:28.941783 | debian-trixie | Starting collection install process 2026-07-26 01:01:28.941791 | debian-trixie | Downloading https://galaxy.ansible.com/api/v3/plugin/ansible/content/published/collections/artifacts/community-general-13.2.0.tar.gz to /home/zuul/.ansible/tmp/ansible-local-1323vjr__vai/tmpl2qixgpo/community-general-13.2.0-zutpczn1 2026-07-26 01:01:28.941798 | debian-trixie | Installing 'community.general:13.2.0' to '/home/zuul/.ansible/collections/ansible_collections/community/general' 2026-07-26 01:01:28.941805 | debian-trixie | community.general:13.2.0 was installed successfully 2026-07-26 01:01:28.941813 | debian-trixie | Downloading https://galaxy.ansible.com/api/v3/plugin/ansible/content/published/collections/artifacts/community-library_inventory_filtering_v1-1.1.5.tar.gz to /home/zuul/.ansible/tmp/ansible-local-1323vjr__vai/tmpl2qixgpo/community-library_inventory_filtering_v1-1.1.5-sb7i1ono 2026-07-26 01:01:28.941821 | debian-trixie | 2026-07-26 01:01:28.941828 | debian-trixie | ansible-galaxy [core 2.19.1] 2026-07-26 01:01:28.941835 | debian-trixie | config file = None 2026-07-26 01:01:28.941842 | debian-trixie | configured module search path = ['/home/zuul/.ansible/plugins/modules', '/usr/share/ansible/plugins/modules'] 2026-07-26 01:01:28.941849 | debian-trixie | ansible python module location = /home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/ansible 2026-07-26 01:01:28.941856 | debian-trixie | ansible collection location = /home/zuul/.ansible/collections:/usr/share/ansible/collections:/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/dist-packages:/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3/dist-packages:/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/local/lib/python3.13/dist-packages:/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages 2026-07-26 01:01:28.941864 | debian-trixie | executable location = /home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/bin/ansible-galaxy 2026-07-26 01:01:28.941871 | debian-trixie | python version = 3.13.5 (main, Jul 15 2026, 20:25:40) [GCC 14.2.0] (/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/bin/python) 2026-07-26 01:01:28.941878 | debian-trixie | jinja version = 3.1.6 2026-07-26 01:01:28.941885 | debian-trixie | pyyaml version = 6.0.2 (with libyaml v0.2.5) 2026-07-26 01:01:28.941892 | debian-trixie | No config file found; using defaults 2026-07-26 01:01:28.941899 | debian-trixie | Found installed collection ansible.posix:2.2.2 at '/home/zuul/.ansible/collections/ansible_collections/ansible/posix' 2026-07-26 01:01:28.941914 | debian-trixie | Found installed collection ansible._protomatter:2.19.1 at '/home/zuul/src/github.com/vexxhost/ansible-collection-containers/.venv/lib/python3.13/site-packages/ansible/_internal/ansible_collections/ansible/_protomatter' 2026-07-26 01:01:28.941921 | debian-trixie | Opened /home/zuul/.ansible/galaxy_token 2026-07-26 01:01:28.941928 | debian-trixie | Collection 'community.general:13.2.0' obtained from server default https://galaxy.ansible.com/api/ 2026-07-26 01:01:28.941936 | debian-trixie | [ERROR]: Failed to download collection tar from 'default': HTTP Error 502: Bad Gateway 2026-07-26 01:01:28.941943 | debian-trixie | 2026-07-26 01:01:29.205848 | debian-trixie | ERROR 2026-07-26 01:01:29.206616 | debian-trixie | { 2026-07-26 01:01:29.206662 | debian-trixie | "delta": "0:01:20.145749", 2026-07-26 01:01:29.206693 | debian-trixie | "end": "2026-07-26 01:01:29.017092", 2026-07-26 01:01:29.206721 | debian-trixie | "msg": "non-zero return code", 2026-07-26 01:01:29.206748 | debian-trixie | "rc": 1, 2026-07-26 01:01:29.206775 | debian-trixie | "start": "2026-07-26 01:00:08.871343" 2026-07-26 01:01:29.206800 | debian-trixie | } failure 2026-07-26 01:01:29.210617 | 2026-07-26 01:01:29.210681 | PLAY RECAP 2026-07-26 01:01:29.210738 | debian-trixie | ok: 3 changed: 2 unreachable: 0 failed: 1 skipped: 0 rescued: 0 ignored: 0 2026-07-26 01:01:29.210769 | 2026-07-26 01:01:29.330706 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-07-26 01:01:29.333237 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-07-26 01:01:30.001335 | 2026-07-26 01:01:30.001485 | PLAY [all] 2026-07-26 01:01:30.012848 | 2026-07-26 01:01:30.013088 | TASK [fetch-output : Set log path for multiple nodes] 2026-07-26 01:01:30.059766 | debian-trixie | skipping: Conditional result was False 2026-07-26 01:01:30.068405 | 2026-07-26 01:01:30.068537 | TASK [fetch-output : Set log path for single node] 2026-07-26 01:01:30.110274 | debian-trixie | ok 2026-07-26 01:01:30.115601 | 2026-07-26 01:01:30.115696 | LOOP [fetch-output : Ensure local output dirs] 2026-07-26 01:01:30.524040 | debian-trixie -> localhost | ok: "/var/lib/zuul/builds/92eaf86348fc4d8c8b8e0a2452a12b77/work/logs" 2026-07-26 01:01:30.736577 | debian-trixie -> localhost | changed: "/var/lib/zuul/builds/92eaf86348fc4d8c8b8e0a2452a12b77/work/artifacts" 2026-07-26 01:01:30.939740 | debian-trixie -> localhost | changed: "/var/lib/zuul/builds/92eaf86348fc4d8c8b8e0a2452a12b77/work/docs" 2026-07-26 01:01:30.954108 | 2026-07-26 01:01:30.954289 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-07-26 01:01:31.590880 | debian-trixie | changed: .d..t...... ./ 2026-07-26 01:01:31.591120 | debian-trixie | changed: All items complete 2026-07-26 01:01:31.591166 | 2026-07-26 01:01:32.037618 | debian-trixie | changed: .d..t...... ./ 2026-07-26 01:01:32.485927 | debian-trixie | changed: .d..t...... ./ 2026-07-26 01:01:32.507491 | 2026-07-26 01:01:32.507632 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-07-26 01:01:32.918043 | debian-trixie -> localhost | ok: Item: artifacts Runtime: 0:00:00.008258 2026-07-26 01:01:33.175440 | debian-trixie -> localhost | ok: Item: docs Runtime: 0:00:00.010416 2026-07-26 01:01:33.196669 | 2026-07-26 01:01:33.196797 | PLAY [all] 2026-07-26 01:01:33.202258 | 2026-07-26 01:01:33.202326 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-07-26 01:01:33.702469 | debian-trixie | changed 2026-07-26 01:01:33.708198 | 2026-07-26 01:01:33.708249 | PLAY RECAP 2026-07-26 01:01:33.708295 | debian-trixie | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-07-26 01:01:33.708316 | 2026-07-26 01:01:33.841737 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-07-26 01:01:33.844047 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main] 2026-07-26 01:01:34.422502 | 2026-07-26 01:01:34.422621 | PLAY [localhost] 2026-07-26 01:01:34.433237 | 2026-07-26 01:01:34.433326 | TASK [Generate Zuul manifest] 2026-07-26 01:01:34.455400 | localhost | ok 2026-07-26 01:01:34.471469 | 2026-07-26 01:01:34.471568 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-07-26 01:01:34.836046 | localhost | changed 2026-07-26 01:01:34.845924 | 2026-07-26 01:01:34.846004 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-07-26 01:01:34.880037 | localhost | ok 2026-07-26 01:01:34.888699 | 2026-07-26 01:01:34.888762 | TASK [Upload logs] 2026-07-26 01:01:34.909763 | localhost | ok 2026-07-26 01:01:34.966570 | 2026-07-26 01:01:34.966700 | TASK [Set zuul-log-path fact] 2026-07-26 01:01:34.987884 | localhost | ok 2026-07-26 01:01:35.000938 | 2026-07-26 01:01:35.001028 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-07-26 01:01:35.034273 | localhost | ok 2026-07-26 01:01:35.043375 | 2026-07-26 01:01:35.043481 | TASK [upload-logs : Create log directories] 2026-07-26 01:01:35.463302 | localhost | changed 2026-07-26 01:01:35.470905 | 2026-07-26 01:01:35.470986 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-07-26 01:01:35.892404 | localhost -> localhost | ok: Runtime: 0:00:00.006675 2026-07-26 01:01:35.905344 | 2026-07-26 01:01:35.905499 | TASK [upload-logs : Upload logs to log server] 2026-07-26 01:01:36.363989 | localhost | Output suppressed because no_log was given 2026-07-26 01:01:36.370908 | 2026-07-26 01:01:36.370979 | LOOP [upload-logs : Compress console log and json output] 2026-07-26 01:01:36.421930 | localhost | skipping: Conditional result was False 2026-07-26 01:01:36.424302 | localhost | skipping: Conditional result was False 2026-07-26 01:01:36.436000 | 2026-07-26 01:01:36.436164 | LOOP [upload-logs : Upload compressed console log and json output] 2026-07-26 01:01:36.478202 | localhost | skipping: Conditional result was False 2026-07-26 01:01:36.478618 | 2026-07-26 01:01:36.482147 | localhost | skipping: Conditional result was False 2026-07-26 01:01:36.491787 | 2026-07-26 01:01:36.491974 | LOOP [upload-logs : Upload console log and json output]