2026-07-25 14:08:37.768983 | Job console starting 2026-07-25 14:08:37.781126 | Updating git repos 2026-07-25 14:08:38.171633 | Cloning repos into workspace 2026-07-25 14:08:54.008872 | Restoring repo states 2026-07-25 14:09:00.305486 | Merging changes 2026-07-25 14:09:01.728332 | Checking out repos 2026-07-25 14:09:03.077386 | Preparing playbooks 2026-07-25 14:09:06.790166 | Running Ansible setup 2026-07-25 14:09:10.998874 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-07-25 14:09:11.642221 | 2026-07-25 14:09:11.805272 | PLAY [localhost] 2026-07-25 14:09:11.818555 | 2026-07-25 14:09:11.818662 | TASK [Gathering Facts] 2026-07-25 14:09:12.939532 | localhost | ok 2026-07-25 14:09:12.951861 | 2026-07-25 14:09:12.951958 | TASK [Setup log path fact] 2026-07-25 14:09:12.973862 | localhost | ok 2026-07-25 14:09:12.987981 | 2026-07-25 14:09:12.988053 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-07-25 14:09:13.018171 | localhost | ok 2026-07-25 14:09:13.029380 | 2026-07-25 14:09:13.029443 | TASK [emit-job-header : Print job information] 2026-07-25 14:09:13.069944 | # Job Information 2026-07-25 14:09:13.070146 | Ansible Version: 2.16.18 2026-07-25 14:09:13.070215 | Job: atmosphere-molecule-aio-ovn-selective 2026-07-25 14:09:13.070263 | Pipeline: check 2026-07-25 14:09:13.070307 | Executor: 2d72f0692154 2026-07-25 14:09:13.070349 | Triggered by: https://github.com/vexxhost/atmosphere/pull/4163 2026-07-25 14:09:13.070402 | Event ID: f22df830-8831-11f1-9fec-f543b67f43d2 2026-07-25 14:09:13.074287 | 2026-07-25 14:09:13.074370 | LOOP [emit-job-header : Print node information] 2026-07-25 14:09:13.164354 | localhost | ok: 2026-07-25 14:09:13.164589 | localhost | # Node Information 2026-07-25 14:09:13.164652 | localhost | Inventory Hostname: instance 2026-07-25 14:09:13.164700 | localhost | Hostname: np0000186833 2026-07-25 14:09:13.164745 | localhost | Username: zuul 2026-07-25 14:09:13.164796 | localhost | Distro: Ubuntu 22.04 2026-07-25 14:09:13.164841 | localhost | Provider: yul1 2026-07-25 14:09:13.164884 | localhost | Region: ca-ymq-1 2026-07-25 14:09:13.164927 | localhost | Label: ubuntu-jammy-16 2026-07-25 14:09:13.165008 | localhost | Product Name: OpenStack Nova 2026-07-25 14:09:13.165055 | localhost | Interface IP: 199.204.45.205 2026-07-25 14:09:13.182100 | 2026-07-25 14:09:13.182244 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-07-25 14:09:13.683765 | localhost -> localhost | changed 2026-07-25 14:09:13.691636 | 2026-07-25 14:09:13.691727 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-07-25 14:09:14.747947 | localhost -> localhost | changed 2026-07-25 14:09:14.756019 | 2026-07-25 14:09:14.756106 | PLAY [all] 2026-07-25 14:09:14.765422 | 2026-07-25 14:09:14.765502 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-07-25 14:09:15.013031 | instance -> localhost | ok 2026-07-25 14:09:15.023480 | 2026-07-25 14:09:15.023589 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-07-25 14:09:15.058321 | instance | ok 2026-07-25 14:09:15.075066 | instance | included: /var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-07-25 14:09:15.080739 | 2026-07-25 14:09:15.080799 | TASK [add-build-sshkey : Create Temp SSH key] 2026-07-25 14:09:16.245343 | instance -> localhost | Generating public/private rsa key pair. 2026-07-25 14:09:16.245535 | instance -> localhost | Your identification has been saved in /var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/work/5e6d06540e784d5da3ef68be796ca5dc_id_rsa 2026-07-25 14:09:16.245577 | instance -> localhost | Your public key has been saved in /var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/work/5e6d06540e784d5da3ef68be796ca5dc_id_rsa.pub 2026-07-25 14:09:16.245610 | instance -> localhost | The key fingerprint is: 2026-07-25 14:09:16.245641 | instance -> localhost | SHA256:dHDHBKi3VbTtNjVq84c2HCkqivy2IFTkzu56brIBXk0 zuul-build-sshkey 2026-07-25 14:09:16.245683 | instance -> localhost | The key's randomart image is: 2026-07-25 14:09:16.245714 | instance -> localhost | +---[RSA 3072]----+ 2026-07-25 14:09:16.245747 | instance -> localhost | | . ..o=+ | 2026-07-25 14:09:16.245778 | instance -> localhost | | o .o .oo | 2026-07-25 14:09:16.245807 | instance -> localhost | | oE .. ... ...| 2026-07-25 14:09:16.245835 | instance -> localhost | | +o ..... ..o.| 2026-07-25 14:09:16.245864 | instance -> localhost | |. ..o. .So .+* | 2026-07-25 14:09:16.245891 | instance -> localhost | |.o.. . ..+o+ | 2026-07-25 14:09:16.245919 | instance -> localhost | | .o o . . =..| 2026-07-25 14:09:16.245946 | instance -> localhost | | .=oo.. . . ..| 2026-07-25 14:09:16.245977 | instance -> localhost | | oB=o+. | 2026-07-25 14:09:16.246006 | instance -> localhost | +----[SHA256]-----+ 2026-07-25 14:09:16.246070 | instance -> localhost | ok: Runtime: 0:00:00.760691 2026-07-25 14:09:16.254036 | 2026-07-25 14:09:16.254099 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-07-25 14:09:16.285143 | instance | ok 2026-07-25 14:09:16.296538 | instance | included: /var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-07-25 14:09:16.303823 | 2026-07-25 14:09:16.303882 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-07-25 14:09:16.327751 | instance | skipping: Conditional result was False 2026-07-25 14:09:16.337830 | 2026-07-25 14:09:16.337890 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-07-25 14:09:16.740058 | instance | changed 2026-07-25 14:09:16.745853 | 2026-07-25 14:09:16.745912 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-07-25 14:09:16.950280 | instance | ok 2026-07-25 14:09:16.955425 | 2026-07-25 14:09:16.955487 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-07-25 14:09:17.388933 | instance | changed 2026-07-25 14:09:17.393852 | 2026-07-25 14:09:17.393910 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-07-25 14:09:17.835902 | instance | changed 2026-07-25 14:09:17.843189 | 2026-07-25 14:09:17.843245 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-07-25 14:09:17.866972 | instance | skipping: Conditional result was False 2026-07-25 14:09:17.879577 | 2026-07-25 14:09:17.879711 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-07-25 14:09:18.176793 | instance -> localhost | changed 2026-07-25 14:09:18.186799 | 2026-07-25 14:09:18.186863 | TASK [add-build-sshkey : Add back temp key] 2026-07-25 14:09:18.452262 | instance -> localhost | Identity added: /var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/work/5e6d06540e784d5da3ef68be796ca5dc_id_rsa (zuul-build-sshkey) 2026-07-25 14:09:18.452408 | instance -> localhost | ok: Runtime: 0:00:00.015044 2026-07-25 14:09:18.457088 | 2026-07-25 14:09:18.457146 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-07-25 14:09:18.712477 | instance | ok 2026-07-25 14:09:18.718844 | 2026-07-25 14:09:18.718909 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-07-25 14:09:18.742922 | instance | skipping: Conditional result was False 2026-07-25 14:09:18.757061 | 2026-07-25 14:09:18.757122 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-07-25 14:09:19.018147 | instance | ok 2026-07-25 14:09:19.023647 | 2026-07-25 14:09:19.023706 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-07-25 14:09:22.159166 | instance | Output suppressed because no_log was given 2026-07-25 14:09:22.168467 | 2026-07-25 14:09:22.168534 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-07-25 14:09:22.369487 | instance | ok: "logs" 2026-07-25 14:09:22.369966 | instance | ok: All items complete 2026-07-25 14:09:22.370037 | 2026-07-25 14:09:22.507060 | instance | ok: "artifacts" 2026-07-25 14:09:22.662371 | instance | ok: "docs" 2026-07-25 14:09:22.671529 | 2026-07-25 14:09:22.671686 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-07-25 14:09:22.869323 | instance | changed: "logs" 2026-07-25 14:09:23.011557 | instance | changed: "artifacts" 2026-07-25 14:09:23.174749 | instance | changed: "docs" 2026-07-25 14:09:23.189609 | 2026-07-25 14:09:23.189737 | PLAY RECAP 2026-07-25 14:09:23.189801 | instance | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-07-25 14:09:23.189843 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-07-25 14:09:23.189875 | 2026-07-25 14:09:23.324457 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-07-25 14:09:23.332209 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-07-25 14:09:23.925402 | 2026-07-25 14:09:23.925530 | PLAY [all] 2026-07-25 14:09:23.936373 | 2026-07-25 14:09:23.936446 | TASK [setup-uv : Extract archive] 2026-07-25 14:09:26.304822 | instance | changed 2026-07-25 14:09:26.348780 | 2026-07-25 14:09:26.349027 | TASK [setup-uv : Print version] 2026-07-25 14:09:26.748455 | instance | uv 0.8.13 2026-07-25 14:09:26.892873 | instance | ok: Runtime: 0:00:00.010901 2026-07-25 14:09:26.909781 | 2026-07-25 14:09:26.909883 | TASK [Install Ansible collection siblings] 2026-07-25 14:09:36.025276 | instance | changed: 2026-07-25 14:09:36.025431 | instance | Sibling collection ansible.netcommon at /home/zuul/src/github.com/ansible-collections/ansible.netcommon 2026-07-25 14:09:36.025460 | instance | Sibling collection ansible.posix at /home/zuul/src/github.com/ansible-collections/ansible.posix 2026-07-25 14:09:36.025482 | instance | Sibling collection ansible.utils at /home/zuul/src/github.com/ansible-collections/ansible.utils 2026-07-25 14:09:36.025502 | instance | Sibling collection community.crypto at /home/zuul/src/github.com/ansible-collections/community.crypto 2026-07-25 14:09:36.025522 | instance | Sibling collection community.general at /home/zuul/src/github.com/ansible-collections/community.general 2026-07-25 14:09:36.025545 | instance | Sibling collection community.mysql at /home/zuul/src/github.com/ansible-collections/community.mysql 2026-07-25 14:09:36.025566 | instance | Sibling collection kubernetes.core at /home/zuul/src/github.com/ansible-collections/kubernetes.core 2026-07-25 14:09:36.025588 | instance | Sibling collection vexxhost.ceph at /home/zuul/src/github.com/vexxhost/ansible-collection-ceph 2026-07-25 14:09:36.025607 | instance | Sibling collection vexxhost.containers at /home/zuul/src/github.com/vexxhost/ansible-collection-containers 2026-07-25 14:09:36.025626 | instance | Sibling collection vexxhost.kubernetes at /home/zuul/src/github.com/vexxhost/ansible-collection-kubernetes 2026-07-25 14:09:36.025645 | instance | Sibling collection atmosphere.common at /home/zuul/src/github.com/vexxhost/atmosphere.common 2026-07-25 14:09:36.025664 | instance | Sibling collection openstack.cloud at /home/zuul/src/opendev.org/openstack/ansible-collections-openstack 2026-07-25 14:09:36.025682 | instance | Resolved ansible.netcommon to 1.2.0 for 1.2.0 2026-07-25 14:09:36.025701 | instance | Resolved ansible.posix to 1.6.0 for 1.6.0 2026-07-25 14:09:36.025719 | instance | Resolved ansible.utils to v6.0.3 for >=2.9.0 2026-07-25 14:09:36.025738 | instance | Resolved community.crypto to 2.2.3 for 2.2.3 2026-07-25 14:09:36.025757 | instance | Resolved community.general to 7.3.0 for 7.3.0 2026-07-25 14:09:36.025775 | instance | Resolved community.mysql to 3.6.0 for 3.6.0 2026-07-25 14:09:36.025794 | instance | Resolved kubernetes.core to 2.4.0 for 2.4.0 2026-07-25 14:09:36.025812 | instance | Resolved openstack.cloud to 2.6.0 for >=2.0.0 2026-07-25 14:09:36.025830 | instance | Resolved vexxhost.ceph to v4.1.0 for >=3.2.0 2026-07-25 14:09:36.025848 | instance | Resolved atmosphere.common to v0.7.0 for >=0.7.0 2026-07-25 14:09:36.025916 | instance | Resolved vexxhost.kubernetes to v3.3.0 for >=3.3.0,>=2.5.0 2026-07-25 14:09:36.025952 | instance | Resolved community.general to 7.3.0 for 7.3.0,>=4.5.0 2026-07-25 14:09:36.025974 | instance | Resolved ansible.utils to v6.0.3 for >=2.9.0,>=6.0.0 2026-07-25 14:09:36.025993 | instance | Resolved vexxhost.containers to v1.6.8 for >=1.1.1,>=1.6.0 2026-07-25 14:09:36.026012 | instance | Resolved kubernetes.core to 2.4.0 for 2.4.0,>=2.4.0,>=2.3.2 2026-07-25 14:09:36.026030 | instance | Resolved vexxhost.kubernetes to v3.3.0 for >=3.3.0,>=2.5.0 2026-07-25 14:09:36.026048 | instance | Resolved ansible.posix to 1.6.0 for 1.6.0,>=1.6.0 2026-07-25 14:09:36.026066 | instance | Resolved community.crypto to 2.2.3 for 2.2.3,>=2.2.3 2026-07-25 14:09:36.026085 | instance | Resolved kubernetes.core to 2.4.0 for 2.4.0,>=2.4.0,>=2.3.2 2026-07-25 14:09:36.026104 | instance | Resolved vexxhost.containers to v1.6.8 for >=1.1.1,>=1.6.0 2026-07-25 14:09:36.026122 | instance | Checked out ansible.netcommon to 1.2.0 2026-07-25 14:09:36.026141 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/ansible-collections/ansible.netcommon 2026-07-25 14:09:36.026165 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.026184 | instance | Process install dependency map 2026-07-25 14:09:36.026203 | instance | Starting collection install process 2026-07-25 14:09:36.026223 | instance | Installing 'ansible.netcommon:*' to '/home/zuul/.ansible/collections/ansible_collections/ansible/netcommon' 2026-07-25 14:09:36.026241 | instance | Created collection for ansible.netcommon:* at /home/zuul/.ansible/collections/ansible_collections/ansible/netcommon 2026-07-25 14:09:36.026259 | instance | ansible.netcommon:* was installed successfully 2026-07-25 14:09:36.026278 | instance | Using CPython 3.10.12 interpreter at: /usr/bin/python3 2026-07-25 14:09:36.026295 | instance | Creating virtual environment at: .venv 2026-07-25 14:09:36.026313 | instance | Building atmosphere @ file:///home/zuul/src/github.com/vexxhost/atmosphere 2026-07-25 14:09:36.026331 | instance | Downloading pydantic-core (2.0MiB) 2026-07-25 14:09:36.026348 | instance | Downloading setuptools (1.1MiB) 2026-07-25 14:09:36.026367 | instance | Downloading netaddr (2.2MiB) 2026-07-25 14:09:36.026385 | instance | Downloading pygments (1.2MiB) 2026-07-25 14:09:36.026403 | instance | Downloading rjsonnet (1.2MiB) 2026-07-25 14:09:36.026422 | instance | Downloading openstacksdk (1.7MiB) 2026-07-25 14:09:36.026440 | instance | Downloading ansible-core (2.1MiB) 2026-07-25 14:09:36.026459 | instance | Downloading cryptography (4.2MiB) 2026-07-25 14:09:36.026477 | instance | Downloading kubernetes (1.9MiB) 2026-07-25 14:09:36.026495 | instance | Building pyperclip==1.9.0 2026-07-25 14:09:36.026515 | instance | Downloading rjsonnet 2026-07-25 14:09:36.026535 | instance | Downloading pydantic-core 2026-07-25 14:09:36.026553 | instance | Downloading netaddr 2026-07-25 14:09:36.026572 | instance | Downloading pygments 2026-07-25 14:09:36.026590 | instance | Downloading cryptography 2026-07-25 14:09:36.026608 | instance | Downloading setuptools 2026-07-25 14:09:36.026625 | instance | Downloading kubernetes 2026-07-25 14:09:36.026644 | instance | Downloading ansible-core 2026-07-25 14:09:36.026662 | instance | Downloading openstacksdk 2026-07-25 14:09:36.026680 | instance | Built pyperclip==1.9.0 2026-07-25 14:09:36.026699 | instance | Built atmosphere @ file:///home/zuul/src/github.com/vexxhost/atmosphere 2026-07-25 14:09:36.026719 | instance | Installed 83 packages in 38ms 2026-07-25 14:09:36.026737 | instance | Checked out ansible.posix to 1.6.0 2026-07-25 14:09:36.026765 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/ansible-collections/ansible.posix 2026-07-25 14:09:36.026812 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.026856 | instance | Process install dependency map 2026-07-25 14:09:36.026910 | instance | Starting collection install process 2026-07-25 14:09:36.026957 | instance | Installing 'ansible.posix:1.6.0' to '/home/zuul/.ansible/collections/ansible_collections/ansible/posix' 2026-07-25 14:09:36.027001 | instance | Created collection for ansible.posix:1.6.0 at /home/zuul/.ansible/collections/ansible_collections/ansible/posix 2026-07-25 14:09:36.027043 | instance | ansible.posix:1.6.0 was installed successfully 2026-07-25 14:09:36.027088 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.027132 | instance | 2.17.12 2026-07-25 14:09:36.027184 | instance | Checked out ansible.utils to v6.0.3 2026-07-25 14:09:36.027250 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/ansible-collections/ansible.utils 2026-07-25 14:09:36.027307 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.027353 | instance | Process install dependency map 2026-07-25 14:09:36.027396 | instance | Starting collection install process 2026-07-25 14:09:36.027440 | instance | Installing 'ansible.utils:6.0.3' to '/home/zuul/.ansible/collections/ansible_collections/ansible/utils' 2026-07-25 14:09:36.027485 | instance | Created collection for ansible.utils:6.0.3 at /home/zuul/.ansible/collections/ansible_collections/ansible/utils 2026-07-25 14:09:36.027529 | instance | ansible.utils:6.0.3 was installed successfully 2026-07-25 14:09:36.027575 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.027618 | instance | 2.17.12 2026-07-25 14:09:36.027661 | instance | Checked out atmosphere.common to v0.7.0 2026-07-25 14:09:36.027704 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/vexxhost/atmosphere.common 2026-07-25 14:09:36.027748 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.027790 | instance | Process install dependency map 2026-07-25 14:09:36.027832 | instance | Starting collection install process 2026-07-25 14:09:36.027875 | instance | Installing 'atmosphere.common:0.7.0' to '/home/zuul/.ansible/collections/ansible_collections/atmosphere/common' 2026-07-25 14:09:36.027917 | instance | Created collection for atmosphere.common:0.7.0 at /home/zuul/.ansible/collections/ansible_collections/atmosphere/common 2026-07-25 14:09:36.027963 | instance | atmosphere.common:0.7.0 was installed successfully 2026-07-25 14:09:36.028005 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.028047 | instance | 2.17.12 2026-07-25 14:09:36.028091 | instance | Checked out community.crypto to 2.2.3 2026-07-25 14:09:36.028135 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/ansible-collections/community.crypto 2026-07-25 14:09:36.028178 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.028220 | instance | Process install dependency map 2026-07-25 14:09:36.028262 | instance | Starting collection install process 2026-07-25 14:09:36.028304 | instance | Installing 'community.crypto:2.2.3' to '/home/zuul/.ansible/collections/ansible_collections/community/crypto' 2026-07-25 14:09:36.028346 | instance | Created collection for community.crypto:2.2.3 at /home/zuul/.ansible/collections/ansible_collections/community/crypto 2026-07-25 14:09:36.028389 | instance | community.crypto:2.2.3 was installed successfully 2026-07-25 14:09:36.028431 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.028471 | instance | 2.17.12 2026-07-25 14:09:36.028512 | instance | Checked out community.general to 7.3.0 2026-07-25 14:09:36.028554 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/ansible-collections/community.general 2026-07-25 14:09:36.028610 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.028654 | instance | Process install dependency map 2026-07-25 14:09:36.028698 | instance | Starting collection install process 2026-07-25 14:09:36.028740 | instance | Installing 'community.general:7.3.0' to '/home/zuul/.ansible/collections/ansible_collections/community/general' 2026-07-25 14:09:36.028782 | instance | Created collection for community.general:7.3.0 at /home/zuul/.ansible/collections/ansible_collections/community/general 2026-07-25 14:09:36.028825 | instance | community.general:7.3.0 was installed successfully 2026-07-25 14:09:36.028869 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.028914 | instance | 2.17.12 2026-07-25 14:09:36.029022 | instance | Checked out community.mysql to 3.6.0 2026-07-25 14:09:36.029083 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/ansible-collections/community.mysql 2026-07-25 14:09:36.029130 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.029176 | instance | Process install dependency map 2026-07-25 14:09:36.029222 | instance | Starting collection install process 2026-07-25 14:09:36.029266 | instance | Installing 'community.mysql:3.6.0' to '/home/zuul/.ansible/collections/ansible_collections/community/mysql' 2026-07-25 14:09:36.029310 | instance | Created collection for community.mysql:3.6.0 at /home/zuul/.ansible/collections/ansible_collections/community/mysql 2026-07-25 14:09:36.029353 | instance | community.mysql:3.6.0 was installed successfully 2026-07-25 14:09:36.029400 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.029443 | instance | 2.17.12 2026-07-25 14:09:36.029486 | instance | Checked out kubernetes.core to 2.4.0 2026-07-25 14:09:36.029530 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/ansible-collections/kubernetes.core 2026-07-25 14:09:36.029574 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.029618 | instance | Process install dependency map 2026-07-25 14:09:36.029661 | instance | Starting collection install process 2026-07-25 14:09:36.029704 | instance | Installing 'kubernetes.core:2.4.0' to '/home/zuul/.ansible/collections/ansible_collections/kubernetes/core' 2026-07-25 14:09:36.029747 | instance | Created collection for kubernetes.core:2.4.0 at /home/zuul/.ansible/collections/ansible_collections/kubernetes/core 2026-07-25 14:09:36.029791 | instance | kubernetes.core:2.4.0 was installed successfully 2026-07-25 14:09:36.029834 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.029930 | instance | 2.17.12 2026-07-25 14:09:36.030076 | instance | Checked out openstack.cloud to 2.6.0 2026-07-25 14:09:36.030152 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/opendev.org/openstack/ansible-collections-openstack 2026-07-25 14:09:36.030201 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.030245 | instance | Process install dependency map 2026-07-25 14:09:36.030290 | instance | Starting collection install process 2026-07-25 14:09:36.030334 | instance | Installing 'openstack.cloud:2.6.0' to '/home/zuul/.ansible/collections/ansible_collections/openstack/cloud' 2026-07-25 14:09:36.030377 | instance | Created collection for openstack.cloud:2.6.0 at /home/zuul/.ansible/collections/ansible_collections/openstack/cloud 2026-07-25 14:09:36.030419 | instance | openstack.cloud:2.6.0 was installed successfully 2026-07-25 14:09:36.030462 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.030505 | instance | 2.17.12 2026-07-25 14:09:36.030559 | instance | Checked out vexxhost.ceph to v4.1.0 2026-07-25 14:09:36.030603 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/vexxhost/ansible-collection-ceph 2026-07-25 14:09:36.030647 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.030710 | instance | Process install dependency map 2026-07-25 14:09:36.030754 | instance | Starting collection install process 2026-07-25 14:09:36.030780 | instance | Installing 'vexxhost.ceph:4.1.0' to '/home/zuul/.ansible/collections/ansible_collections/vexxhost/ceph' 2026-07-25 14:09:36.030798 | instance | Created collection for vexxhost.ceph:4.1.0 at /home/zuul/.ansible/collections/ansible_collections/vexxhost/ceph 2026-07-25 14:09:36.030816 | instance | vexxhost.ceph:4.1.0 was installed successfully 2026-07-25 14:09:36.030834 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.030852 | instance | 2.17.12 2026-07-25 14:09:36.030869 | instance | Checked out vexxhost.containers to v1.6.8 2026-07-25 14:09:36.030887 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/vexxhost/ansible-collection-containers 2026-07-25 14:09:36.030905 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.030923 | instance | Process install dependency map 2026-07-25 14:09:36.030941 | instance | Starting collection install process 2026-07-25 14:09:36.030958 | instance | Installing 'vexxhost.containers:1.6.8' to '/home/zuul/.ansible/collections/ansible_collections/vexxhost/containers' 2026-07-25 14:09:36.030976 | instance | Created collection for vexxhost.containers:1.6.8 at /home/zuul/.ansible/collections/ansible_collections/vexxhost/containers 2026-07-25 14:09:36.030994 | instance | vexxhost.containers:1.6.8 was installed successfully 2026-07-25 14:09:36.031012 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.031030 | instance | 2.17.12 2026-07-25 14:09:36.031048 | instance | Checked out vexxhost.kubernetes to v3.3.0 2026-07-25 14:09:36.031066 | instance | Running: uv run ansible-galaxy collection install --force --no-deps --collections-path /home/zuul/.ansible/collections /home/zuul/src/github.com/vexxhost/ansible-collection-kubernetes 2026-07-25 14:09:36.031084 | instance | Starting galaxy collection install process 2026-07-25 14:09:36.031102 | instance | Process install dependency map 2026-07-25 14:09:36.031119 | instance | Starting collection install process 2026-07-25 14:09:36.031137 | instance | Installing 'vexxhost.kubernetes:3.3.0' to '/home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes' 2026-07-25 14:09:36.031156 | instance | Created collection for vexxhost.kubernetes:3.3.0 at /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes 2026-07-25 14:09:36.031182 | instance | vexxhost.kubernetes:3.3.0 was installed successfully 2026-07-25 14:09:36.031207 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version 2026-07-25 14:09:36.031230 | instance | 2.17.12 2026-07-25 14:09:36.036908 | 2026-07-25 14:09:36.036968 | PLAY RECAP 2026-07-25 14:09:36.037017 | instance | ok: 3 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-07-25 14:09:36.037039 | 2026-07-25 14:09:36.174324 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-07-25 14:09:36.185380 | PRE-RUN START: [untrusted : github.com/vexxhost/atmosphere-zuul-jobs/playbooks/molecule/pre.yml@main] 2026-07-25 14:09:36.816384 | 2026-07-25 14:09:36.816501 | PLAY [all] 2026-07-25 14:09:36.828065 | 2026-07-25 14:09:36.828139 | TASK [Install "jq" for log collection] 2026-07-25 14:09:47.402806 | instance | changed 2026-07-25 14:09:47.404944 | 2026-07-25 14:09:47.405027 | PLAY RECAP 2026-07-25 14:09:47.405083 | instance | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-07-25 14:09:47.405141 | 2026-07-25 14:09:47.527843 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere-zuul-jobs/playbooks/molecule/pre.yml@main] 2026-07-25 14:09:47.535515 | PRE-RUN START: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/prepare.yml@main] 2026-07-25 14:09:48.144875 | 2026-07-25 14:09:48.145017 | PLAY [Prepare Molecule dependencies] 2026-07-25 14:09:48.156198 | 2026-07-25 14:09:48.156277 | TASK [Install jq for log collection] 2026-07-25 14:09:50.987369 | instance | ok 2026-07-25 14:09:50.990270 | 2026-07-25 14:09:50.990356 | PLAY [Install Go for the Atmosphere deployment binary] 2026-07-25 14:09:50.998697 | 2026-07-25 14:09:50.998787 | TASK [ensure-go : Check installed go version] 2026-07-25 14:09:51.550157 | instance | ok: ERROR (ignored) 2026-07-25 14:09:51.725780 | instance | { 2026-07-25 14:09:51.725898 | instance | "failed_when_result": false, 2026-07-25 14:09:51.725957 | instance | "msg": "[Errno 2] No such file or directory: b'go'", 2026-07-25 14:09:51.726001 | instance | "rc": 2 2026-07-25 14:09:51.726042 | instance | } 2026-07-25 14:09:51.736776 | 2026-07-25 14:09:51.736848 | TASK [ensure-go : Skip if correct version of go is installed] 2026-07-25 14:09:51.790877 | instance | ok 2026-07-25 14:09:51.798664 | instance | included: /var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/untrusted/project_2/opendev.org/zuul/zuul-jobs/roles/ensure-go/tasks/install-go.yaml 2026-07-25 14:09:51.803342 | 2026-07-25 14:09:51.803405 | TASK [ensure-go : Create temp directory] 2026-07-25 14:09:52.112707 | instance | changed 2026-07-25 14:09:52.117829 | 2026-07-25 14:09:52.117895 | TASK [ensure-go : Get archive checksum] 2026-07-25 14:09:52.952210 | instance | ok: OK (64 bytes) 2026-07-25 14:09:52.957452 | 2026-07-25 14:09:52.957515 | TASK [ensure-go : Download go archive] 2026-07-25 14:09:54.321965 | instance | changed: OK (78559214 bytes) 2026-07-25 14:09:54.327152 | 2026-07-25 14:09:54.327217 | TASK [ensure-go : Install go] 2026-07-25 14:10:00.128862 | instance | changed 2026-07-25 14:10:00.137541 | 2026-07-25 14:10:00.137594 | PLAY [Prepare selective Molecule execution plan] 2026-07-25 14:10:00.144486 | 2026-07-25 14:10:00.144551 | TASK [Build atmosphere binary] 2026-07-25 14:10:00.405454 | instance | go: downloading github.com/spf13/cobra v1.9.1 2026-07-25 14:10:00.405540 | instance | go: downloading golang.org/x/sync v0.18.0 2026-07-25 14:10:00.406086 | instance | go: downloading github.com/goccy/go-yaml v1.18.0 2026-07-25 14:10:00.682358 | instance | go: downloading github.com/spf13/pflag v1.0.7 2026-07-25 14:10:07.719130 | instance | ok: Runtime: 0:00:07.089665 2026-07-25 14:10:07.724740 | 2026-07-25 14:10:07.724809 | TASK [Generate selective CI plan] 2026-07-25 14:10:08.265281 | instance | ok: Runtime: 0:00:00.027062 2026-07-25 14:10:08.271377 | 2026-07-25 14:10:08.271520 | TASK [Explain selective CI plan] 2026-07-25 14:10:08.503657 | instance | CI plan mode: selective 2026-07-25 14:10:08.503974 | instance | Changed files: 2026-07-25 14:10:08.503989 | instance | A roles/keystone/.ci-selective-test 2026-07-25 14:10:08.504001 | instance | Matches: 2026-07-25 14:10:08.504015 | instance | roles/keystone/.ci-selective-test: component:keystone (targets) -> keystone 2026-07-25 14:10:08.504026 | instance | Direct targets: keystone 2026-07-25 14:10:08.504039 | instance | Deployment roots: keystone 2026-07-25 14:10:08.504049 | instance | Verification profiles: identity, keycloak-federation 2026-07-25 14:10:08.504060 | instance | Variant openvswitch (12 components): ceph, cert-manager, cluster-issuer, csi, ingress-nginx, keycloak, keystone, kubernetes, memcached, percona-xtradb-cluster, percona-xtradb-cluster-operator, rabbitmq-cluster-operator 2026-07-25 14:10:08.504074 | instance | Molecule jobs: 2026-07-25 14:10:08.504084 | instance | aio-openvswitch: run (12 components) - executes the openvswitch deployment variant 2026-07-25 14:10:08.504094 | instance | aio-ovn: skip - plan has no ovn deployment variant 2026-07-25 14:10:08.504103 | instance | csi-local-path-provisioner: skip - none of the job's verification profiles were requested 2026-07-25 14:10:08.504112 | instance | csi-rbd: skip - none of the job's verification profiles were requested 2026-07-25 14:10:08.504122 | instance | keycloak: run (12 components) - requested verification profiles: keycloak-federation 2026-07-25 14:10:08.804826 | instance | ok: Runtime: 0:00:00.026917 2026-07-25 14:10:08.818356 | 2026-07-25 14:10:08.818490 | TASK [Print selective CI plan] 2026-07-25 14:10:08.879676 | instance | ok 2026-07-25 14:10:08.884779 | 2026-07-25 14:10:08.884850 | TASK [Report conservative fallback] 2026-07-25 14:10:08.909630 | instance | skipping: Conditional result was False 2026-07-25 14:10:08.917679 | 2026-07-25 14:10:08.917798 | TASK [Create selective CI plan log directory] 2026-07-25 14:10:09.245445 | instance | changed 2026-07-25 14:10:09.254043 | 2026-07-25 14:10:09.254155 | TASK [Publish selective CI plan with job logs] 2026-07-25 14:10:09.641858 | instance | changed 2026-07-25 14:10:09.647247 | 2026-07-25 14:10:09.647410 | PLAY RECAP 2026-07-25 14:10:09.647481 | instance | ok: 13 changed: 5 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-07-25 14:10:09.647514 | 2026-07-25 14:10:09.810644 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/prepare.yml@main] 2026-07-25 14:10:09.830556 | RUN START: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/selective-run.yml@main] 2026-07-25 14:10:10.595885 | 2026-07-25 14:10:10.596006 | PLAY [Run selected Molecule deployment and verification] 2026-07-25 14:10:10.608682 | 2026-07-25 14:10:10.608779 | TASK [Check for selective CI plan] 2026-07-25 14:10:10.962867 | instance | ok 2026-07-25 14:10:10.974132 | 2026-07-25 14:10:10.974206 | TASK [Validate selective CI plan] 2026-07-25 14:10:11.522756 | instance | ok: Runtime: 0:00:00.032310 2026-07-25 14:10:11.528687 | 2026-07-25 14:10:11.528755 | TASK [Resolve selective CI plan availability] 2026-07-25 14:10:11.581327 | instance | ok 2026-07-25 14:10:11.587354 | 2026-07-25 14:10:11.587440 | TASK [Read selective CI plan] 2026-07-25 14:10:11.884428 | instance | ok 2026-07-25 14:10:11.890096 | 2026-07-25 14:10:11.890161 | TASK [Load selective CI plan or full fallback] 2026-07-25 14:10:11.943011 | instance | ok 2026-07-25 14:10:11.951389 | 2026-07-25 14:10:11.951476 | TASK [Find this job in the selective CI plan] 2026-07-25 14:10:12.003784 | instance | ok 2026-07-25 14:10:12.009679 | 2026-07-25 14:10:12.009763 | TASK [Resolve this job or use full fallback] 2026-07-25 14:10:12.060896 | instance | ok 2026-07-25 14:10:12.067675 | 2026-07-25 14:10:12.067759 | TASK [Resolve deployment and verification inputs] 2026-07-25 14:10:12.160982 | instance | ok 2026-07-25 14:10:12.199324 | 2026-07-25 14:10:12.199477 | TASK [Resolve deployment tags] 2026-07-25 14:10:12.254578 | instance | ok 2026-07-25 14:10:12.261416 | 2026-07-25 14:10:12.261499 | TASK [Report Molecule job decision] 2026-07-25 14:10:12.297543 | instance | ok: {'job': 'aio-ovn', 'mode': 'selective', 'run': False, 'reason': 'plan has no ovn deployment variant', 'network_backend': 'ovn', 'csi_driver': 'rbd', 'components': [], 'verification_profiles': ['identity', 'keycloak-federation']} 2026-07-25 14:10:12.302728 | 2026-07-25 14:10:12.302788 | TASK [Copy inventory file for Zuul] 2026-07-25 14:10:12.328145 | instance | skipping: Conditional result was False 2026-07-25 14:10:12.337081 | 2026-07-25 14:10:12.337171 | TASK [Switch ansible_host to private IP] 2026-07-25 14:10:12.362533 | instance | skipping: Conditional result was False 2026-07-25 14:10:12.374048 | 2026-07-25 14:10:12.374137 | TASK [Prepare Molecule scenario] 2026-07-25 14:10:12.904040 | instance | skipping: Conditional result was False 2026-07-25 14:10:13.005922 | 2026-07-25 14:10:13.006022 | TASK [Prepare host for Ceph-backed storage] 2026-07-25 14:10:13.533896 | instance | skipping: Conditional result was False 2026-07-25 14:10:13.750541 | 2026-07-25 14:10:13.750758 | TASK [Build deployment command] 2026-07-25 14:10:13.774872 | instance | skipping: Conditional result was False 2026-07-25 14:10:13.783117 | 2026-07-25 14:10:13.783200 | TASK [Deploy with parallel orchestrator] 2026-07-25 14:10:14.311156 | instance | skipping: Conditional result was False 2026-07-25 14:10:14.316561 | 2026-07-25 14:10:14.316629 | TASK [Re-deploy to verify idempotent execution] 2026-07-25 14:10:14.843493 | instance | skipping: Conditional result was False 2026-07-25 14:10:14.855508 | 2026-07-25 14:10:14.855656 | TASK [Check for br-ex interface] 2026-07-25 14:10:15.381836 | instance | skipping: Conditional result was False 2026-07-25 14:10:15.387275 | 2026-07-25 14:10:15.387343 | TASK [Add IP address to br-ex] 2026-07-25 14:10:15.911307 | instance | skipping: Conditional result was False 2026-07-25 14:10:15.918480 | 2026-07-25 14:10:15.918573 | TASK [Set br-ex interface up] 2026-07-25 14:10:16.447579 | instance | skipping: Conditional result was False 2026-07-25 14:10:16.459065 | 2026-07-25 14:10:16.459155 | TASK [Verify Molecule scenario] 2026-07-25 14:10:16.984445 | instance | skipping: Conditional result was False 2026-07-25 14:10:16.987389 | 2026-07-25 14:10:16.987490 | PLAY RECAP 2026-07-25 14:10:16.987597 | instance | ok: 10 changed: 0 unreachable: 0 failed: 0 skipped: 11 rescued: 0 ignored: 0 2026-07-25 14:10:16.987646 | 2026-07-25 14:10:17.138665 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/selective-run.yml@main] 2026-07-25 14:10:17.147453 | POST-RUN START: [untrusted : github.com/vexxhost/atmosphere-zuul-jobs/playbooks/molecule/post.yml@main] 2026-07-25 14:10:17.798435 | 2026-07-25 14:10:18.735565 | PLAY [all] 2026-07-25 14:10:18.763173 | 2026-07-25 14:10:18.763356 | TASK [gather-host-logs : creating directory for system status] 2026-07-25 14:10:19.123941 | instance | ok 2026-07-25 14:10:19.129394 | 2026-07-25 14:10:19.129478 | TASK [gather-host-logs : Get logs for each host] 2026-07-25 14:10:19.469151 | instance | + systemd-cgls --full --all --no-pager 2026-07-25 14:10:19.480612 | instance | + ip addr 2026-07-25 14:10:19.483079 | instance | + ip route 2026-07-25 14:10:19.486400 | instance | + lsblk 2026-07-25 14:10:19.490342 | instance | + mount 2026-07-25 14:10:19.491926 | instance | + docker images 2026-07-25 14:10:19.492301 | instance | /bin/bash: line 7: docker: command not found 2026-07-25 14:10:19.492501 | instance | + brctl show 2026-07-25 14:10:19.492867 | instance | /bin/bash: line 8: brctl: command not found 2026-07-25 14:10:19.493074 | instance | + ps aux --sort=-%mem 2026-07-25 14:10:19.507202 | instance | + dpkg -l 2026-07-25 14:10:19.518467 | instance | + CONTAINERS=($(docker ps -a --format '{{ .Names }}' --filter label=zuul)) 2026-07-25 14:10:19.518895 | instance | ++ docker ps -a --format '{{ .Names }}' --filter label=zuul 2026-07-25 14:10:19.518955 | instance | /bin/bash: line 11: docker: command not found 2026-07-25 14:10:19.519234 | instance | + '[' '!' -z '' ']' 2026-07-25 14:10:19.666172 | instance | ok: Runtime: 0:00:00.055259 2026-07-25 14:10:19.674488 | 2026-07-25 14:10:19.674557 | TASK [gather-host-logs : Downloads logs to executor] 2026-07-25 14:10:20.605405 | instance | ERROR 2026-07-25 14:10:20.605620 | instance | { 2026-07-25 14:10:20.605652 | instance | "msg": "Warning: Permanently added '199.204.45.205' (ED25519) to the list of known hosts.\r\nrsync: [generator] chown \"/var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/work/logs/instance/system\" failed: Invalid argument (22)\nrsync: [receiver] chown \"/var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/work/logs/instance/system/.ci-plan.json.f5G0N6\" failed: Invalid argument (22)\nrsync error: some files/attrs were not transferred (see previous errors) (code 23) at main.c(1865) [generator=3.2.7]\n", 2026-07-25 14:10:20.605678 | instance | "rc": 23 2026-07-25 14:10:20.605698 | instance | } 2026-07-25 14:10:20.605726 | instance | ERROR: Ignoring Errors 2026-07-25 14:10:20.615154 | 2026-07-25 14:10:20.615234 | LOOP [helm-release-status : creating directory for helm release status] 2026-07-25 14:10:20.805788 | instance | changed: "values" 2026-07-25 14:10:20.972309 | instance | changed: "releases" 2026-07-25 14:10:20.990942 | 2026-07-25 14:10:20.991076 | TASK [helm-release-status : Gather get release status for helm charts] 2026-07-25 14:10:21.229826 | instance | /bin/bash: line 3: kubectl: command not found 2026-07-25 14:10:21.524380 | instance | ok: Runtime: 0:00:00.006121 2026-07-25 14:10:21.529394 | 2026-07-25 14:10:21.529461 | TASK [helm-release-status : Downloads logs to executor] 2026-07-25 14:10:22.046969 | instance | changed: 2026-07-25 14:10:22.094233 | instance | cd+++++++++ helm/ 2026-07-25 14:10:22.094378 | instance | cd+++++++++ helm/releases/ 2026-07-25 14:10:22.094423 | instance | cd+++++++++ helm/values/ 2026-07-25 14:10:22.107021 | 2026-07-25 14:10:22.107108 | TASK [describe-kubernetes-objects : creating directory for cluster scoped objects] 2026-07-25 14:10:22.304673 | instance | changed 2026-07-25 14:10:22.310322 | 2026-07-25 14:10:22.310399 | TASK [describe-kubernetes-objects : Gathering descriptions for cluster scoped objects] 2026-07-25 14:10:22.526560 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-07-25 14:10:22.526931 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-07-25 14:10:22.532086 | instance | environment: line 1: kubectl: command not found 2026-07-25 14:10:22.533823 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-07-25 14:10:22.534459 | instance | environment: line 1: kubectl: command not found 2026-07-25 14:10:22.535938 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-07-25 14:10:22.537335 | instance | environment: line 1: kubectl: command not found 2026-07-25 14:10:22.538163 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-07-25 14:10:22.539041 | instance | environment: line 1: kubectl: command not found 2026-07-25 14:10:22.540510 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-07-25 14:10:22.541834 | instance | environment: line 1: kubectl: command not found 2026-07-25 14:10:22.542592 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-07-25 14:10:22.847864 | instance | ok: Runtime: 0:00:00.027207 2026-07-25 14:10:22.854647 | 2026-07-25 14:10:22.854717 | TASK [describe-kubernetes-objects : creating directory for namespace scoped objects] 2026-07-25 14:10:23.051035 | instance | changed 2026-07-25 14:10:23.056504 | 2026-07-25 14:10:23.056582 | TASK [describe-kubernetes-objects : Gathering descriptions for namespace scoped objects] 2026-07-25 14:10:23.303316 | instance | environment: line 5: kubectl: command not found 2026-07-25 14:10:23.304207 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-07-25 14:10:23.304246 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-07-25 14:10:23.305168 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-07-25 14:10:23.829707 | instance | ok: Runtime: 0:00:00.009036 2026-07-25 14:10:23.840399 | 2026-07-25 14:10:23.840566 | TASK [describe-kubernetes-objects : Downloads logs to executor] 2026-07-25 14:10:24.353010 | instance | changed: 2026-07-25 14:10:24.353257 | instance | cd+++++++++ objects/ 2026-07-25 14:10:24.353329 | instance | cd+++++++++ objects/cluster/ 2026-07-25 14:10:24.353365 | instance | cd+++++++++ objects/namespaced/ 2026-07-25 14:10:24.364614 | 2026-07-25 14:10:24.364675 | TASK [gather-pod-logs : creating directory for pod logs] 2026-07-25 14:10:24.569286 | instance | changed 2026-07-25 14:10:24.578878 | 2026-07-25 14:10:24.578947 | TASK [gather-pod-logs : creating directory for failed pod logs] 2026-07-25 14:10:24.772884 | instance | changed 2026-07-25 14:10:24.779822 | 2026-07-25 14:10:24.779889 | TASK [gather-pod-logs : retrieve all kubernetes logs, current and previous (if they exist)] 2026-07-25 14:10:24.983653 | instance | environment: line 3: kubectl: command not found 2026-07-25 14:10:25.311833 | instance | ok: Runtime: 0:00:00.008826 2026-07-25 14:10:25.319141 | 2026-07-25 14:10:25.319210 | TASK [gather-pod-logs : Downloads pod logs to executor] 2026-07-25 14:10:25.831214 | instance | changed: 2026-07-25 14:10:25.831481 | instance | cd+++++++++ pod-logs/ 2026-07-25 14:10:25.831533 | instance | cd+++++++++ pod-logs/failed-pods/ 2026-07-25 14:10:25.842292 | 2026-07-25 14:10:25.842426 | TASK [gather-prom-metrics : creating directory for helm release descriptions] 2026-07-25 14:10:26.050054 | instance | changed 2026-07-25 14:10:26.056300 | 2026-07-25 14:10:26.056371 | TASK [gather-prom-metrics : Get metrics from exporter services in all namespaces] 2026-07-25 14:10:26.264244 | instance | /bin/bash: line 2: kubectl: command not found 2026-07-25 14:10:26.595745 | instance | ok: Runtime: 0:00:00.036769 2026-07-25 14:10:26.600667 | 2026-07-25 14:10:26.600735 | TASK [gather-prom-metrics : Get ceph metrics from ceph-mgr] 2026-07-25 14:10:26.828020 | instance | /bin/bash: line 2: kubectl: command not found 2026-07-25 14:10:26.858710 | instance | ceph-mgr endpoints: 2026-07-25 14:10:27.136508 | instance | ok: Runtime: 0:00:00.037722 2026-07-25 14:10:27.143449 | 2026-07-25 14:10:27.143516 | TASK [gather-prom-metrics : Get metrics from fluentd pods] 2026-07-25 14:10:27.384879 | instance | /bin/bash: line 4: kubectl: command not found 2026-07-25 14:10:27.724460 | instance | ok: Runtime: 0:00:00.035938 2026-07-25 14:10:27.729731 | 2026-07-25 14:10:27.729809 | TASK [gather-prom-metrics : Downloads logs to executor] 2026-07-25 14:10:28.198278 | instance | changed: cd+++++++++ prometheus/ 2026-07-25 14:10:28.210163 | 2026-07-25 14:10:28.210232 | TASK [gather-selenium-data : creating directory for helm release descriptions] 2026-07-25 14:10:28.408355 | instance | changed 2026-07-25 14:10:28.413385 | 2026-07-25 14:10:28.413453 | TASK [gather-selenium-data : Get selenium data] 2026-07-25 14:10:28.616018 | instance | + cp '/tmp/artifacts/*' /tmp/logs/selenium/. 2026-07-25 14:10:28.617606 | instance | cp: cannot stat '/tmp/artifacts/*': No such file or directory 2026-07-25 14:10:28.947065 | instance | ERROR 2026-07-25 14:10:28.947257 | instance | { 2026-07-25 14:10:28.947308 | instance | "delta": "0:00:00.007022", 2026-07-25 14:10:28.947345 | instance | "end": "2026-07-25 14:10:28.617995", 2026-07-25 14:10:28.947379 | instance | "msg": "non-zero return code", 2026-07-25 14:10:28.947414 | instance | "rc": 1, 2026-07-25 14:10:28.947448 | instance | "start": "2026-07-25 14:10:28.610973" 2026-07-25 14:10:28.947490 | instance | } 2026-07-25 14:10:28.947546 | instance | ERROR: Ignoring Errors 2026-07-25 14:10:28.954068 | 2026-07-25 14:10:28.954137 | TASK [gather-selenium-data : Downloads logs to executor] 2026-07-25 14:10:29.440850 | instance | changed: cd+++++++++ selenium/ 2026-07-25 14:10:29.450926 | 2026-07-25 14:10:29.451025 | PLAY RECAP 2026-07-25 14:10:29.451098 | instance | ok: 23 changed: 21 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 2 2026-07-25 14:10:29.451135 | 2026-07-25 14:10:29.650107 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere-zuul-jobs/playbooks/molecule/post.yml@main] 2026-07-25 14:10:29.663791 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-07-25 14:10:30.544068 | 2026-07-25 14:10:30.544232 | PLAY [all] 2026-07-25 14:10:30.557474 | 2026-07-25 14:10:30.569322 | TASK [fetch-output : Set log path for multiple nodes] 2026-07-25 14:10:30.616725 | instance | skipping: Conditional result was False 2026-07-25 14:10:30.628677 | 2026-07-25 14:10:30.628843 | TASK [fetch-output : Set log path for single node] 2026-07-25 14:10:30.672010 | instance | ok 2026-07-25 14:10:30.679065 | 2026-07-25 14:10:30.679148 | LOOP [fetch-output : Ensure local output dirs] 2026-07-25 14:10:31.081319 | instance -> localhost | ok: "/var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/work/logs" 2026-07-25 14:10:31.311698 | instance -> localhost | changed: "/var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/work/artifacts" 2026-07-25 14:10:31.513160 | instance -> localhost | changed: "/var/lib/zuul/builds/5e6d06540e784d5da3ef68be796ca5dc/work/docs" 2026-07-25 14:10:31.525147 | 2026-07-25 14:10:31.525333 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-07-25 14:10:32.134173 | instance | changed: .d..t...... ./ 2026-07-25 14:10:32.134418 | instance | changed: All items complete 2026-07-25 14:10:32.134459 | 2026-07-25 14:10:32.717262 | instance | changed: .d..t...... ./ 2026-07-25 14:10:33.186535 | instance | changed: .d..t...... ./ 2026-07-25 14:10:33.211424 | 2026-07-25 14:10:33.239501 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-07-25 14:10:33.679236 | instance -> localhost | ok: Item: artifacts Runtime: 0:00:00.025238 2026-07-25 14:10:34.101726 | instance -> localhost | ok: Item: docs Runtime: 0:00:00.009181 2026-07-25 14:10:34.118316 | 2026-07-25 14:10:34.118694 | PLAY [all] 2026-07-25 14:10:34.124720 | 2026-07-25 14:10:34.124782 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-07-25 14:10:34.527823 | instance | changed 2026-07-25 14:10:34.535131 | 2026-07-25 14:10:34.535183 | PLAY RECAP 2026-07-25 14:10:34.535227 | instance | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-07-25 14:10:34.535248 | 2026-07-25 14:10:34.648852 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-07-25 14:10:34.664980 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main] 2026-07-25 14:10:35.339785 | 2026-07-25 14:10:35.339934 | PLAY [localhost] 2026-07-25 14:10:35.350268 | 2026-07-25 14:10:35.350399 | TASK [Generate Zuul manifest] 2026-07-25 14:10:35.372745 | localhost | ok 2026-07-25 14:10:35.460646 | 2026-07-25 14:10:35.460796 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-07-25 14:10:35.890500 | localhost | changed 2026-07-25 14:10:35.932841 | 2026-07-25 14:10:35.932934 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-07-25 14:10:36.074356 | localhost | ok 2026-07-25 14:10:36.082921 | 2026-07-25 14:10:36.082987 | TASK [Upload logs] 2026-07-25 14:10:36.101399 | localhost | ok 2026-07-25 14:10:36.254645 | 2026-07-25 14:10:36.254764 | TASK [Set zuul-log-path fact] 2026-07-25 14:10:36.273741 | localhost | ok 2026-07-25 14:10:36.290008 | 2026-07-25 14:10:36.290074 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-07-25 14:10:36.322716 | localhost | ok 2026-07-25 14:10:36.329612 | 2026-07-25 14:10:36.329677 | TASK [upload-logs : Create log directories] 2026-07-25 14:10:36.686106 | localhost | changed 2026-07-25 14:10:36.692993 | 2026-07-25 14:10:36.693073 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-07-25 14:10:37.101937 | localhost -> localhost | ok: Runtime: 0:00:00.038231 2026-07-25 14:10:37.107423 | 2026-07-25 14:10:37.107495 | TASK [upload-logs : Upload logs to log server] 2026-07-25 14:10:37.654815 | localhost | Output suppressed because no_log was given 2026-07-25 14:10:37.660306 | 2026-07-25 14:10:37.660379 | LOOP [upload-logs : Compress console log and json output] 2026-07-25 14:10:37.703090 | localhost | skipping: Conditional result was False 2026-07-25 14:10:37.709989 | localhost | skipping: Conditional result was False 2026-07-25 14:10:37.724894 | 2026-07-25 14:10:37.789956 | LOOP [upload-logs : Upload compressed console log and json output] 2026-07-25 14:10:37.829799 | localhost | skipping: Conditional result was False 2026-07-25 14:10:37.830159 | 2026-07-25 14:10:37.834021 | localhost | skipping: Conditional result was False 2026-07-25 14:10:37.844002 | 2026-07-25 14:10:37.844146 | LOOP [upload-logs : Upload console log and json output]