2026-08-24 20:28:47.950869 | Job console starting
2026-08-24 20:28:47.966762 | Updating git repos
2026-08-24 20:28:51.222282 | Cloning repos into workspace
2026-08-24 20:29:06.364418 | Restoring repo states
2026-08-24 20:29:10.063729 | Merging changes
2026-08-24 20:29:11.438671 | Checking out repos
2026-08-24 20:29:13.373486 | Preparing playbooks
2026-08-24 20:29:15.428678 | Running Ansible setup
2026-08-24 20:29:18.944618 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main]
2026-08-24 20:29:19.554808 | 
2026-08-24 20:29:19.554925 | PLAY [localhost]
2026-08-24 20:29:19.562168 | 
2026-08-24 20:29:19.562235 | TASK [Gathering Facts]
2026-08-24 20:29:20.505302 | localhost | ok
2026-08-24 20:29:20.516179 | 
2026-08-24 20:29:20.516296 | TASK [Setup log path fact]
2026-08-24 20:29:20.538147 | localhost | ok
2026-08-24 20:29:20.552009 | 
2026-08-24 20:29:20.552105 | TASK [set-zuul-log-path-fact : Set log path for a build]
2026-08-24 20:29:20.582693 | localhost | ok
2026-08-24 20:29:20.743231 | 
2026-08-24 20:29:20.743348 | TASK [emit-job-header : Print job information]
2026-08-24 20:29:20.784732 | # Job Information
2026-08-24 20:29:20.785013 | Ansible Version: 2.16.18
2026-08-24 20:29:20.785086 | Job: atmosphere-molecule-csi-rbd
2026-08-24 20:29:20.785134 | Pipeline: check
2026-08-24 20:29:20.785177 | Executor: 2d72f0692154
2026-08-24 20:29:20.785220 | Triggered by: https://github.com/vexxhost/atmosphere/pull/4090
2026-08-24 20:29:20.785269 | Event ID: b66b6280-9ff9-11f1-83b9-da52a34606a1
2026-08-24 20:29:20.789498 | 
2026-08-24 20:29:20.789593 | LOOP [emit-job-header : Print node information]
2026-08-24 20:29:20.926073 | localhost | ok:
2026-08-24 20:29:20.926334 | localhost | # Node Information
2026-08-24 20:29:20.926395 | localhost | Inventory Hostname: instance
2026-08-24 20:29:20.926442 | localhost | Hostname: np0000191003
2026-08-24 20:29:20.926487 | localhost | Username: zuul
2026-08-24 20:29:20.926539 | localhost | Distro: Ubuntu 22.04
2026-08-24 20:29:20.926597 | localhost | Provider: yul1
2026-08-24 20:29:20.926651 | localhost | Region: ca-ymq-1
2026-08-24 20:29:20.926701 | localhost | Label: ubuntu-jammy
2026-08-24 20:29:20.926750 | localhost | Product Name: OpenStack Nova
2026-08-24 20:29:20.926797 | localhost | Interface IP: 199.204.45.140
2026-08-24 20:29:20.947609 | 
2026-08-24 20:29:20.947741 | TASK [log-inventory : Ensure Zuul Ansible directory exists]
2026-08-24 20:29:21.489304 | localhost -> localhost | changed
2026-08-24 20:29:21.496350 | 
2026-08-24 20:29:21.496443 | TASK [log-inventory : Copy ansible inventory to logs dir]
2026-08-24 20:29:22.448835 | localhost -> localhost | changed
2026-08-24 20:29:22.462106 | 
2026-08-24 20:29:22.462182 | PLAY [all]
2026-08-24 20:29:22.475266 | 
2026-08-24 20:29:22.475335 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build]
2026-08-24 20:29:22.971473 | instance -> localhost | ok
2026-08-24 20:29:22.979508 | 
2026-08-24 20:29:22.979665 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID]
2026-08-24 20:29:23.015366 | instance | ok
2026-08-24 20:29:23.030325 | instance | included: /var/lib/zuul/builds/02d23b833fa24a6db7c8f5ff63efdb8b/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml
2026-08-24 20:29:23.035764 | 
2026-08-24 20:29:23.035824 | TASK [add-build-sshkey : Create Temp SSH key]
2026-08-24 20:29:24.770827 | instance -> localhost | Generating public/private rsa key pair.
2026-08-24 20:29:24.771040 | instance -> localhost | Your identification has been saved in /var/lib/zuul/builds/02d23b833fa24a6db7c8f5ff63efdb8b/work/02d23b833fa24a6db7c8f5ff63efdb8b_id_rsa
2026-08-24 20:29:24.771106 | instance -> localhost | Your public key has been saved in /var/lib/zuul/builds/02d23b833fa24a6db7c8f5ff63efdb8b/work/02d23b833fa24a6db7c8f5ff63efdb8b_id_rsa.pub
2026-08-24 20:29:24.771134 | instance -> localhost | The key fingerprint is:
2026-08-24 20:29:24.771197 | instance -> localhost | SHA256:aPYJR8V3Ch2UrcxWuqBykxL6jhyFigUwkt0Klu2VrAI zuul-build-sshkey
2026-08-24 20:29:24.771253 | instance -> localhost | The key's randomart image is:
2026-08-24 20:29:24.771281 | instance -> localhost | +---[RSA 3072]----+
2026-08-24 20:29:24.771350 | instance -> localhost | |+oo.. .  ..oo+   |
2026-08-24 20:29:24.771402 | instance -> localhost | |E+...+   .o + +  |
2026-08-24 20:29:24.771441 | instance -> localhost | |+...o   .  = *   |
2026-08-24 20:29:24.771484 | instance -> localhost | | o.o ..o  . B    |
2026-08-24 20:29:24.771512 | instance -> localhost | |  o ..*.So o .   |
2026-08-24 20:29:24.771570 | instance -> localhost | | o ..+o+=.  .    |
2026-08-24 20:29:24.771617 | instance -> localhost | |. . .. +o.       |
2026-08-24 20:29:24.771645 | instance -> localhost | |   . o.          |
2026-08-24 20:29:24.771695 | instance -> localhost | |    o..          |
2026-08-24 20:29:24.771724 | instance -> localhost | +----[SHA256]-----+
2026-08-24 20:29:24.771805 | instance -> localhost | ok: Runtime: 0:00:01.275458
2026-08-24 20:29:24.780018 | 
2026-08-24 20:29:24.780132 | TASK [add-build-sshkey : Remote setup ssh keys (linux)]
2026-08-24 20:29:24.810486 | instance | ok
2026-08-24 20:29:24.820982 | instance | included: /var/lib/zuul/builds/02d23b833fa24a6db7c8f5ff63efdb8b/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml
2026-08-24 20:29:24.828452 | 
2026-08-24 20:29:24.828540 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey]
2026-08-24 20:29:24.853082 | instance | skipping: Conditional result was False
2026-08-24 20:29:24.858275 | 
2026-08-24 20:29:24.858337 | TASK [add-build-sshkey : Enable access via build key on all nodes]
2026-08-24 20:29:25.311299 | instance | changed
2026-08-24 20:29:25.479565 | 
2026-08-24 20:29:25.479678 | TASK [add-build-sshkey : Make sure user has a .ssh]
2026-08-24 20:29:25.663041 | instance | ok
2026-08-24 20:29:25.668322 | 
2026-08-24 20:29:25.668385 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes]
2026-08-24 20:29:26.154117 | instance | changed
2026-08-24 20:29:26.160436 | 
2026-08-24 20:29:26.160499 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes]
2026-08-24 20:29:26.620395 | instance | changed
2026-08-24 20:29:26.626643 | 
2026-08-24 20:29:26.626706 | TASK [add-build-sshkey : Remote setup ssh keys (windows)]
2026-08-24 20:29:26.651164 | instance | skipping: Conditional result was False
2026-08-24 20:29:26.662084 | 
2026-08-24 20:29:26.662174 | TASK [remove-zuul-sshkey : Remove master key from local agent]
2026-08-24 20:29:27.316066 | instance -> localhost | changed
2026-08-24 20:29:27.331234 | 
2026-08-24 20:29:27.331301 | TASK [add-build-sshkey : Add back temp key]
2026-08-24 20:29:27.731182 | instance -> localhost | Identity added: /var/lib/zuul/builds/02d23b833fa24a6db7c8f5ff63efdb8b/work/02d23b833fa24a6db7c8f5ff63efdb8b_id_rsa (zuul-build-sshkey)
2026-08-24 20:29:27.731579 | instance -> localhost | ok: Runtime: 0:00:00.014299
2026-08-24 20:29:27.738278 | 
2026-08-24 20:29:27.738367 | TASK [add-build-sshkey : Verify we can still SSH to all nodes]
2026-08-24 20:29:28.061376 | instance | ok
2026-08-24 20:29:28.067333 | 
2026-08-24 20:29:28.067418 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)]
2026-08-24 20:29:28.091841 | instance | skipping: Conditional result was False
2026-08-24 20:29:28.107871 | 
2026-08-24 20:29:28.107935 | TASK [prepare-workspace : Start zuul_console daemon.]
2026-08-24 20:29:28.424872 | instance | ok
2026-08-24 20:29:28.430513 | 
2026-08-24 20:29:28.430578 | TASK [prepare-workspace : Synchronize src repos to workspace directory.]
2026-08-24 20:29:43.823678 | instance | Output suppressed because no_log was given
2026-08-24 20:29:43.837404 | 
2026-08-24 20:29:43.837472 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them]
2026-08-24 20:29:44.070006 | instance | ok: "logs"
2026-08-24 20:29:44.070311 | instance | ok: All items complete
2026-08-24 20:29:44.070353 | 
2026-08-24 20:29:44.223341 | instance | ok: "artifacts"
2026-08-24 20:29:44.378659 | instance | ok: "docs"
2026-08-24 20:29:44.389947 | 
2026-08-24 20:29:44.390085 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist]
2026-08-24 20:29:44.581151 | instance | changed: "logs"
2026-08-24 20:29:44.751140 | instance | changed: "artifacts"
2026-08-24 20:29:44.900254 | instance | changed: "docs"
2026-08-24 20:29:44.918062 | 
2026-08-24 20:29:44.918164 | PLAY RECAP
2026-08-24 20:29:44.918215 | instance | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0
2026-08-24 20:29:44.918244 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-08-24 20:29:44.918266 | 
2026-08-24 20:29:45.111303 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main]
2026-08-24 20:29:45.114884 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main]
2026-08-24 20:29:46.030676 | 
2026-08-24 20:29:46.030796 | PLAY [all]
2026-08-24 20:29:46.043380 | 
2026-08-24 20:29:46.043475 | TASK [setup-uv : Extract archive]
2026-08-24 20:29:48.321318 | instance | changed
2026-08-24 20:29:48.326965 | 
2026-08-24 20:29:48.327045 | TASK [setup-uv : Print version]
2026-08-24 20:29:48.705891 | instance | uv 0.8.13
2026-08-24 20:29:48.861529 | instance | ok: Runtime: 0:00:00.010811
2026-08-24 20:29:48.874062 | 
2026-08-24 20:29:48.874164 | TASK [Install Ansible collection siblings]
2026-08-24 20:29:57.502623 | instance | changed:
2026-08-24 20:29:57.502879 | instance | Sibling collection ansible.netcommon at /home/zuul/src/github.com/ansible-collections/ansible.netcommon
2026-08-24 20:29:57.502916 | instance | Sibling collection ansible.posix at /home/zuul/src/github.com/ansible-collections/ansible.posix
2026-08-24 20:29:57.502945 | instance | Sibling collection ansible.utils at /home/zuul/src/github.com/ansible-collections/ansible.utils
2026-08-24 20:29:57.502972 | instance | Sibling collection community.crypto at /home/zuul/src/github.com/ansible-collections/community.crypto
2026-08-24 20:29:57.502998 | instance | Sibling collection community.general at /home/zuul/src/github.com/ansible-collections/community.general
2026-08-24 20:29:57.503027 | instance | Sibling collection community.mysql at /home/zuul/src/github.com/ansible-collections/community.mysql
2026-08-24 20:29:57.503055 | instance | Sibling collection kubernetes.core at /home/zuul/src/github.com/ansible-collections/kubernetes.core
2026-08-24 20:29:57.503084 | instance | Sibling collection vexxhost.ceph at /home/zuul/src/github.com/vexxhost/ansible-collection-ceph
2026-08-24 20:29:57.503110 | instance | Sibling collection vexxhost.containers at /home/zuul/src/github.com/vexxhost/ansible-collection-containers
2026-08-24 20:29:57.503136 | instance | Sibling collection vexxhost.kubernetes at /home/zuul/src/github.com/vexxhost/ansible-collection-kubernetes
2026-08-24 20:29:57.503161 | instance | Sibling collection atmosphere.common at /home/zuul/src/github.com/vexxhost/atmosphere.common
2026-08-24 20:29:57.503185 | instance | Sibling collection openstack.cloud at /home/zuul/src/opendev.org/openstack/ansible-collections-openstack
2026-08-24 20:29:57.503210 | instance | Resolved ansible.netcommon to 1.2.0 for 1.2.0
2026-08-24 20:29:57.503235 | instance | Resolved ansible.posix to 1.6.0 for 1.6.0
2026-08-24 20:29:57.503260 | instance | Resolved ansible.utils to v6.1.0 for >=2.9.0
2026-08-24 20:29:57.503286 | instance | Resolved community.crypto to 2.2.3 for 2.2.3
2026-08-24 20:29:57.503311 | instance | Resolved community.general to 7.3.0 for 7.3.0
2026-08-24 20:29:57.503336 | instance | Resolved community.mysql to 3.6.0 for 3.6.0
2026-08-24 20:29:57.503362 | instance | Resolved kubernetes.core to 2.4.0 for 2.4.0
2026-08-24 20:29:57.503386 | instance | Resolved openstack.cloud to 2.6.0 for >=2.0.0
2026-08-24 20:29:57.503410 | instance | Resolved vexxhost.ceph to v4.2.0 for >=3.1.2
2026-08-24 20:29:57.503434 | instance | Resolved atmosphere.common to v0.7.0 for >=0.7.0
2026-08-24 20:29:57.503460 | instance | Resolved vexxhost.kubernetes to v3.3.0 for >=3.3.0,>=2.5.0
2026-08-24 20:29:57.503498 | instance | Resolved community.general to 7.3.0 for 7.3.0,>=4.5.0
2026-08-24 20:29:57.503523 | instance | Resolved ansible.utils to v6.1.0 for >=2.9.0,>=6.0.0
2026-08-24 20:29:57.503548 | instance | Resolved vexxhost.containers to v1.6.8 for >=1.1.1,>=1.6.0
2026-08-24 20:29:57.503573 | instance | Resolved kubernetes.core to 2.4.0 for 2.4.0,>=2.4.0,>=2.3.2
2026-08-24 20:29:57.503597 | instance | Resolved vexxhost.kubernetes to v3.3.0 for >=3.3.0,>=2.5.0
2026-08-24 20:29:57.503622 | instance | Resolved ansible.posix to 1.6.0 for 1.6.0,>=1.6.0
2026-08-24 20:29:57.503646 | instance | Resolved community.crypto to 2.2.3 for 2.2.3,>=2.2.3
2026-08-24 20:29:57.503670 | instance | Resolved kubernetes.core to 2.4.0 for 2.4.0,>=2.4.0,>=2.3.2
2026-08-24 20:29:57.503695 | instance | Resolved vexxhost.containers to v1.6.8 for >=1.1.1,>=1.6.0
2026-08-24 20:29:57.503719 | instance | Checked out ansible.netcommon to 1.2.0
2026-08-24 20:29:57.503744 | 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-08-24 20:29:57.503776 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.503801 | instance | Process install dependency map
2026-08-24 20:29:57.503826 | instance | Starting collection install process
2026-08-24 20:29:57.503855 | instance | Installing 'ansible.netcommon:*' to '/home/zuul/.ansible/collections/ansible_collections/ansible/netcommon'
2026-08-24 20:29:57.503879 | instance | Created collection for ansible.netcommon:* at /home/zuul/.ansible/collections/ansible_collections/ansible/netcommon
2026-08-24 20:29:57.503904 | instance | ansible.netcommon:* was installed successfully
2026-08-24 20:29:57.503928 | instance | Using CPython 3.10.12 interpreter at: /usr/bin/python3
2026-08-24 20:29:57.503952 | instance | Creating virtual environment at: .venv
2026-08-24 20:29:57.503976 | instance |    Building atmosphere @ file:///home/zuul/src/github.com/vexxhost/atmosphere
2026-08-24 20:29:57.504002 | instance | Downloading rjsonnet (1.2MiB)
2026-08-24 20:29:57.504028 | instance | Downloading openstacksdk (1.7MiB)
2026-08-24 20:29:57.504061 | instance | Downloading pygments (1.2MiB)
2026-08-24 20:29:57.504081 | instance | Downloading cryptography (4.2MiB)
2026-08-24 20:29:57.504100 | instance | Downloading ansible-core (2.1MiB)
2026-08-24 20:29:57.504118 | instance | Downloading kubernetes (1.9MiB)
2026-08-24 20:29:57.504137 | instance | Downloading setuptools (1.1MiB)
2026-08-24 20:29:57.504155 | instance | Downloading netaddr (2.2MiB)
2026-08-24 20:29:57.504174 | instance |    Building pyperclip==1.9.0
2026-08-24 20:29:57.504192 | instance |  Downloading rjsonnet
2026-08-24 20:29:57.504212 | instance |  Downloading netaddr
2026-08-24 20:29:57.504231 | instance |  Downloading pygments
2026-08-24 20:29:57.504249 | instance |  Downloading cryptography
2026-08-24 20:29:57.504267 | instance |  Downloading setuptools
2026-08-24 20:29:57.504285 | instance |  Downloading kubernetes
2026-08-24 20:29:57.504303 | instance |  Downloading ansible-core
2026-08-24 20:29:57.504321 | instance |  Downloading openstacksdk
2026-08-24 20:29:57.504339 | instance |       Built pyperclip==1.9.0
2026-08-24 20:29:57.504357 | instance |       Built atmosphere @ file:///home/zuul/src/github.com/vexxhost/atmosphere
2026-08-24 20:29:57.504376 | instance | Installed 79 packages in 33ms
2026-08-24 20:29:57.504394 | instance | Checked out ansible.posix to 1.6.0
2026-08-24 20:29:57.504413 | 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-08-24 20:29:57.504431 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.504450 | instance | Process install dependency map
2026-08-24 20:29:57.504468 | instance | Starting collection install process
2026-08-24 20:29:57.504486 | instance | Installing 'ansible.posix:1.6.0' to '/home/zuul/.ansible/collections/ansible_collections/ansible/posix'
2026-08-24 20:29:57.504513 | instance | Created collection for ansible.posix:1.6.0 at /home/zuul/.ansible/collections/ansible_collections/ansible/posix
2026-08-24 20:29:57.504537 | instance | ansible.posix:1.6.0 was installed successfully
2026-08-24 20:29:57.504556 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.504574 | instance | 2.17.12
2026-08-24 20:29:57.504593 | instance | Checked out ansible.utils to v6.1.0
2026-08-24 20:29:57.504612 | 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-08-24 20:29:57.504631 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.504649 | instance | Process install dependency map
2026-08-24 20:29:57.504668 | instance | Starting collection install process
2026-08-24 20:29:57.504686 | instance | Installing 'ansible.utils:6.1.0' to '/home/zuul/.ansible/collections/ansible_collections/ansible/utils'
2026-08-24 20:29:57.504704 | instance | Created collection for ansible.utils:6.1.0 at /home/zuul/.ansible/collections/ansible_collections/ansible/utils
2026-08-24 20:29:57.504723 | instance | ansible.utils:6.1.0 was installed successfully
2026-08-24 20:29:57.504742 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.504761 | instance | 2.17.12
2026-08-24 20:29:57.504780 | instance | Checked out atmosphere.common to v0.7.0
2026-08-24 20:29:57.504799 | 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-08-24 20:29:57.504818 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.504837 | instance | Process install dependency map
2026-08-24 20:29:57.504855 | instance | Starting collection install process
2026-08-24 20:29:57.504873 | instance | Installing 'atmosphere.common:0.7.0' to '/home/zuul/.ansible/collections/ansible_collections/atmosphere/common'
2026-08-24 20:29:57.504892 | instance | Created collection for atmosphere.common:0.7.0 at /home/zuul/.ansible/collections/ansible_collections/atmosphere/common
2026-08-24 20:29:57.504910 | instance | atmosphere.common:0.7.0 was installed successfully
2026-08-24 20:29:57.504929 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.504947 | instance | 2.17.12
2026-08-24 20:29:57.504992 | instance | Checked out community.crypto to 2.2.3
2026-08-24 20:29:57.505014 | 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-08-24 20:29:57.505033 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.505051 | instance | Process install dependency map
2026-08-24 20:29:57.505069 | instance | Starting collection install process
2026-08-24 20:29:57.505087 | instance | Installing 'community.crypto:2.2.3' to '/home/zuul/.ansible/collections/ansible_collections/community/crypto'
2026-08-24 20:29:57.505105 | instance | Created collection for community.crypto:2.2.3 at /home/zuul/.ansible/collections/ansible_collections/community/crypto
2026-08-24 20:29:57.505124 | instance | community.crypto:2.2.3 was installed successfully
2026-08-24 20:29:57.505142 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.505160 | instance | 2.17.12
2026-08-24 20:29:57.505178 | instance | Checked out community.general to 7.3.0
2026-08-24 20:29:57.505196 | 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-08-24 20:29:57.505215 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.505239 | instance | Process install dependency map
2026-08-24 20:29:57.505259 | instance | Starting collection install process
2026-08-24 20:29:57.505278 | instance | Installing 'community.general:7.3.0' to '/home/zuul/.ansible/collections/ansible_collections/community/general'
2026-08-24 20:29:57.505296 | instance | Created collection for community.general:7.3.0 at /home/zuul/.ansible/collections/ansible_collections/community/general
2026-08-24 20:29:57.505314 | instance | community.general:7.3.0 was installed successfully
2026-08-24 20:29:57.505333 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.505351 | instance | 2.17.12
2026-08-24 20:29:57.505370 | instance | Checked out community.mysql to 3.6.0
2026-08-24 20:29:57.505389 | 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-08-24 20:29:57.505408 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.505429 | instance | Process install dependency map
2026-08-24 20:29:57.505448 | instance | Starting collection install process
2026-08-24 20:29:57.505466 | instance | Installing 'community.mysql:3.6.0' to '/home/zuul/.ansible/collections/ansible_collections/community/mysql'
2026-08-24 20:29:57.505485 | instance | Created collection for community.mysql:3.6.0 at /home/zuul/.ansible/collections/ansible_collections/community/mysql
2026-08-24 20:29:57.505503 | instance | community.mysql:3.6.0 was installed successfully
2026-08-24 20:29:57.505522 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.505540 | instance | 2.17.12
2026-08-24 20:29:57.505558 | instance | Checked out kubernetes.core to 2.4.0
2026-08-24 20:29:57.505577 | 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-08-24 20:29:57.505595 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.505613 | instance | Process install dependency map
2026-08-24 20:29:57.505632 | instance | Starting collection install process
2026-08-24 20:29:57.505650 | instance | Installing 'kubernetes.core:2.4.0' to '/home/zuul/.ansible/collections/ansible_collections/kubernetes/core'
2026-08-24 20:29:57.505669 | instance | Created collection for kubernetes.core:2.4.0 at /home/zuul/.ansible/collections/ansible_collections/kubernetes/core
2026-08-24 20:29:57.505687 | instance | kubernetes.core:2.4.0 was installed successfully
2026-08-24 20:29:57.505706 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.505724 | instance | 2.17.12
2026-08-24 20:29:57.505742 | instance | Checked out openstack.cloud to 2.6.0
2026-08-24 20:29:57.505761 | 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-08-24 20:29:57.505779 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.505821 | instance | Process install dependency map
2026-08-24 20:29:57.505845 | instance | Starting collection install process
2026-08-24 20:29:57.505867 | instance | Installing 'openstack.cloud:2.6.0' to '/home/zuul/.ansible/collections/ansible_collections/openstack/cloud'
2026-08-24 20:29:57.505885 | instance | Created collection for openstack.cloud:2.6.0 at /home/zuul/.ansible/collections/ansible_collections/openstack/cloud
2026-08-24 20:29:57.505903 | instance | openstack.cloud:2.6.0 was installed successfully
2026-08-24 20:29:57.505921 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.505939 | instance | 2.17.12
2026-08-24 20:29:57.505958 | instance | Checked out vexxhost.ceph to v4.2.0
2026-08-24 20:29:57.505976 | 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-08-24 20:29:57.506000 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.506019 | instance | Process install dependency map
2026-08-24 20:29:57.506037 | instance | Starting collection install process
2026-08-24 20:29:57.506055 | instance | Installing 'vexxhost.ceph:4.2.0' to '/home/zuul/.ansible/collections/ansible_collections/vexxhost/ceph'
2026-08-24 20:29:57.506074 | instance | Created collection for vexxhost.ceph:4.2.0 at /home/zuul/.ansible/collections/ansible_collections/vexxhost/ceph
2026-08-24 20:29:57.506092 | instance | vexxhost.ceph:4.2.0 was installed successfully
2026-08-24 20:29:57.506110 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.506128 | instance | 2.17.12
2026-08-24 20:29:57.506147 | instance | Checked out vexxhost.containers to v1.6.8
2026-08-24 20:29:57.506165 | 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-08-24 20:29:57.506184 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.506201 | instance | Process install dependency map
2026-08-24 20:29:57.506220 | instance | Starting collection install process
2026-08-24 20:29:57.506239 | instance | Installing 'vexxhost.containers:1.6.8' to '/home/zuul/.ansible/collections/ansible_collections/vexxhost/containers'
2026-08-24 20:29:57.506257 | instance | Created collection for vexxhost.containers:1.6.8 at /home/zuul/.ansible/collections/ansible_collections/vexxhost/containers
2026-08-24 20:29:57.506275 | instance | vexxhost.containers:1.6.8 was installed successfully
2026-08-24 20:29:57.506293 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.506311 | instance | 2.17.12
2026-08-24 20:29:57.506330 | instance | Checked out vexxhost.kubernetes to v3.3.0
2026-08-24 20:29:57.506349 | 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-08-24 20:29:57.506368 | instance | Starting galaxy collection install process
2026-08-24 20:29:57.506387 | instance | Process install dependency map
2026-08-24 20:29:57.506405 | instance | Starting collection install process
2026-08-24 20:29:57.506423 | instance | Installing 'vexxhost.kubernetes:3.3.0' to '/home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes'
2026-08-24 20:29:57.506442 | instance | Created collection for vexxhost.kubernetes:3.3.0 at /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes
2026-08-24 20:29:57.506460 | instance | vexxhost.kubernetes:3.3.0 was installed successfully
2026-08-24 20:29:57.506478 | instance | [WARNING]: Collection ansible.netcommon does not support Ansible version
2026-08-24 20:29:57.506497 | instance | 2.17.12
2026-08-24 20:29:57.512429 | 
2026-08-24 20:29:57.512478 | PLAY RECAP
2026-08-24 20:29:57.512527 | instance | ok: 3 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-08-24 20:29:57.512549 | 
2026-08-24 20:29:57.650567 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main]
2026-08-24 20:29:57.655142 | PRE-RUN START: [untrusted : github.com/vexxhost/atmosphere-zuul-jobs/playbooks/molecule/pre.yml@main]
2026-08-24 20:29:58.310393 | 
2026-08-24 20:29:58.310513 | PLAY [all]
2026-08-24 20:29:58.321230 | 
2026-08-24 20:29:58.321300 | TASK [Install "jq" for log collection]
2026-08-24 20:30:09.492553 | instance | changed
2026-08-24 20:30:09.494449 | 
2026-08-24 20:30:09.494511 | PLAY RECAP
2026-08-24 20:30:09.494563 | instance | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-08-24 20:30:09.494613 | 
2026-08-24 20:30:09.611628 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere-zuul-jobs/playbooks/molecule/pre.yml@main]
2026-08-24 20:30:09.615715 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main]
2026-08-24 20:30:10.257846 | 
2026-08-24 20:30:10.258000 | PLAY [all]
2026-08-24 20:30:10.269928 | 
2026-08-24 20:30:10.270023 | LOOP [Check inventory directories]
2026-08-24 20:30:10.593123 | instance | ok: "src/github.com/vexxhost/atmosphere"
2026-08-24 20:30:10.742822 | instance | ok: "src/github.com/vexxhost/atmosphere/molecule/csi/inventory"
2026-08-24 20:30:10.907403 | instance | ok: "src/github.com/vexxhost/atmosphere/extensions/molecule/csi/inventory"
2026-08-24 20:30:10.928776 | 
2026-08-24 20:30:10.929040 | LOOP [Copy inventory file for Zuul]
2026-08-24 20:30:11.681562 | instance | changed:
2026-08-24 20:30:11.681783 | instance | {
2026-08-24 20:30:11.681812 | instance |   "ansible_loop_var": "item",
2026-08-24 20:30:11.681836 | instance |   "changed": false,
2026-08-24 20:30:11.681856 | instance |   "failed": false,
2026-08-24 20:30:11.681878 | instance |   "invocation": {
2026-08-24 20:30:11.681897 | instance |     "module_args": {
2026-08-24 20:30:11.681916 | instance |       "checksum_algorithm": "sha1",
2026-08-24 20:30:11.681934 | instance |       "follow": true,
2026-08-24 20:30:11.681952 | instance |       "get_attributes": true,
2026-08-24 20:30:11.681971 | instance |       "get_checksum": true,
2026-08-24 20:30:11.681989 | instance |       "get_mime": true,
2026-08-24 20:30:11.682007 | instance |       "path": "src/github.com/vexxhost/atmosphere"
2026-08-24 20:30:11.682026 | instance |     }
2026-08-24 20:30:11.682044 | instance |   },
2026-08-24 20:30:11.682088 | instance |   "item": "src/github.com/vexxhost/atmosphere",
2026-08-24 20:30:11.682107 | instance |   "stat": {
2026-08-24 20:30:11.682124 | instance |     "atime": 1787603390.5735235,
2026-08-24 20:30:11.682142 | instance |     "attr_flags": "e",
2026-08-24 20:30:11.682160 | instance |     "attributes": [
2026-08-24 20:30:11.682177 | instance |       "extents"
2026-08-24 20:30:11.682195 | instance |     ],
2026-08-24 20:30:11.682212 | instance |     "block_size": 4096,
2026-08-24 20:30:11.682230 | instance |     "blocks": 8,
2026-08-24 20:30:11.682248 | instance |     "charset": "unknown",
2026-08-24 20:30:11.682268 | instance |     "ctime": 1787603389.6455543,
2026-08-24 20:30:11.682286 | instance |     "dev": 64513,
2026-08-24 20:30:11.682304 | instance |     "device_type": 0,
2026-08-24 20:30:11.682322 | instance |     "executable": true,
2026-08-24 20:30:11.682339 | instance |     "exists": true,
2026-08-24 20:30:11.682356 | instance |     "gid": 1000,
2026-08-24 20:30:11.682373 | instance |     "gr_name": "zuul",
2026-08-24 20:30:11.682390 | instance |     "inode": 1046399,
2026-08-24 20:30:11.682407 | instance |     "isblk": false,
2026-08-24 20:30:11.682425 | instance |     "ischr": false,
2026-08-24 20:30:11.682442 | instance |     "isdir": true,
2026-08-24 20:30:11.682460 | instance |     "isfifo": false,
2026-08-24 20:30:11.682478 | instance |     "isgid": false,
2026-08-24 20:30:11.682495 | instance |     "islnk": false,
2026-08-24 20:30:11.682512 | instance |     "isreg": false,
2026-08-24 20:30:11.682528 | instance |     "issock": false,
2026-08-24 20:30:11.682545 | instance |     "isuid": false,
2026-08-24 20:30:11.682562 | instance |     "mimetype": "unknown",
2026-08-24 20:30:11.682579 | instance |     "mode": "0755",
2026-08-24 20:30:11.682596 | instance |     "mtime": 1787603389.6455543,
2026-08-24 20:30:11.682613 | instance |     "nlink": 21,
2026-08-24 20:30:11.682631 | instance |     "path": "src/github.com/vexxhost/atmosphere",
2026-08-24 20:30:11.682649 | instance |     "pw_name": "zuul",
2026-08-24 20:30:11.682671 | instance |     "readable": true,
2026-08-24 20:30:11.682688 | instance |     "rgrp": true,
2026-08-24 20:30:11.682706 | instance |     "roth": true,
2026-08-24 20:30:11.682724 | instance |     "rusr": true,
2026-08-24 20:30:11.682742 | instance |     "size": 4096,
2026-08-24 20:30:11.682758 | instance |     "uid": 1000,
2026-08-24 20:30:11.682796 | instance |     "version": "4110579561",
2026-08-24 20:30:11.682815 | instance |     "wgrp": false,
2026-08-24 20:30:11.682834 | instance |     "woth": false,
2026-08-24 20:30:11.682852 | instance |     "writeable": true,
2026-08-24 20:30:11.682870 | instance |     "wusr": true,
2026-08-24 20:30:11.682888 | instance |     "xgrp": true,
2026-08-24 20:30:11.682906 | instance |     "xoth": true,
2026-08-24 20:30:11.682923 | instance |     "xusr": true
2026-08-24 20:30:11.682940 | instance |   }
2026-08-24 20:30:11.682958 | instance | }
2026-08-24 20:30:11.682993 | instance | ok: All items complete
2026-08-24 20:30:11.683015 | 
2026-08-24 20:30:11.684296 | instance | skipping: Conditional result was False
2026-08-24 20:30:11.687242 | instance | skipping: Conditional result was False
2026-08-24 20:30:11.703203 | 
2026-08-24 20:30:11.703395 | LOOP [Switch "ansible_host" to private IP]
2026-08-24 20:30:12.067699 | instance | changed: 1 replacements made
2026-08-24 20:30:12.069644 | instance | skipping: Conditional result was False
2026-08-24 20:30:12.072251 | instance | skipping: Conditional result was False
2026-08-24 20:30:12.089324 | 
2026-08-24 20:30:12.089499 | TASK [Run Molecule scenario]
2026-08-24 20:30:13.084226 | instance | WARNING  Molecule scenarios should migrate to 'extensions/molecule'
2026-08-24 20:30:13.489530 | instance | INFO     [csi > discovery] scenario test matrix: dependency, cleanup, destroy, syntax, create, prepare, converge, idempotence, side_effect, verify, cleanup, destroy
2026-08-24 20:30:13.489618 | instance | INFO     [csi > prerun] Performing prerun with role_name_check=0...
2026-08-24 20:30:23.803862 | instance | INFO     [csi > dependency] Executing
2026-08-24 20:30:23.803992 | instance | WARNING  [csi > dependency] Missing roles requirements file: requirements.yml
2026-08-24 20:30:23.804164 | instance | WARNING  [csi > dependency] Missing collections requirements file: collections.yml
2026-08-24 20:30:23.804286 | instance | WARNING  [csi > dependency] Executed: 2 missing (Remove from test_sequence to suppress)
2026-08-24 20:30:23.813894 | instance | INFO     [csi > cleanup] Executing
2026-08-24 20:30:23.814412 | instance | WARNING  [csi > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress)
2026-08-24 20:30:23.822088 | instance | INFO     [csi > destroy] Executing
2026-08-24 20:30:23.822144 | instance | WARNING  [csi > destroy] Skipping, '--destroy=never' requested.
2026-08-24 20:30:23.822232 | instance | INFO     [csi > destroy] Executed: Successful
2026-08-24 20:30:23.829539 | instance | INFO     [csi > syntax] Executing
2026-08-24 20:30:25.408535 | instance |
2026-08-24 20:30:25.408808 | instance | playbook: /home/zuul/src/github.com/vexxhost/atmosphere/molecule/csi/converge.yml
2026-08-24 20:30:25.473052 | instance | INFO     [csi > syntax] Executed: Successful
2026-08-24 20:30:25.484411 | instance | INFO     [csi > create] Executing
2026-08-24 20:30:25.486156 | instance | WARNING  [csi > create] Executed: Missing playbook (Remove from test_sequence to suppress)
2026-08-24 20:30:25.493394 | instance | INFO     [csi > prepare] Executing
2026-08-24 20:30:26.238108 | instance |
2026-08-24 20:30:26.238348 | instance | PLAY [Prepare] *****************************************************************
2026-08-24 20:30:26.238619 | instance |
2026-08-24 20:30:26.238893 | instance | TASK [Gathering Facts] *********************************************************
2026-08-24 20:30:26.239194 | instance | Monday 24 August 2026  20:30:26 +0000 (0:00:00.023)       0:00:00.023 *********
2026-08-24 20:30:27.359201 | instance | [WARNING]: Platform linux on host instance is using the discovered Python
2026-08-24 20:30:27.359349 | instance | interpreter at /usr/bin/python3.10, but future installation of another Python
2026-08-24 20:30:27.359531 | instance | interpreter could change the meaning of that path. See
2026-08-24 20:30:27.359707 | instance | https://docs.ansible.com/ansible-
2026-08-24 20:30:27.359895 | instance | core/2.17/reference_appendices/interpreter_discovery.html for more information.
2026-08-24 20:30:27.366593 | instance | ok: [instance]
2026-08-24 20:30:27.366732 | instance |
2026-08-24 20:30:27.366894 | instance | TASK [Configure short hostname] ************************************************
2026-08-24 20:30:27.367059 | instance | Monday 24 August 2026  20:30:27 +0000 (0:00:01.129)       0:00:01.153 *********
2026-08-24 20:30:27.989373 | instance | changed: [instance]
2026-08-24 20:30:27.989600 | instance |
2026-08-24 20:30:27.989924 | instance | TASK [Ensure hostname inside hosts file] ***************************************
2026-08-24 20:30:27.990228 | instance | Monday 24 August 2026  20:30:27 +0000 (0:00:00.622)       0:00:01.775 *********
2026-08-24 20:30:28.226661 | instance | [WARNING]: Module remote_tmp /root/.ansible/tmp did not exist and was created
2026-08-24 20:30:28.226935 | instance | with a mode of 0700, this may cause issues when running as another user. To
2026-08-24 20:30:28.227236 | instance | avoid this, create the remote_tmp dir with the correct permissions manually
2026-08-24 20:30:28.236703 | instance | changed: [instance]
2026-08-24 20:30:28.236961 | instance |
2026-08-24 20:30:28.237231 | instance | TASK [Purge "snapd" package] ***************************************************
2026-08-24 20:30:28.237512 | instance | Monday 24 August 2026  20:30:28 +0000 (0:00:00.247)       0:00:02.022 *********
2026-08-24 20:30:28.976548 | instance | ok: [instance]
2026-08-24 20:30:28.976728 | instance |
2026-08-24 20:30:28.976921 | instance | PLAY [Create devices for Ceph] *************************************************
2026-08-24 20:30:28.977104 | instance |
2026-08-24 20:30:28.977278 | instance | TASK [Gathering Facts] *********************************************************
2026-08-24 20:30:28.977461 | instance | Monday 24 August 2026  20:30:28 +0000 (0:00:00.740)       0:00:02.763 *********
2026-08-24 20:30:29.643635 | instance | ok: [instance]
2026-08-24 20:30:29.643837 | instance |
2026-08-24 20:30:29.644085 | instance | TASK [Install depedencies] *****************************************************
2026-08-24 20:30:29.644330 | instance | Monday 24 August 2026  20:30:29 +0000 (0:00:00.666)       0:00:03.429 *********
2026-08-24 20:30:54.864898 | instance | changed: [instance]
2026-08-24 20:30:54.865229 | instance |
2026-08-24 20:30:54.865572 | instance | TASK [Start up service] ********************************************************
2026-08-24 20:30:54.865932 | instance | Monday 24 August 2026  20:30:54 +0000 (0:00:25.221)       0:00:28.651 *********
2026-08-24 20:30:55.392818 | instance | ok: [instance]
2026-08-24 20:30:55.393098 | instance |
2026-08-24 20:30:55.393411 | instance | TASK [Generate lvm.conf] *******************************************************
2026-08-24 20:30:55.393999 | instance | Monday 24 August 2026  20:30:55 +0000 (0:00:00.527)       0:00:29.178 *********
2026-08-24 20:30:55.699098 | instance | ok: [instance]
2026-08-24 20:30:55.699346 | instance |
2026-08-24 20:30:55.699675 | instance | TASK [Write /etc/lvm/lvm.conf] *************************************************
2026-08-24 20:30:55.699948 | instance | Monday 24 August 2026  20:30:55 +0000 (0:00:00.306)       0:00:29.485 *********
2026-08-24 20:30:56.356989 | instance | changed: [instance]
2026-08-24 20:30:56.357061 | instance |
2026-08-24 20:30:56.357193 | instance | TASK [Get list of all loopback devices] ****************************************
2026-08-24 20:30:56.357317 | instance | Monday 24 August 2026  20:30:56 +0000 (0:00:00.657)       0:00:30.142 *********
2026-08-24 20:30:56.541722 | instance | ok: [instance]
2026-08-24 20:30:56.542019 | instance |
2026-08-24 20:30:56.542320 | instance | TASK [Fail if there is any existing loopback devices] **************************
2026-08-24 20:30:56.542627 | instance | Monday 24 August 2026  20:30:56 +0000 (0:00:00.184)       0:00:30.327 *********
2026-08-24 20:30:56.568227 | instance | skipping: [instance]
2026-08-24 20:30:56.568481 | instance |
2026-08-24 20:30:56.568817 | instance | TASK [Create devices for Ceph] *************************************************
2026-08-24 20:30:56.569109 | instance | Monday 24 August 2026  20:30:56 +0000 (0:00:00.026)       0:00:30.354 *********
2026-08-24 20:30:57.098228 | instance | changed: [instance] => (item=osd0)
2026-08-24 20:30:57.098492 | instance | changed: [instance] => (item=osd1)
2026-08-24 20:30:57.098760 | instance | changed: [instance] => (item=osd2)
2026-08-24 20:30:57.099010 | instance |
2026-08-24 20:30:57.099279 | instance | TASK [Set permissions on loopback devices] *************************************
2026-08-24 20:30:57.099502 | instance | Monday 24 August 2026  20:30:57 +0000 (0:00:00.529)       0:00:30.884 *********
2026-08-24 20:30:57.715859 | instance | changed: [instance] => (item=osd0)
2026-08-24 20:30:57.716278 | instance | changed: [instance] => (item=osd1)
2026-08-24 20:30:57.716676 | instance | changed: [instance] => (item=osd2)
2026-08-24 20:30:57.717019 | instance |
2026-08-24 20:30:57.717370 | instance | TASK [Start loop devices] ******************************************************
2026-08-24 20:30:57.717719 | instance | Monday 24 August 2026  20:30:57 +0000 (0:00:00.617)       0:00:31.501 *********
2026-08-24 20:30:58.406709 | instance | changed: [instance] => (item=osd0)
2026-08-24 20:30:58.406964 | instance | changed: [instance] => (item=osd1)
2026-08-24 20:30:58.407124 | instance | changed: [instance] => (item=osd2)
2026-08-24 20:30:58.407273 | instance |
2026-08-24 20:30:58.407431 | instance | TASK [Create a volume group for each loop device] ******************************
2026-08-24 20:30:58.407588 | instance | Monday 24 August 2026  20:30:58 +0000 (0:00:00.690)       0:00:32.192 *********
2026-08-24 20:31:01.580271 | instance | changed: [instance] => (item=osd0)
2026-08-24 20:31:01.580394 | instance | changed: [instance] => (item=osd1)
2026-08-24 20:31:01.580408 | instance | changed: [instance] => (item=osd2)
2026-08-24 20:31:01.580801 | instance |
2026-08-24 20:31:01.580851 | instance | TASK [Create a logical volume for each loop device] ****************************
2026-08-24 20:31:01.580857 | instance | Monday 24 August 2026  20:31:01 +0000 (0:00:03.174)       0:00:35.366 *********
2026-08-24 20:31:03.482130 | instance | changed: [instance] => (item=ceph-instance-osd0)
2026-08-24 20:31:03.482735 | instance | changed: [instance] => (item=ceph-instance-osd1)
2026-08-24 20:31:03.482773 | instance | changed: [instance] => (item=ceph-instance-osd2)
2026-08-24 20:31:03.485357 | instance |
2026-08-24 20:31:03.485435 | instance | PLAY RECAP *********************************************************************
2026-08-24 20:31:03.485444 | instance | instance                   : ok=15   changed=9    unreachable=0    failed=0    skipped=1    rescued=0    ignored=0
2026-08-24 20:31:03.485451 | instance |
2026-08-24 20:31:03.485457 | instance | Monday 24 August 2026  20:31:03 +0000 (0:00:01.901)       0:00:37.268 *********
2026-08-24 20:31:03.485464 | instance | ===============================================================================
2026-08-24 20:31:03.485470 | instance | Install depedencies ---------------------------------------------------- 25.22s
2026-08-24 20:31:03.485476 | instance | Create a volume group for each loop device ------------------------------ 3.17s
2026-08-24 20:31:03.485483 | instance | Create a logical volume for each loop device ---------------------------- 1.90s
2026-08-24 20:31:03.485491 | instance | Gathering Facts --------------------------------------------------------- 1.13s
2026-08-24 20:31:03.485497 | instance | Purge "snapd" package --------------------------------------------------- 0.74s
2026-08-24 20:31:03.485503 | instance | Start loop devices ------------------------------------------------------ 0.69s
2026-08-24 20:31:03.485519 | instance | Gathering Facts --------------------------------------------------------- 0.67s
2026-08-24 20:31:03.485889 | instance | Write /etc/lvm/lvm.conf ------------------------------------------------- 0.66s
2026-08-24 20:31:03.485901 | instance | Configure short hostname ------------------------------------------------ 0.62s
2026-08-24 20:31:03.485910 | instance | Set permissions on loopback devices ------------------------------------- 0.62s
2026-08-24 20:31:03.486101 | instance | Create devices for Ceph ------------------------------------------------- 0.53s
2026-08-24 20:31:03.486335 | instance | Start up service -------------------------------------------------------- 0.53s
2026-08-24 20:31:03.486550 | instance | Generate lvm.conf ------------------------------------------------------- 0.31s
2026-08-24 20:31:03.486764 | instance | Ensure hostname inside hosts file --------------------------------------- 0.25s
2026-08-24 20:31:03.486977 | instance | Get list of all loopback devices ---------------------------------------- 0.18s
2026-08-24 20:31:03.487192 | instance | Fail if there is any existing loopback devices -------------------------- 0.03s
2026-08-24 20:31:03.557712 | instance | INFO     [csi > prepare] Executed: Successful
2026-08-24 20:31:03.570062 | instance | INFO     [csi > converge] Executing
2026-08-24 20:31:05.030769 | instance |
2026-08-24 20:31:05.031152 | instance | PLAY [Debug CSI driver value] **************************************************
2026-08-24 20:31:05.031468 | instance |
2026-08-24 20:31:05.031853 | instance | TASK [Gathering Facts] *********************************************************
2026-08-24 20:31:05.032196 | instance | Monday 24 August 2026  20:31:05 +0000 (0:00:00.007)       0:00:00.007 *********
2026-08-24 20:31:05.957944 | instance | [WARNING]: Platform linux on host instance is using the discovered Python
2026-08-24 20:31:05.958028 | instance | interpreter at /usr/bin/python3.10, but future installation of another Python
2026-08-24 20:31:05.958037 | instance | interpreter could change the meaning of that path. See
2026-08-24 20:31:05.958044 | instance | https://docs.ansible.com/ansible-
2026-08-24 20:31:05.958057 | instance | core/2.17/reference_appendices/interpreter_discovery.html for more information.
2026-08-24 20:31:05.967534 | instance | ok: [instance]
2026-08-24 20:31:05.967773 | instance |
2026-08-24 20:31:05.968040 | instance | TASK [Display CSI driver value and environment variable] ***********************
2026-08-24 20:31:05.968332 | instance | Monday 24 August 2026  20:31:05 +0000 (0:00:00.936)       0:00:00.944 *********
2026-08-24 20:31:06.010134 | instance | ok: [instance] => {
2026-08-24 20:31:06.010427 | instance |     "msg": "csi_driver=rbd, MOLECULE_CSI_DRIVER="
2026-08-24 20:31:06.010689 | instance | }
2026-08-24 20:31:06.010941 | instance |
2026-08-24 20:31:06.011204 | instance | PLAY [all] *********************************************************************
2026-08-24 20:31:06.011444 | instance |
2026-08-24 20:31:06.011707 | instance | TASK [Gathering Facts] *********************************************************
2026-08-24 20:31:06.011973 | instance | Monday 24 August 2026  20:31:06 +0000 (0:00:00.042)       0:00:00.987 *********
2026-08-24 20:31:06.884992 | instance | ok: [instance]
2026-08-24 20:31:06.885090 | instance |
2026-08-24 20:31:06.885382 | instance | TASK [Set a fact with the "atmosphere_images" for other plays] *****************
2026-08-24 20:31:06.885654 | instance | Monday 24 August 2026  20:31:06 +0000 (0:00:00.874)       0:00:01.861 *********
2026-08-24 20:31:07.061221 | instance | ok: [instance]
2026-08-24 20:31:07.061381 | instance |
2026-08-24 20:31:07.061667 | instance | PLAY [Deploy Ceph monitors & managers] *****************************************
2026-08-24 20:31:07.061944 | instance |
2026-08-24 20:31:07.062215 | instance | TASK [Gathering Facts] *********************************************************
2026-08-24 20:31:07.062483 | instance | Monday 24 August 2026  20:31:07 +0000 (0:00:00.176)       0:00:02.038 *********
2026-08-24 20:31:07.941008 | instance | ok: [instance]
2026-08-24 20:31:07.941202 | instance |
2026-08-24 20:31:07.941357 | instance | TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-08-24 20:31:07.941520 | instance | Monday 24 August 2026  20:31:07 +0000 (0:00:00.879)       0:00:02.918 *********
2026-08-24 20:31:08.219607 | instance | ok: [instance]
2026-08-24 20:31:08.219638 | instance |
2026-08-24 20:31:08.219645 | instance | TASK [vexxhost.containers.package : Update state for tar] **********************
2026-08-24 20:31:08.219651 | instance | Monday 24 August 2026  20:31:08 +0000 (0:00:00.278)       0:00:03.196 *********
2026-08-24 20:31:08.265000 | instance | skipping: [instance]
2026-08-24 20:31:08.265027 | instance |
2026-08-24 20:31:08.265032 | instance | TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads)] ***
2026-08-24 20:31:08.265036 | instance | Monday 24 August 2026  20:31:08 +0000 (0:00:00.045)       0:00:03.242 *********
2026-08-24 20:31:08.677024 | instance | changed: [instance]
2026-08-24 20:31:08.677121 | instance |
2026-08-24 20:31:08.677368 | instance | TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-08-24 20:31:08.677383 | instance | Monday 24 August 2026  20:31:08 +0000 (0:00:00.412)       0:00:03.654 *********
2026-08-24 20:31:08.754307 | instance | ok: [instance] => {
2026-08-24 20:31:08.755015 | instance |     "msg": "https://github.com/opencontainers/runc/releases/download/v1.4.2/runc.amd64"
2026-08-24 20:31:08.755030 | instance | }
2026-08-24 20:31:08.755036 | instance |
2026-08-24 20:31:08.755040 | instance | TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-08-24 20:31:08.755045 | instance | Monday 24 August 2026  20:31:08 +0000 (0:00:00.077)       0:00:03.731 *********
2026-08-24 20:31:09.385147 | instance | changed: [instance]
2026-08-24 20:31:09.385883 | instance |
2026-08-24 20:31:09.385899 | instance | TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-08-24 20:31:09.385910 | instance | Monday 24 August 2026  20:31:09 +0000 (0:00:00.630)       0:00:04.362 *********
2026-08-24 20:31:09.429126 | instance | skipping: [instance]
2026-08-24 20:31:09.429273 | instance |
2026-08-24 20:31:09.429287 | instance | TASK [vexxhost.containers.package : Update state for tar] **********************
2026-08-24 20:31:09.429400 | instance | Monday 24 August 2026  20:31:09 +0000 (0:00:00.044)       0:00:04.406 *********
2026-08-24 20:31:09.489603 | instance | skipping: [instance]
2026-08-24 20:31:09.489960 | instance |
2026-08-24 20:31:09.490032 | instance | TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-08-24 20:31:09.490209 | instance | Monday 24 August 2026  20:31:09 +0000 (0:00:00.059)       0:00:04.466 *********
2026-08-24 20:31:09.702072 | instance | ok: [instance]
2026-08-24 20:31:09.702202 | instance |
2026-08-24 20:31:09.702220 | instance | TASK [vexxhost.containers.package : Update state for tar] **********************
2026-08-24 20:31:09.702377 | instance | Monday 24 August 2026  20:31:09 +0000 (0:00:00.212)       0:00:04.679 *********
2026-08-24 20:31:10.857036 | instance | ok: [instance]
2026-08-24 20:31:10.857100 | instance |
2026-08-24 20:31:10.857362 | instance | TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-08-24 20:31:10.857402 | instance | Monday 24 August 2026  20:31:10 +0000 (0:00:01.155)       0:00:05.834 *********
2026-08-24 20:31:10.920467 | instance | ok: [instance] => {
2026-08-24 20:31:10.920533 | instance |     "msg": "https://github.com/containerd/containerd/releases/download/v2.3.2/containerd-2.3.2-linux-amd64.tar.gz"
2026-08-24 20:31:10.921013 | instance | }
2026-08-24 20:31:10.921031 | instance |
2026-08-24 20:31:10.921037 | instance | TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-08-24 20:31:10.921041 | instance | Monday 24 August 2026  20:31:10 +0000 (0:00:00.063)       0:00:05.897 *********
2026-08-24 20:31:11.614471 | instance | changed: [instance]
2026-08-24 20:31:11.614534 | instance |
2026-08-24 20:31:11.614827 | instance | TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-08-24 20:31:11.614969 | instance | Monday 24 August 2026  20:31:11 +0000 (0:00:00.693)       0:00:06.591 *********
2026-08-24 20:31:14.468690 | instance | changed: [instance]
2026-08-24 20:31:14.468873 | instance |
2026-08-24 20:31:14.469182 | instance | TASK [vexxhost.containers.containerd : Install SELinux packages] ***************
2026-08-24 20:31:14.469229 | instance | Monday 24 August 2026  20:31:14 +0000 (0:00:02.854)       0:00:09.445 *********
2026-08-24 20:31:14.496730 | instance | skipping: [instance]
2026-08-24 20:31:14.496803 | instance |
2026-08-24 20:31:14.497099 | instance | TASK [vexxhost.containers.containerd : Set SELinux to permissive at runtime] ***
2026-08-24 20:31:14.497140 | instance | Monday 24 August 2026  20:31:14 +0000 (0:00:00.028)       0:00:09.473 *********
2026-08-24 20:31:14.533902 | instance | skipping: [instance]
2026-08-24 20:31:14.534842 | instance |
2026-08-24 20:31:14.535013 | instance | TASK [vexxhost.containers.containerd : Persist SELinux permissive mode] ********
2026-08-24 20:31:14.535023 | instance | Monday 24 August 2026  20:31:14 +0000 (0:00:00.036)       0:00:09.510 *********
2026-08-24 20:31:14.562833 | instance | skipping: [instance]
2026-08-24 20:31:14.562937 | instance |
2026-08-24 20:31:14.563179 | instance | TASK [vexxhost.containers.containerd : Install AppArmor packages] **************
2026-08-24 20:31:14.563229 | instance | Monday 24 August 2026  20:31:14 +0000 (0:00:00.029)       0:00:09.539 *********
2026-08-24 20:31:27.602060 | instance | changed: [instance]
2026-08-24 20:31:27.602189 | instance |
2026-08-24 20:31:27.602246 | instance | TASK [vexxhost.containers.containerd : Create systemd service file for containerd] ***
2026-08-24 20:31:27.602423 | instance | Monday 24 August 2026  20:31:27 +0000 (0:00:13.039)       0:00:22.579 *********
2026-08-24 20:31:28.203413 | instance | changed: [instance]
2026-08-24 20:31:28.203480 | instance |
2026-08-24 20:31:28.203783 | instance | TASK [vexxhost.containers.containerd : Create folders for configuration] *******
2026-08-24 20:31:28.203825 | instance | Monday 24 August 2026  20:31:28 +0000 (0:00:00.601)       0:00:23.180 *********
2026-08-24 20:31:29.140292 | instance | changed: [instance] => (item={'path': '/etc/containerd'})
2026-08-24 20:31:29.140372 | instance | changed: [instance] => (item={'path': '/var/lib/containerd', 'mode': '0o700'})
2026-08-24 20:31:29.141107 | instance | changed: [instance] => (item={'path': '/run/containerd', 'mode': '0o711'})
2026-08-24 20:31:29.141254 | instance | changed: [instance] => (item={'path': '/run/containerd/io.containerd.grpc.v1.cri', 'mode': '0o700'})
2026-08-24 20:31:29.141286 | instance | changed: [instance] => (item={'path': '/run/containerd/io.containerd.sandbox.controller.v1.shim', 'mode': '0o700'})
2026-08-24 20:31:29.141292 | instance |
2026-08-24 20:31:29.141301 | instance | TASK [vexxhost.containers.containerd : Create containerd config file] **********
2026-08-24 20:31:29.141305 | instance | Monday 24 August 2026  20:31:29 +0000 (0:00:00.936)       0:00:24.117 *********
2026-08-24 20:31:29.714547 | instance | changed: [instance]
2026-08-24 20:31:29.714618 | instance |
2026-08-24 20:31:29.714754 | instance | TASK [vexxhost.containers.containerd : Force any restarts if necessary] ********
2026-08-24 20:31:29.714882 | instance | Monday 24 August 2026  20:31:29 +0000 (0:00:00.557)       0:00:24.674 *********
2026-08-24 20:31:29.714993 | instance |
2026-08-24 20:31:29.715123 | instance | RUNNING HANDLER [vexxhost.containers.containerd : Reload systemd] **************
2026-08-24 20:31:29.715247 | instance | Monday 24 August 2026  20:31:29 +0000 (0:00:00.017)       0:00:24.691 *********
2026-08-24 20:31:30.641521 | instance | ok: [instance]
2026-08-24 20:31:30.641624 | instance |
2026-08-24 20:31:30.641771 | instance | RUNNING HANDLER [vexxhost.containers.containerd : Restart containerd] **********
2026-08-24 20:31:30.641941 | instance | Monday 24 August 2026  20:31:30 +0000 (0:00:00.927)       0:00:25.618 *********
2026-08-24 20:31:31.082338 | instance | changed: [instance]
2026-08-24 20:31:31.082450 | instance |
2026-08-24 20:31:31.082636 | instance | TASK [vexxhost.containers.containerd : Enable and start service] ***************
2026-08-24 20:31:31.082811 | instance | Monday 24 August 2026  20:31:31 +0000 (0:00:00.440)       0:00:26.058 *********
2026-08-24 20:31:31.655118 | instance | changed: [instance]
2026-08-24 20:31:31.655191 | instance |
2026-08-24 20:31:31.655202 | instance | TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-08-24 20:31:31.655213 | instance | Monday 24 August 2026  20:31:31 +0000 (0:00:00.571)       0:00:26.630 *********
2026-08-24 20:31:31.880101 | instance | ok: [instance]
2026-08-24 20:31:31.880179 | instance |
2026-08-24 20:31:31.880454 | instance | TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-08-24 20:31:31.880493 | instance | Monday 24 August 2026  20:31:31 +0000 (0:00:00.226)       0:00:26.857 *********
2026-08-24 20:31:31.946182 | instance | ok: [instance] => {
2026-08-24 20:31:31.946810 | instance |     "msg": "https://download.docker.com/linux/static/stable/x86_64/docker-24.0.9.tgz"
2026-08-24 20:31:31.946849 | instance | }
2026-08-24 20:31:31.946856 | instance |
2026-08-24 20:31:31.946860 | instance | TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-08-24 20:31:31.946864 | instance | Monday 24 August 2026  20:31:31 +0000 (0:00:00.065)       0:00:26.923 *********
2026-08-24 20:31:32.763955 | instance | changed: [instance]
2026-08-24 20:31:32.764056 | instance |
2026-08-24 20:31:32.764325 | instance | TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-08-24 20:31:32.764383 | instance | Monday 24 August 2026  20:31:32 +0000 (0:00:00.817)       0:00:27.741 *********
2026-08-24 20:31:37.140879 | instance | changed: [instance]
2026-08-24 20:31:37.140951 | instance |
2026-08-24 20:31:37.141265 | instance | TASK [vexxhost.containers.docker : Install AppArmor packages] ******************
2026-08-24 20:31:37.141331 | instance | Monday 24 August 2026  20:31:37 +0000 (0:00:04.376)       0:00:32.117 *********
2026-08-24 20:31:38.446230 | instance | ok: [instance]
2026-08-24 20:31:38.446340 | instance |
2026-08-24 20:31:38.446630 | instance | TASK [vexxhost.containers.docker : Ensure group "docker" exists] ***************
2026-08-24 20:31:38.446683 | instance | Monday 24 August 2026  20:31:38 +0000 (0:00:01.305)       0:00:33.423 *********
2026-08-24 20:31:38.802716 | instance | changed: [instance]
2026-08-24 20:31:38.802792 | instance |
2026-08-24 20:31:38.803119 | instance | TASK [vexxhost.containers.docker : Create systemd service file for docker] *****
2026-08-24 20:31:38.803185 | instance | Monday 24 August 2026  20:31:38 +0000 (0:00:00.356)       0:00:33.779 *********
2026-08-24 20:31:39.277640 | instance | changed: [instance]
2026-08-24 20:31:39.277723 | instance |
2026-08-24 20:31:39.277965 | instance | TASK [vexxhost.containers.docker : Create folders for configuration] ***********
2026-08-24 20:31:39.278041 | instance | Monday 24 August 2026  20:31:39 +0000 (0:00:00.475)       0:00:34.254 *********
2026-08-24 20:31:39.829815 | instance | changed: [instance] => (item={'path': '/etc/docker'})
2026-08-24 20:31:39.830715 | instance | changed: [instance] => (item={'path': '/var/lib/docker', 'mode': '0o710'})
2026-08-24 20:31:39.830773 | instance | changed: [instance] => (item={'path': '/run/docker', 'mode': '0o711'})
2026-08-24 20:31:39.830781 | instance |
2026-08-24 20:31:39.830788 | instance | TASK [vexxhost.containers.docker : Create systemd socket file for docker] ******
2026-08-24 20:31:39.830794 | instance | Monday 24 August 2026  20:31:39 +0000 (0:00:00.551)       0:00:34.806 *********
2026-08-24 20:31:40.305681 | instance | changed: [instance]
2026-08-24 20:31:40.306089 | instance |
2026-08-24 20:31:40.306153 | instance | TASK [vexxhost.containers.docker : Create docker daemon config file] ***********
2026-08-24 20:31:40.306268 | instance | Monday 24 August 2026  20:31:40 +0000 (0:00:00.476)       0:00:35.282 *********
2026-08-24 20:31:40.764955 | instance | changed: [instance]
2026-08-24 20:31:40.765018 | instance |
2026-08-24 20:31:40.765648 | instance | TASK [vexxhost.containers.docker : Force any restarts if necessary] ************
2026-08-24 20:31:40.765687 | instance | Monday 24 August 2026  20:31:40 +0000 (0:00:00.442)       0:00:35.725 *********
2026-08-24 20:31:40.765692 | instance |
2026-08-24 20:31:40.765697 | instance | RUNNING HANDLER [vexxhost.containers.containerd : Reload systemd] **************
2026-08-24 20:31:40.765702 | instance | Monday 24 August 2026  20:31:40 +0000 (0:00:00.016)       0:00:35.742 *********
2026-08-24 20:31:41.492390 | instance | ok: [instance]
2026-08-24 20:31:41.492496 | instance |
2026-08-24 20:31:41.492772 | instance | RUNNING HANDLER [vexxhost.containers.docker : Restart docker] ******************
2026-08-24 20:31:41.492817 | instance | Monday 24 August 2026  20:31:41 +0000 (0:00:00.727)       0:00:36.469 *********
2026-08-24 20:31:42.386380 | instance | changed: [instance]
2026-08-24 20:31:42.386519 | instance |
2026-08-24 20:31:42.386531 | instance | TASK [vexxhost.containers.docker : Enable and start service] *******************
2026-08-24 20:31:42.386682 | instance | Monday 24 August 2026  20:31:42 +0000 (0:00:00.893)       0:00:37.363 *********
2026-08-24 20:31:42.946598 | instance | changed: [instance]
2026-08-24 20:31:42.946676 | instance |
2026-08-24 20:31:42.946938 | instance | TASK [vexxhost.ceph.cephadm : Gather variables for each operating system] ******
2026-08-24 20:31:42.946973 | instance | Monday 24 August 2026  20:31:42 +0000 (0:00:00.560)       0:00:37.923 *********
2026-08-24 20:31:43.000235 | instance | ok: [instance] => (item=/home/zuul/.ansible/collections/ansible_collections/vexxhost/ceph/roles/cephadm/vars/ubuntu-22.04.yml)
2026-08-24 20:31:43.000651 | instance |
2026-08-24 20:31:43.000689 | instance | TASK [vexxhost.ceph.cephadm : Install packages] ********************************
2026-08-24 20:31:43.000695 | instance | Monday 24 August 2026  20:31:42 +0000 (0:00:00.053)       0:00:37.977 *********
2026-08-24 20:31:48.376637 | instance | changed: [instance]
2026-08-24 20:31:48.376675 | instance |
2026-08-24 20:31:48.376680 | instance | TASK [vexxhost.ceph.cephadm : Ensure services are started] *********************
2026-08-24 20:31:48.376685 | instance | Monday 24 August 2026  20:31:48 +0000 (0:00:05.376)       0:00:43.353 *********
2026-08-24 20:31:49.002920 | instance | ok: [instance] => (item=chronyd)
2026-08-24 20:31:49.002989 | instance | ok: [instance] => (item=sshd)
2026-08-24 20:31:49.003412 | instance |
2026-08-24 20:31:49.003451 | instance | TASK [vexxhost.ceph.cephadm : Download "cephadm"] ******************************
2026-08-24 20:31:49.003457 | instance | Monday 24 August 2026  20:31:48 +0000 (0:00:00.626)       0:00:43.980 *********
2026-08-24 20:31:50.063990 | instance | changed: [instance]
2026-08-24 20:31:50.064065 | instance |
2026-08-24 20:31:50.064291 | instance | TASK [vexxhost.ceph.cephadm : Remove cephadm from old path] ********************
2026-08-24 20:31:50.064330 | instance | Monday 24 August 2026  20:31:50 +0000 (0:00:01.060)       0:00:45.041 *********
2026-08-24 20:31:50.274565 | instance | ok: [instance]
2026-08-24 20:31:50.274637 | instance |
2026-08-24 20:31:50.274927 | instance | TASK [vexxhost.ceph.cephadm : Ensure "cephadm" user is present] ****************
2026-08-24 20:31:50.274960 | instance | Monday 24 August 2026  20:31:50 +0000 (0:00:00.210)       0:00:45.251 *********
2026-08-24 20:31:50.717569 | instance | changed: [instance]
2026-08-24 20:31:50.717642 | instance |
2026-08-24 20:31:50.717940 | instance | TASK [vexxhost.ceph.cephadm : Allow "cephadm" user to have passwordless sudo] ***
2026-08-24 20:31:50.718002 | instance | Monday 24 August 2026  20:31:50 +0000 (0:00:00.443)       0:00:45.694 *********
2026-08-24 20:31:51.066789 | instance | changed: [instance]
2026-08-24 20:31:51.066885 | instance |
2026-08-24 20:31:51.067154 | instance | TASK [vexxhost.ceph.mon : Set Ceph Monitor IP address] *************************
2026-08-24 20:31:51.067193 | instance | Monday 24 August 2026  20:31:51 +0000 (0:00:00.349)       0:00:46.044 *********
2026-08-24 20:31:51.176282 | instance | ok: [instance]
2026-08-24 20:31:51.176351 | instance |
2026-08-24 20:31:51.176601 | instance | TASK [vexxhost.ceph.mon : Check if any node is bootstrapped] *******************
2026-08-24 20:31:51.176623 | instance | Monday 24 August 2026  20:31:51 +0000 (0:00:00.109)       0:00:46.153 *********
2026-08-24 20:31:51.386543 | instance | ok: [instance] => (item=instance)
2026-08-24 20:31:51.386642 | instance |
2026-08-24 20:31:51.386963 | instance | TASK [vexxhost.ceph.mon : Select pre-existing bootstrap node if exists] ********
2026-08-24 20:31:51.387031 | instance | Monday 24 August 2026  20:31:51 +0000 (0:00:00.209)       0:00:46.363 *********
2026-08-24 20:31:51.438816 | instance | ok: [instance]
2026-08-24 20:31:51.438935 | instance |
2026-08-24 20:31:51.439003 | instance | TASK [vexxhost.ceph.mon : Bootstrap cluster] ***********************************
2026-08-24 20:31:51.439179 | instance | Monday 24 August 2026  20:31:51 +0000 (0:00:00.052)       0:00:46.415 *********
2026-08-24 20:31:51.516256 | instance | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/ceph/roles/mon/tasks/bootstrap-ceph.yml for instance
2026-08-24 20:31:51.516721 | instance |
2026-08-24 20:31:51.516746 | instance | TASK [vexxhost.ceph.mon : Generate temporary file for "ceph.conf"] *************
2026-08-24 20:31:51.516760 | instance | Monday 24 August 2026  20:31:51 +0000 (0:00:00.077)       0:00:46.492 *********
2026-08-24 20:31:51.838029 | instance | changed: [instance]
2026-08-24 20:31:51.838159 | instance |
2026-08-24 20:31:51.838503 | instance | TASK [vexxhost.ceph.mon : Include extra configuration values] ******************
2026-08-24 20:31:51.838563 | instance | Monday 24 August 2026  20:31:51 +0000 (0:00:00.321)       0:00:46.814 *********
2026-08-24 20:31:52.498220 | instance | changed: [instance] => (item={'option': 'mon allow pool size one', 'section': 'global', 'value': True})
2026-08-24 20:31:52.499091 | instance | changed: [instance] => (item={'option': 'osd crush chooseleaf type', 'section': 'global', 'value': 0})
2026-08-24 20:31:52.499141 | instance | changed: [instance] => (item={'option': 'auth allow insecure global id reclaim', 'section': 'mon', 'value': False})
2026-08-24 20:31:52.499148 | instance |
2026-08-24 20:31:52.499155 | instance | TASK [vexxhost.ceph.mon : Run Bootstrap command] *******************************
2026-08-24 20:31:52.499161 | instance | Monday 24 August 2026  20:31:52 +0000 (0:00:00.660)       0:00:47.475 *********
2026-08-24 20:33:14.682882 | instance | ok: [instance]
2026-08-24 20:33:14.682953 | instance |
2026-08-24 20:33:14.683148 | instance | TASK [vexxhost.ceph.mon : Remove temporary file for "ceph.conf"] ***************
2026-08-24 20:33:14.683282 | instance | Monday 24 August 2026  20:33:14 +0000 (0:01:22.184)       0:02:09.659 *********
2026-08-24 20:33:14.894614 | instance | changed: [instance]
2026-08-24 20:33:14.894689 | instance |
2026-08-24 20:33:14.894960 | instance | TASK [vexxhost.ceph.mon : Set bootstrap node] **********************************
2026-08-24 20:33:14.894999 | instance | Monday 24 August 2026  20:33:14 +0000 (0:00:00.211)       0:02:09.871 *********
2026-08-24 20:33:14.973276 | instance | ok: [instance]
2026-08-24 20:33:14.973543 | instance |
2026-08-24 20:33:14.973742 | instance | TASK [Install Ceph host] *******************************************************
2026-08-24 20:33:14.974000 | instance | Monday 24 August 2026  20:33:14 +0000 (0:00:00.078)       0:02:09.950 *********
2026-08-24 20:33:15.052069 | instance | included: vexxhost.ceph.cephadm_host for instance
2026-08-24 20:33:15.052134 | instance |
2026-08-24 20:33:15.052429 | instance | TASK [vexxhost.ceph.cephadm_host : Get public SSH key for "cephadm" user] ******
2026-08-24 20:33:15.052462 | instance | Monday 24 August 2026  20:33:15 +0000 (0:00:00.079)       0:02:10.029 *********
2026-08-24 20:33:16.623709 | instance | ok: [instance]
2026-08-24 20:33:16.623788 | instance |
2026-08-24 20:33:16.623892 | instance | TASK [vexxhost.ceph.cephadm_host : Set fact with public SSH key for "cephadm" user] ***
2026-08-24 20:33:16.624015 | instance | Monday 24 August 2026  20:33:16 +0000 (0:00:01.571)       0:02:11.601 *********
2026-08-24 20:33:16.676789 | instance | ok: [instance] => (item=instance)
2026-08-24 20:33:16.676871 | instance |
2026-08-24 20:33:16.676997 | instance | TASK [vexxhost.ceph.cephadm_host : Set authorized key for "cephadm"] ***********
2026-08-24 20:33:16.677116 | instance | Monday 24 August 2026  20:33:16 +0000 (0:00:00.053)       0:02:11.654 *********
2026-08-24 20:33:17.016927 | instance | ok: [instance]
2026-08-24 20:33:17.017023 | instance |
2026-08-24 20:33:17.017153 | instance | TASK [vexxhost.ceph.cephadm_host : Add new host to Ceph] ***********************
2026-08-24 20:33:17.017281 | instance | Monday 24 August 2026  20:33:17 +0000 (0:00:00.339)       0:02:11.994 *********
2026-08-24 20:33:19.293038 | instance | ok: [instance]
2026-08-24 20:33:19.293129 | instance |
2026-08-24 20:33:19.293365 | instance | TASK [vexxhost.ceph.mon : Configure "mon" label for monitors] ******************
2026-08-24 20:33:19.293408 | instance | Monday 24 August 2026  20:33:19 +0000 (0:00:02.276)       0:02:14.270 *********
2026-08-24 20:34:02.826010 | instance | An exception occurred during task execution. To see the full traceback, use -vvv. The error was: [errno 5] RADOS I/O error (error connecting to the cluster)
2026-08-24 20:34:02.826904 | instance | fatal: [instance]: FAILED! => {"changed": false, "module_stderr": "Traceback (most recent call last):\n  File \"<stdin>\", line 107, in <module>\n  File \"<stdin>\", line 99, in _ansiballz_main\n  File \"<stdin>\", line 47, in invoke_module\n  File \"/usr/lib/python3.10/runpy.py\", line 224, in run_module\n    return _run_module_code(code, init_globals, run_name, mod_spec)\n  File \"/usr/lib/python3.10/runpy.py\", line 96, in _run_module_code\n    _run_code(code, mod_globals, init_globals,\n  File \"/usr/lib/python3.10/runpy.py\", line 86, in _run_code\n    exec(code, run_globals)\n  File \"/tmp/ansible_vexxhost.ceph.orch_apply_payload_ydones55/ansible_vexxhost.ceph.orch_apply_payload.zip/ansible_collections/vexxhost/ceph/plugins/modules/orch_apply.py\", line 202, in <module>\n  File \"/tmp/ansible_vexxhost.ceph.orch_apply_payload_ydones55/ansible_vexxhost.ceph.orch_apply_payload.zip/ansible_collections/vexxhost/ceph/plugins/modules/orch_apply.py\", line 198, in main\n  File \"/tmp/ansible_vexxhost.ceph.orch_apply_payload_ydones55/ansible_vexxhost.ceph.orch_apply_payload.zip/ansible_collections/vexxhost/ceph/plugins/modules/orch_apply.py\", line 177, in run_module\n  File \"/tmp/ansible_vexxhost.ceph.orch_apply_payload_ydones55/ansible_vexxhost.ceph.orch_apply_payload.zip/ansible_collections/vexxhost/ceph/plugins/modules/orch_apply.py\", line 120, in apply_spec\nRuntimeError: Inferring config /var/lib/ceph/4837cbf8-4f90-4300-b3f6-726c9b9f89b4/mon.instance/config\n2026-08-24T20:34:02.672+0000 7efca3144640 -1 auth: error parsing file /etc/ceph/ceph.keyring: error setting modifier for [client.admin] type=key val=AgBhqoxqfMgGMiAADLQyVLyPEb67npUfrI2wHk1okosC2ZWjXqFdVL3pzxY=: Malformed input [buffer:3]\n2026-08-24T20:34:02.672+0000 7efca3144640 -1 auth: failed to load /etc/ceph/ceph.keyring: (5) Input/output error\n2026-08-24T20:34:02.676+0000 7efca3144640 -1 auth: error parsing file /etc/ceph/ceph.keyring: error setting modifier for [client.admin] type=key val=AgBhqoxqfMgGMiAADLQyVLyPEb67npUfrI2wHk1okosC2ZWjXqFdVL3pzxY=: Malformed input [buffer:3]\n2026-08-24T20:34:02.676+0000 7efca3144640 -1 auth: failed to load /etc/ceph/ceph.keyring: (5) Input/output error\n2026-08-24T20:34:02.676+0000 7efca3144640 -1 auth: error parsing file /etc/ceph/ceph.keyring: error setting modifier for [client.admin] type=key val=AgBhqoxqfMgGMiAADLQyVLyPEb67npUfrI2wHk1okosC2ZWjXqFdVL3pzxY=: Malformed input [buffer:3]\n2026-08-24T20:34:02.676+0000 7efca3144640 -1 auth: failed to load /etc/ceph/ceph.keyring: (5) Input/output error\n2026-08-24T20:34:02.676+0000 7efca3144640 -1 monclient: keyring not found\n[errno 5] RADOS I/O error (error connecting to the cluster)\n\n", "module_stdout": "", "msg": "MODULE FAILURE\nSee stdout/stderr for the exact error", "rc": 1}
2026-08-24 20:34:02.830240 | instance |
2026-08-24 20:34:02.833891 | instance | PLAY RECAP *********************************************************************
2026-08-24 20:34:02.833929 | instance | instance                   : ok=55   changed=26   unreachable=0    failed=1    skipped=6    rescued=0    ignored=0
2026-08-24 20:34:02.833942 | instance |
2026-08-24 20:34:02.833953 | instance | Monday 24 August 2026  20:34:02 +0000 (0:00:43.537)       0:02:57.807 *********
2026-08-24 20:34:02.833963 | instance | ===============================================================================
2026-08-24 20:34:02.833973 | instance | vexxhost.ceph.mon : Run Bootstrap command ------------------------------ 82.18s
2026-08-24 20:34:02.833983 | instance | vexxhost.ceph.mon : Configure "mon" label for monitors ----------------- 43.54s
2026-08-24 20:34:02.833993 | instance | vexxhost.containers.containerd : Install AppArmor packages ------------- 13.04s
2026-08-24 20:34:02.834002 | instance | vexxhost.ceph.cephadm : Install packages -------------------------------- 5.38s
2026-08-24 20:34:02.834012 | instance | vexxhost.containers.download_artifact : Extract archive ----------------- 4.38s
2026-08-24 20:34:02.834022 | instance | vexxhost.containers.download_artifact : Extract archive ----------------- 2.85s
2026-08-24 20:34:02.834031 | instance | vexxhost.ceph.cephadm_host : Add new host to Ceph ----------------------- 2.28s
2026-08-24 20:34:02.834046 | instance | vexxhost.containers.containerd : Reload systemd ------------------------- 1.65s
2026-08-24 20:34:02.834264 | instance | vexxhost.ceph.cephadm_host : Get public SSH key for "cephadm" user ------ 1.57s
2026-08-24 20:34:02.834665 | instance | vexxhost.containers.docker : Install AppArmor packages ------------------ 1.31s
2026-08-24 20:34:02.835004 | instance | vexxhost.containers.package : Update state for tar ---------------------- 1.16s
2026-08-24 20:34:02.835337 | instance | vexxhost.ceph.cephadm : Download "cephadm" ------------------------------ 1.06s
2026-08-24 20:34:02.835687 | instance | Gathering Facts --------------------------------------------------------- 0.94s
2026-08-24 20:34:02.836029 | instance | vexxhost.containers.containerd : Create folders for configuration ------- 0.94s
2026-08-24 20:34:02.836363 | instance | vexxhost.containers.docker : Restart docker ----------------------------- 0.89s
2026-08-24 20:34:02.836712 | instance | Gathering Facts --------------------------------------------------------- 0.88s
2026-08-24 20:34:02.837048 | instance | Gathering Facts --------------------------------------------------------- 0.87s
2026-08-24 20:34:02.837381 | instance | vexxhost.containers.download_artifact : Download item ------------------- 0.82s
2026-08-24 20:34:02.837800 | instance | vexxhost.containers.download_artifact : Download item ------------------- 0.69s
2026-08-24 20:34:02.838199 | instance | vexxhost.ceph.mon : Include extra configuration values ------------------ 0.66s
2026-08-24 20:34:02.930668 | instance | CRITICAL Ansible return code was 2, command was: ansible-playbook --inventory /home/zuul/.ansible/tmp/molecule.v9Wo.csi/inventory --skip-tags molecule-notest,notest --inventory=/home/zuul/src/github.com/vexxhost/atmosphere/inventory.yaml /home/zuul/src/github.com/vexxhost/atmosphere/molecule/csi/converge.yml
2026-08-24 20:34:02.930978 | instance | ERROR    [csi > converge] Executed: Failed
2026-08-24 20:34:02.931191 | instance | ERROR    Ansible return code was 2, command was: ansible-playbook --inventory /home/zuul/.ansible/tmp/molecule.v9Wo.csi/inventory --skip-tags molecule-notest,notest --inventory=/home/zuul/src/github.com/vexxhost/atmosphere/inventory.yaml /home/zuul/src/github.com/vexxhost/atmosphere/molecule/csi/converge.yml
2026-08-24 20:34:03.446199 | instance | ERROR
2026-08-24 20:34:03.446378 | instance | {
2026-08-24 20:34:03.446414 | instance |   "delta": "0:03:50.547396",
2026-08-24 20:34:03.446436 | instance |   "end": "2026-08-24 20:34:02.981374",
2026-08-24 20:34:03.446455 | instance |   "msg": "non-zero return code",
2026-08-24 20:34:03.446473 | instance |   "rc": 2,
2026-08-24 20:34:03.446491 | instance |   "start": "2026-08-24 20:30:12.433978"
2026-08-24 20:34:03.446508 | instance | }
failure
2026-08-24 20:34:03.451240 | 
2026-08-24 20:34:03.451290 | PLAY RECAP
2026-08-24 20:34:03.451335 | instance | ok: 3 changed: 2 unreachable: 0 failed: 1 skipped: 0 rescued: 0 ignored: 0
2026-08-24 20:34:03.451359 | 
2026-08-24 20:34:03.746684 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main]
2026-08-24 20:34:04.008182 | POST-RUN START: [untrusted : github.com/vexxhost/atmosphere-zuul-jobs/playbooks/molecule/post.yml@main]
2026-08-24 20:34:07.613596 | 
2026-08-24 20:34:07.613730 | PLAY [all]
2026-08-24 20:34:07.653195 | 
2026-08-24 20:34:08.342509 | TASK [gather-host-logs : creating directory for system status]
2026-08-24 20:34:08.668534 | instance | changed
2026-08-24 20:34:08.674278 | 
2026-08-24 20:34:08.674370 | TASK [gather-host-logs : Get logs for each host]
2026-08-24 20:34:09.028237 | instance | + systemd-cgls --full --all --no-pager
2026-08-24 20:34:09.042471 | instance | + ip addr
2026-08-24 20:34:09.045334 | instance | + ip route
2026-08-24 20:34:09.047605 | instance | + lsblk
2026-08-24 20:34:09.050634 | instance | + mount
2026-08-24 20:34:09.052902 | instance | + docker images
2026-08-24 20:34:09.076565 | instance | + brctl show
2026-08-24 20:34:09.076967 | instance | /bin/bash: line 8: brctl: command not found
2026-08-24 20:34:09.077176 | instance | + ps aux --sort=-%mem
2026-08-24 20:34:09.092809 | instance | + dpkg -l
2026-08-24 20:34:09.102487 | instance | + CONTAINERS=($(docker ps -a --format '{{ .Names }}' --filter label=zuul))
2026-08-24 20:34:09.103058 | instance | ++ docker ps -a --format '{{ .Names }}' --filter label=zuul
2026-08-24 20:34:09.119526 | instance | + '[' '!' -z '' ']'
2026-08-24 20:34:09.212287 | instance | ok: Runtime: 0:00:00.095698
2026-08-24 20:34:09.220631 | 
2026-08-24 20:34:09.220721 | TASK [gather-host-logs : Downloads logs to executor]
2026-08-24 20:34:09.952375 | instance | changed:
2026-08-24 20:34:09.952609 | instance | created directory /var/lib/zuul/builds/02d23b833fa24a6db7c8f5ff63efdb8b/work/logs/instance
2026-08-24 20:34:09.952652 | instance | cd+++++++++ system/
2026-08-24 20:34:09.952684 | instance | >f+++++++++ system/brctl-show.txt
2026-08-24 20:34:09.952714 | instance | >f+++++++++ system/docker-images.txt
2026-08-24 20:34:09.952743 | instance | >f+++++++++ system/ip-addr.txt
2026-08-24 20:34:09.952777 | instance | >f+++++++++ system/ip-route.txt
2026-08-24 20:34:09.952807 | instance | >f+++++++++ system/lsblk.txt
2026-08-24 20:34:09.952836 | instance | >f+++++++++ system/mount.txt
2026-08-24 20:34:09.952863 | instance | >f+++++++++ system/packages.txt
2026-08-24 20:34:09.952890 | instance | >f+++++++++ system/ps.txt
2026-08-24 20:34:09.952921 | instance | >f+++++++++ system/systemd-cgls.txt
2026-08-24 20:34:09.965582 | 
2026-08-24 20:34:09.965675 | LOOP [helm-release-status : creating directory for helm release status]
2026-08-24 20:34:10.173110 | instance | changed: "values"
2026-08-24 20:34:10.347973 | instance | changed: "releases"
2026-08-24 20:34:10.368499 | 
2026-08-24 20:34:10.368718 | TASK [helm-release-status : Gather get release status for helm charts]
2026-08-24 20:34:10.575233 | instance | /bin/bash: line 3: kubectl: command not found
2026-08-24 20:34:10.909688 | instance | ok: Runtime: 0:00:00.005564
2026-08-24 20:34:10.916660 | 
2026-08-24 20:34:10.916754 | TASK [helm-release-status : Downloads logs to executor]
2026-08-24 20:34:11.398512 | instance | changed:
2026-08-24 20:34:11.398692 | instance | cd+++++++++ helm/
2026-08-24 20:34:11.398730 | instance | cd+++++++++ helm/releases/
2026-08-24 20:34:11.398760 | instance | cd+++++++++ helm/values/
2026-08-24 20:34:11.411046 | 
2026-08-24 20:34:11.411178 | TASK [describe-kubernetes-objects : creating directory for cluster scoped objects]
2026-08-24 20:34:11.597760 | instance | changed
2026-08-24 20:34:11.605871 | 
2026-08-24 20:34:11.605968 | TASK [describe-kubernetes-objects : Gathering descriptions for cluster scoped objects]
2026-08-24 20:34:11.873980 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-08-24 20:34:11.874173 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-08-24 20:34:11.879780 | instance | environment: line 1: kubectl: command not found
2026-08-24 20:34:11.880620 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-08-24 20:34:11.881347 | instance | environment: line 1: kubectl: command not found
2026-08-24 20:34:11.882165 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-08-24 20:34:11.883817 | instance | environment: line 1: kubectl: command not found
2026-08-24 20:34:11.884898 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-08-24 20:34:11.886147 | instance | environment: line 1: kubectl: command not found
2026-08-24 20:34:11.887252 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-08-24 20:34:11.889891 | instance | environment: line 1: kubectl: command not found
2026-08-24 20:34:11.890804 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-08-24 20:34:12.145585 | instance | ok: Runtime: 0:00:00.024229
2026-08-24 20:34:12.152108 | 
2026-08-24 20:34:12.152192 | TASK [describe-kubernetes-objects : creating directory for namespace scoped objects]
2026-08-24 20:34:12.368738 | instance | changed
2026-08-24 20:34:12.375334 | 
2026-08-24 20:34:12.375423 | TASK [describe-kubernetes-objects : Gathering descriptions for namespace scoped objects]
2026-08-24 20:34:12.579196 | instance | environment: line 5: kubectl: command not found
2026-08-24 20:34:12.579981 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-08-24 20:34:12.580019 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-08-24 20:34:12.580369 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-08-24 20:34:13.349913 | instance | ok: Runtime: 0:00:00.009013
2026-08-24 20:34:13.358844 | 
2026-08-24 20:34:13.358933 | TASK [describe-kubernetes-objects : Downloads logs to executor]
2026-08-24 20:34:13.852909 | instance | changed:
2026-08-24 20:34:13.853181 | instance | cd+++++++++ objects/
2026-08-24 20:34:13.853222 | instance | cd+++++++++ objects/cluster/
2026-08-24 20:34:13.853255 | instance | cd+++++++++ objects/namespaced/
2026-08-24 20:34:13.872902 | 
2026-08-24 20:34:13.873071 | TASK [gather-pod-logs : creating directory for pod logs]
2026-08-24 20:34:14.089326 | instance | changed
2026-08-24 20:34:14.098307 | 
2026-08-24 20:34:14.098551 | TASK [gather-pod-logs : creating directory for failed pod logs]
2026-08-24 20:34:14.292722 | instance | changed
2026-08-24 20:34:14.299864 | 
2026-08-24 20:34:14.299959 | TASK [gather-pod-logs : retrieve all kubernetes logs, current and previous (if they exist)]
2026-08-24 20:34:14.512199 | instance | environment: line 3: kubectl: command not found
2026-08-24 20:34:14.839072 | instance | ok: Runtime: 0:00:00.008062
2026-08-24 20:34:14.844753 | 
2026-08-24 20:34:14.844817 | TASK [gather-pod-logs : Downloads pod logs to executor]
2026-08-24 20:34:15.316977 | instance | changed:
2026-08-24 20:34:15.317135 | instance | cd+++++++++ pod-logs/
2026-08-24 20:34:15.317172 | instance | cd+++++++++ pod-logs/failed-pods/
2026-08-24 20:34:15.326429 | 
2026-08-24 20:34:15.326526 | TASK [gather-prom-metrics : creating directory for helm release descriptions]
2026-08-24 20:34:15.513469 | instance | changed
2026-08-24 20:34:15.520702 | 
2026-08-24 20:34:15.520816 | TASK [gather-prom-metrics : Get metrics from exporter services in all namespaces]
2026-08-24 20:34:15.716011 | instance | /bin/bash: line 2: kubectl: command not found
2026-08-24 20:34:16.057230 | instance | ok: Runtime: 0:00:00.035838
2026-08-24 20:34:16.065530 | 
2026-08-24 20:34:16.065640 | TASK [gather-prom-metrics : Get ceph metrics from ceph-mgr]
2026-08-24 20:34:16.269150 | instance | /bin/bash: line 2: kubectl: command not found
2026-08-24 20:34:16.299911 | instance | ceph-mgr endpoints:
2026-08-24 20:34:16.599677 | instance | ok: Runtime: 0:00:00.036439
2026-08-24 20:34:16.606683 | 
2026-08-24 20:34:16.606747 | TASK [gather-prom-metrics : Get metrics from fluentd pods]
2026-08-24 20:34:16.805706 | instance | /bin/bash: line 4: kubectl: command not found
2026-08-24 20:34:17.137376 | instance | ok: Runtime: 0:00:00.034897
2026-08-24 20:34:17.142442 | 
2026-08-24 20:34:17.142513 | TASK [gather-prom-metrics : Downloads logs to executor]
2026-08-24 20:34:17.633472 | instance | changed: cd+++++++++ prometheus/
2026-08-24 20:34:17.645480 | 
2026-08-24 20:34:17.645541 | TASK [gather-selenium-data : creating directory for helm release descriptions]
2026-08-24 20:34:17.847730 | instance | changed
2026-08-24 20:34:17.853173 | 
2026-08-24 20:34:17.853244 | TASK [gather-selenium-data : Get selenium data]
2026-08-24 20:34:18.109196 | instance | + cp '/tmp/artifacts/*' /tmp/logs/selenium/.
2026-08-24 20:34:18.110735 | instance | cp: cannot stat '/tmp/artifacts/*': No such file or directory
2026-08-24 20:34:18.387755 | instance | ERROR
2026-08-24 20:34:18.388014 | instance | {
2026-08-24 20:34:18.388084 | instance |   "delta": "0:00:00.007612",
2026-08-24 20:34:18.388131 | instance |   "end": "2026-08-24 20:34:18.111239",
2026-08-24 20:34:18.388178 | instance |   "msg": "non-zero return code",
2026-08-24 20:34:18.388220 | instance |   "rc": 1,
2026-08-24 20:34:18.388262 | instance |   "start": "2026-08-24 20:34:18.103627"
2026-08-24 20:34:18.388292 | instance | }
2026-08-24 20:34:18.388326 | instance | ERROR: Ignoring Errors
2026-08-24 20:34:18.395007 | 
2026-08-24 20:34:18.395092 | TASK [gather-selenium-data : Downloads logs to executor]
2026-08-24 20:34:18.892131 | instance | changed: cd+++++++++ selenium/
2026-08-24 20:34:18.908129 | 
2026-08-24 20:34:18.908421 | PLAY RECAP
2026-08-24 20:34:18.908539 | instance | ok: 23 changed: 23 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 1
2026-08-24 20:34:18.908593 | 
2026-08-24 20:34:19.073148 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere-zuul-jobs/playbooks/molecule/post.yml@main]
2026-08-24 20:34:19.077980 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main]
2026-08-24 20:34:19.939652 | 
2026-08-24 20:34:19.939772 | PLAY [all]
2026-08-24 20:34:19.951635 | 
2026-08-24 20:34:19.951752 | TASK [fetch-output : Set log path for multiple nodes]
2026-08-24 20:34:19.996885 | instance | skipping: Conditional result was False
2026-08-24 20:34:20.006055 | 
2026-08-24 20:34:20.006185 | TASK [fetch-output : Set log path for single node]
2026-08-24 20:34:20.049933 | instance | ok
2026-08-24 20:34:20.056611 | 
2026-08-24 20:34:20.056703 | LOOP [fetch-output : Ensure local output dirs]
2026-08-24 20:34:20.510576 | instance -> localhost | ok: "/var/lib/zuul/builds/02d23b833fa24a6db7c8f5ff63efdb8b/work/logs"
2026-08-24 20:34:20.727258 | instance -> localhost | changed: "/var/lib/zuul/builds/02d23b833fa24a6db7c8f5ff63efdb8b/work/artifacts"
2026-08-24 20:34:20.948331 | instance -> localhost | changed: "/var/lib/zuul/builds/02d23b833fa24a6db7c8f5ff63efdb8b/work/docs"
2026-08-24 20:34:20.963189 | 
2026-08-24 20:34:20.963337 | LOOP [fetch-output : Collect logs, artifacts and docs]
2026-08-24 20:34:21.607746 | instance | changed: .d..t...... ./
2026-08-24 20:34:21.607990 | instance | changed: All items complete
2026-08-24 20:34:21.608030 | 
2026-08-24 20:34:22.079698 | instance | changed: .d..t...... ./
2026-08-24 20:34:22.544321 | instance | changed: .d..t...... ./
2026-08-24 20:34:22.588502 | 
2026-08-24 20:34:22.588641 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir]
2026-08-24 20:34:23.043364 | instance -> localhost | ok: Item: artifacts Runtime: 0:00:00.008982
2026-08-24 20:34:23.270836 | instance -> localhost | ok: Item: docs Runtime: 0:00:00.006026
2026-08-24 20:34:23.293300 | 
2026-08-24 20:34:23.293846 | PLAY [all]
2026-08-24 20:34:23.299623 | 
2026-08-24 20:34:23.299694 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes]
2026-08-24 20:34:23.734974 | instance | changed
2026-08-24 20:34:23.741100 | 
2026-08-24 20:34:23.741160 | PLAY RECAP
2026-08-24 20:34:23.741217 | instance | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0
2026-08-24 20:34:23.741262 | 
2026-08-24 20:34:23.913561 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main]
2026-08-24 20:34:23.915651 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main]
2026-08-24 20:34:24.648268 | 
2026-08-24 20:34:24.648397 | PLAY [localhost]
2026-08-24 20:34:24.658319 | 
2026-08-24 20:34:24.658394 | TASK [Generate Zuul manifest]
2026-08-24 20:34:24.680009 | localhost | ok
2026-08-24 20:34:24.767120 | 
2026-08-24 20:34:24.767320 | TASK [generate-zuul-manifest : Generate Zuul manifest]
2026-08-24 20:34:25.136706 | localhost | changed
2026-08-24 20:34:25.148625 | 
2026-08-24 20:34:25.148783 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul]
2026-08-24 20:34:25.542163 | localhost | ok
2026-08-24 20:34:25.550963 | 
2026-08-24 20:34:25.551035 | TASK [Upload logs]
2026-08-24 20:34:25.570390 | localhost | ok
2026-08-24 20:34:25.682191 | 
2026-08-24 20:34:25.682341 | TASK [Set zuul-log-path fact]
2026-08-24 20:34:25.703096 | localhost | ok
2026-08-24 20:34:25.731481 | 
2026-08-24 20:34:25.731621 | TASK [set-zuul-log-path-fact : Set log path for a build]
2026-08-24 20:34:25.763152 | localhost | ok
2026-08-24 20:34:25.771983 | 
2026-08-24 20:34:25.772055 | TASK [upload-logs : Create log directories]
2026-08-24 20:34:26.205285 | localhost | changed
2026-08-24 20:34:26.212364 | 
2026-08-24 20:34:26.212450 | TASK [upload-logs : Ensure logs are readable before uploading]
2026-08-24 20:34:26.650582 | localhost -> localhost | ok: Runtime: 0:00:00.005642
2026-08-24 20:34:26.657645 | 
2026-08-24 20:34:26.657733 | TASK [upload-logs : Upload logs to log server]
2026-08-24 20:34:27.122241 | localhost | Output suppressed because no_log was given
2026-08-24 20:34:27.184939 | 
2026-08-24 20:34:27.185132 | LOOP [upload-logs : Compress console log and json output]
2026-08-24 20:34:27.231031 | localhost | skipping: Conditional result was False
2026-08-24 20:34:27.239441 | localhost | skipping: Conditional result was False
2026-08-24 20:34:27.250377 | 
2026-08-24 20:34:27.250563 | LOOP [upload-logs : Upload compressed console log and json output]
2026-08-24 20:34:27.290186 | localhost | skipping: Conditional result was False
2026-08-24 20:34:27.290479 | 
2026-08-24 20:34:27.294777 | localhost | skipping: Conditional result was False
2026-08-24 20:34:27.303874 | 
2026-08-24 20:34:27.304041 | LOOP [upload-logs : Upload console log and json output]