2026-04-25 08:35:17.008556 | Job console starting
2026-04-25 08:35:17.019994 | Updating git repos
2026-04-25 08:35:17.081613 | Cloning repos into workspace
2026-04-25 08:35:17.151602 | Restoring repo states
2026-04-25 08:35:17.171210 | Merging changes
2026-04-25 08:35:18.762767 | Checking out repos
2026-04-25 08:35:18.945783 | Preparing playbooks
2026-04-25 08:35:21.371543 | Running Ansible setup
2026-04-25 08:35:24.682828 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main]
2026-04-25 08:35:25.312650 | 
2026-04-25 08:35:25.471099 | PLAY [localhost]
2026-04-25 08:35:25.483725 | 
2026-04-25 08:35:25.483829 | TASK [Gathering Facts]
2026-04-25 08:35:26.382012 | localhost | ok
2026-04-25 08:35:26.390791 | 
2026-04-25 08:35:26.390868 | TASK [Setup log path fact]
2026-04-25 08:35:26.410039 | localhost | ok
2026-04-25 08:35:26.421249 | 
2026-04-25 08:35:26.421313 | TASK [set-zuul-log-path-fact : Set log path for a build]
2026-04-25 08:35:26.448191 | localhost | ok
2026-04-25 08:35:26.455839 | 
2026-04-25 08:35:26.455928 | TASK [emit-job-header : Print job information]
2026-04-25 08:35:26.493728 | # Job Information
2026-04-25 08:35:26.493879 | Ansible Version: 2.16.16
2026-04-25 08:35:26.493923 | Job: atmosphere-molecule-csi-rbd
2026-04-25 08:35:26.493954 | Pipeline: check
2026-04-25 08:35:26.493982 | Executor: 0a8996d2b663
2026-04-25 08:35:26.494009 | Triggered by: https://github.com/vexxhost/atmosphere/pull/3877
2026-04-25 08:35:26.494040 | Event ID: 994bb330-4081-11f1-907b-42e050ef8cf8
2026-04-25 08:35:26.497624 | 
2026-04-25 08:35:26.497708 | LOOP [emit-job-header : Print node information]
2026-04-25 08:35:26.596425 | localhost | ok:
2026-04-25 08:35:26.596622 | localhost | # Node Information
2026-04-25 08:35:26.596669 | localhost | Inventory Hostname: instance
2026-04-25 08:35:26.596737 | localhost | Hostname: np0000170160
2026-04-25 08:35:26.596858 | localhost | Username: zuul
2026-04-25 08:35:26.596918 | localhost | Distro: Ubuntu 22.04
2026-04-25 08:35:26.596953 | localhost | Provider: yul1
2026-04-25 08:35:26.597023 | localhost | Region: ca-ymq-1
2026-04-25 08:35:26.597060 | localhost | Label: ubuntu-jammy
2026-04-25 08:35:26.597088 | localhost | Product Name: OpenStack Nova
2026-04-25 08:35:26.597114 | localhost | Interface IP: 199.204.45.95
2026-04-25 08:35:26.617552 | 
2026-04-25 08:35:26.617664 | TASK [log-inventory : Ensure Zuul Ansible directory exists]
2026-04-25 08:35:27.067054 | localhost -> localhost | changed
2026-04-25 08:35:27.071939 | 
2026-04-25 08:35:27.072032 | TASK [log-inventory : Copy ansible inventory to logs dir]
2026-04-25 08:35:28.099383 | localhost -> localhost | changed
2026-04-25 08:35:28.105423 | 
2026-04-25 08:35:28.105482 | PLAY [all]
2026-04-25 08:35:28.117037 | 
2026-04-25 08:35:28.117126 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build]
2026-04-25 08:35:28.345486 | instance -> localhost | ok
2026-04-25 08:35:28.355266 | 
2026-04-25 08:35:28.355327 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID]
2026-04-25 08:35:28.388593 | instance | ok
2026-04-25 08:35:28.403132 | instance | included: /var/lib/zuul/builds/d7ed201c69e94217a0409ade646dbc4f/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml
2026-04-25 08:35:28.408608 | 
2026-04-25 08:35:28.408674 | TASK [add-build-sshkey : Create Temp SSH key]
2026-04-25 08:35:29.996766 | instance -> localhost | Generating public/private rsa key pair.
2026-04-25 08:35:29.996998 | instance -> localhost | Your identification has been saved in /var/lib/zuul/builds/d7ed201c69e94217a0409ade646dbc4f/work/d7ed201c69e94217a0409ade646dbc4f_id_rsa
2026-04-25 08:35:29.997057 | instance -> localhost | Your public key has been saved in /var/lib/zuul/builds/d7ed201c69e94217a0409ade646dbc4f/work/d7ed201c69e94217a0409ade646dbc4f_id_rsa.pub
2026-04-25 08:35:29.997092 | instance -> localhost | The key fingerprint is:
2026-04-25 08:35:29.997125 | instance -> localhost | SHA256:nWje7u+iBxu991vdMFjnCL4ay7xsQ+TbQtrYwG1YiFI zuul-build-sshkey
2026-04-25 08:35:29.997173 | instance -> localhost | The key's randomart image is:
2026-04-25 08:35:29.997204 | instance -> localhost | +---[RSA 3072]----+
2026-04-25 08:35:29.997241 | instance -> localhost | |                 |
2026-04-25 08:35:29.997273 | instance -> localhost | |      E          |
2026-04-25 08:35:29.997302 | instance -> localhost | |     . . .  . . .|
2026-04-25 08:35:29.997332 | instance -> localhost | |    . . .ooo + + |
2026-04-25 08:35:29.997361 | instance -> localhost | |     . .SBo o + .|
2026-04-25 08:35:29.997390 | instance -> localhost | |       o*.B  . oo|
2026-04-25 08:35:29.997419 | instance -> localhost | |        .&o+.   +|
2026-04-25 08:35:29.997449 | instance -> localhost | |        +=@+o  . |
2026-04-25 08:35:29.997482 | instance -> localhost | |        .=XOo.o. |
2026-04-25 08:35:29.997513 | instance -> localhost | +----[SHA256]-----+
2026-04-25 08:35:29.997578 | instance -> localhost | ok: Runtime: 0:00:01.141318
2026-04-25 08:35:30.003474 | 
2026-04-25 08:35:30.003533 | TASK [add-build-sshkey : Remote setup ssh keys (linux)]
2026-04-25 08:35:30.034386 | instance | ok
2026-04-25 08:35:30.044706 | instance | included: /var/lib/zuul/builds/d7ed201c69e94217a0409ade646dbc4f/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml
2026-04-25 08:35:30.052075 | 
2026-04-25 08:35:30.052136 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey]
2026-04-25 08:35:30.075332 | instance | skipping: Conditional result was False
2026-04-25 08:35:30.085561 | 
2026-04-25 08:35:30.085625 | TASK [add-build-sshkey : Enable access via build key on all nodes]
2026-04-25 08:35:30.513627 | instance | changed
2026-04-25 08:35:30.518527 | 
2026-04-25 08:35:30.518588 | TASK [add-build-sshkey : Make sure user has a .ssh]
2026-04-25 08:35:30.720825 | instance | ok
2026-04-25 08:35:30.732728 | 
2026-04-25 08:35:30.732809 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes]
2026-04-25 08:35:31.165387 | instance | changed
2026-04-25 08:35:31.172843 | 
2026-04-25 08:35:31.172952 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes]
2026-04-25 08:35:31.613010 | instance | changed
2026-04-25 08:35:31.618479 | 
2026-04-25 08:35:31.618543 | TASK [add-build-sshkey : Remote setup ssh keys (windows)]
2026-04-25 08:35:31.642967 | instance | skipping: Conditional result was False
2026-04-25 08:35:31.652299 | 
2026-04-25 08:35:31.652365 | TASK [remove-zuul-sshkey : Remove master key from local agent]
2026-04-25 08:35:32.000201 | instance -> localhost | changed
2026-04-25 08:35:32.010818 | 
2026-04-25 08:35:32.010907 | TASK [add-build-sshkey : Add back temp key]
2026-04-25 08:35:32.314706 | instance -> localhost | Identity added: /var/lib/zuul/builds/d7ed201c69e94217a0409ade646dbc4f/work/d7ed201c69e94217a0409ade646dbc4f_id_rsa (zuul-build-sshkey)
2026-04-25 08:35:32.314936 | instance -> localhost | ok: Runtime: 0:00:00.013286
2026-04-25 08:35:32.322825 | 
2026-04-25 08:35:32.322886 | TASK [add-build-sshkey : Verify we can still SSH to all nodes]
2026-04-25 08:35:32.630604 | instance | ok
2026-04-25 08:35:32.637189 | 
2026-04-25 08:35:32.637273 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)]
2026-04-25 08:35:32.661071 | instance | skipping: Conditional result was False
2026-04-25 08:35:32.674628 | 
2026-04-25 08:35:32.674706 | TASK [prepare-workspace : Start zuul_console daemon.]
2026-04-25 08:35:33.000585 | instance | ok
2026-04-25 08:35:33.009061 | 
2026-04-25 08:35:33.009133 | TASK [prepare-workspace : Synchronize src repos to workspace directory.]
2026-04-25 08:35:34.662894 | instance | Output suppressed because no_log was given
2026-04-25 08:35:34.757465 | 
2026-04-25 08:35:34.757601 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them]
2026-04-25 08:35:34.938914 | instance | ok: "logs"
2026-04-25 08:35:34.939166 | instance | ok: All items complete
2026-04-25 08:35:34.939194 | 
2026-04-25 08:35:35.081059 | instance | ok: "artifacts"
2026-04-25 08:35:35.230172 | instance | ok: "docs"
2026-04-25 08:35:35.249410 | 
2026-04-25 08:35:35.249585 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist]
2026-04-25 08:35:35.427460 | instance | changed: "logs"
2026-04-25 08:35:35.574021 | instance | changed: "artifacts"
2026-04-25 08:35:35.724120 | instance | changed: "docs"
2026-04-25 08:35:35.736822 | 
2026-04-25 08:35:35.736978 | PLAY RECAP
2026-04-25 08:35:35.737045 | instance | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0
2026-04-25 08:35:35.737086 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-04-25 08:35:35.737114 | 
2026-04-25 08:35:35.856922 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main]
2026-04-25 08:35:35.860762 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main]
2026-04-25 08:35:36.448580 | 
2026-04-25 08:35:36.448707 | PLAY [all]
2026-04-25 08:35:36.467459 | 
2026-04-25 08:35:36.467622 | TASK [setup-uv : Extract archive]
2026-04-25 08:35:38.577483 | instance | changed
2026-04-25 08:35:38.584681 | 
2026-04-25 08:35:38.584759 | TASK [setup-uv : Print version]
2026-04-25 08:35:38.016469 | instance | uv 0.8.13
2026-04-25 08:35:39.123190 | instance | ok: Runtime: 0:00:00.012166
2026-04-25 08:35:39.132306 | 
2026-04-25 08:35:39.132361 | PLAY RECAP
2026-04-25 08:35:39.132410 | instance | ok: 2 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-04-25 08:35:39.132434 | 
2026-04-25 08:35:39.309186 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main]
2026-04-25 08:35:39.311290 | PRE-RUN START: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/pre.yml@main]
2026-04-25 08:35:39.894218 | 
2026-04-25 08:35:39.894388 | PLAY [all]
2026-04-25 08:35:39.905905 | 
2026-04-25 08:35:39.905981 | TASK [Install "jq" for log collection]
2026-04-25 08:35:55.332034 | instance | changed
2026-04-25 08:35:55.337496 | 
2026-04-25 08:35:55.337589 | TASK [Install pip3 for Python package management]
2026-04-25 08:35:59.127977 | instance | changed
2026-04-25 08:35:59.135387 | 
2026-04-25 08:35:59.135483 | TASK [Install Python "kubernetes" library for kubernetes.core modules]
2026-04-25 08:36:02.230778 | instance | changed
2026-04-25 08:36:02.233709 | 
2026-04-25 08:36:02.233764 | PLAY [all]
2026-04-25 08:36:02.242332 | 
2026-04-25 08:36:02.242397 | TASK [ensure-go : Check installed go version]
2026-04-25 08:36:02.779003 | instance | ok: ERROR (ignored)
2026-04-25 08:36:02.779389 | instance | {
2026-04-25 08:36:02.779458 | instance |   "failed_when_result": false,
2026-04-25 08:36:02.779505 | instance |   "msg": "[Errno 2] No such file or directory: b'go'",
2026-04-25 08:36:02.779552 | instance |   "rc": 2
2026-04-25 08:36:02.779602 | instance | }
2026-04-25 08:36:02.786553 | 
2026-04-25 08:36:02.786655 | TASK [ensure-go : Skip if correct version of go is installed]
2026-04-25 08:36:02.839199 | instance | ok
2026-04-25 08:36:02.852990 | instance | included: /var/lib/zuul/builds/d7ed201c69e94217a0409ade646dbc4f/untrusted/project_2/opendev.org/zuul/zuul-jobs/roles/ensure-go/tasks/install-go.yaml
2026-04-25 08:36:02.858028 | 
2026-04-25 08:36:02.858128 | TASK [ensure-go : Create temp directory]
2026-04-25 08:36:03.156932 | instance | changed
2026-04-25 08:36:03.162355 | 
2026-04-25 08:36:03.162418 | TASK [ensure-go : Get archive checksum]
2026-04-25 08:36:03.723468 | instance | ok: OK (64 bytes)
2026-04-25 08:36:03.728886 | 
2026-04-25 08:36:03.729147 | TASK [ensure-go : Download go archive]
2026-04-25 08:36:04.903594 | instance | changed: OK (78559214 bytes)
2026-04-25 08:36:04.910775 | 
2026-04-25 08:36:04.910858 | TASK [ensure-go : Install go]
2026-04-25 08:36:10.632505 | instance | changed
2026-04-25 08:36:10.640744 | 
2026-04-25 08:36:10.640812 | PLAY [all]
2026-04-25 08:36:10.646514 | 
2026-04-25 08:36:10.646574 | TASK [Copy inventory file for Zuul]
2026-04-25 08:36:11.387436 | instance | changed
2026-04-25 08:36:11.394376 | 
2026-04-25 08:36:11.394489 | TASK [Switch "ansible_host" to private IP]
2026-04-25 08:36:11.702911 | instance | changed: 1 replacements made
2026-04-25 08:36:11.708411 | 
2026-04-25 08:36:11.708472 | TASK [Run molecule prepare]
2026-04-25 08:36:11.957508 | instance | Using CPython 3.10.12 interpreter at: /usr/bin/python3
2026-04-25 08:36:11.958090 | instance | Creating virtual environment at: .venv
2026-04-25 08:36:11.985615 | instance |    Building atmosphere @ file:///home/zuul/src/github.com/vexxhost/atmosphere
2026-04-25 08:36:12.008891 | instance | Downloading openstacksdk (1.7MiB)
2026-04-25 08:36:12.009846 | instance | Downloading netaddr (2.2MiB)
2026-04-25 08:36:12.010382 | instance | Downloading ansible-core (2.1MiB)
2026-04-25 08:36:12.010936 | instance | Downloading kubernetes (1.9MiB)
2026-04-25 08:36:12.011630 | instance | Downloading cryptography (4.2MiB)
2026-04-25 08:36:12.012159 | instance | Downloading pygments (1.2MiB)
2026-04-25 08:36:12.013502 | instance | Downloading rjsonnet (1.2MiB)
2026-04-25 08:36:12.013962 | instance | Downloading pydantic-core (2.0MiB)
2026-04-25 08:36:12.018801 | instance | Downloading setuptools (1.1MiB)
2026-04-25 08:36:12.313305 | instance |    Building pyperclip==1.9.0
2026-04-25 08:36:12.342404 | instance |  Downloading rjsonnet
2026-04-25 08:36:12.424550 | instance |  Downloading pydantic-core
2026-04-25 08:36:12.444275 | instance |  Downloading netaddr
2026-04-25 08:36:12.456388 | instance |  Downloading pygments
2026-04-25 08:36:12.492515 | instance |  Downloading setuptools
2026-04-25 08:36:12.540138 | instance |  Downloading kubernetes
2026-04-25 08:36:12.565881 | instance |  Downloading ansible-core
2026-04-25 08:36:12.592173 | instance |  Downloading openstacksdk
2026-04-25 08:36:12.651862 | instance |  Downloading cryptography
2026-04-25 08:36:12.978996 | instance |       Built pyperclip==1.9.0
2026-04-25 08:36:13.138105 | instance |       Built atmosphere @ file:///home/zuul/src/github.com/vexxhost/atmosphere
2026-04-25 08:36:13.180146 | instance | Installed 83 packages in 39ms
2026-04-25 08:36:13.767364 | instance | WARNING  Molecule scenarios should migrate to 'extensions/molecule'
2026-04-25 08:36:14.390434 | instance | INFO     [csi > discovery] scenario test matrix: prepare
2026-04-25 08:36:14.390560 | instance | INFO     [csi > prerun] Performing prerun with role_name_check=0...
2026-04-25 08:36:58.696097 | instance | INFO     [csi > prepare] Executing
2026-04-25 08:36:59.561755 | instance |
2026-04-25 08:36:59.562269 | instance | PLAY [Prepare] *****************************************************************
2026-04-25 08:36:59.562589 | instance |
2026-04-25 08:36:59.562863 | instance | TASK [Gathering Facts] *********************************************************
2026-04-25 08:36:59.563198 | instance | Saturday 25 April 2026  08:36:59 +0000 (0:00:00.027)       0:00:00.027 ********
2026-04-25 08:37:00.659763 | instance | [WARNING]: Platform linux on host instance is using the discovered Python
2026-04-25 08:37:00.660098 | instance | interpreter at /usr/bin/python3.10, but future installation of another Python
2026-04-25 08:37:00.660490 | instance | interpreter could change the meaning of that path. See
2026-04-25 08:37:00.660796 | instance | https://docs.ansible.com/ansible-
2026-04-25 08:37:00.661230 | instance | core/2.17/reference_appendices/interpreter_discovery.html for more information.
2026-04-25 08:37:00.667884 | instance | ok: [instance]
2026-04-25 08:37:00.668295 | instance |
2026-04-25 08:37:00.668766 | instance | TASK [Configure short hostname] ************************************************
2026-04-25 08:37:00.669129 | instance | Saturday 25 April 2026  08:37:00 +0000 (0:00:01.106)       0:00:01.134 ********
2026-04-25 08:37:01.414547 | instance | changed: [instance]
2026-04-25 08:37:01.414751 | instance |
2026-04-25 08:37:01.415030 | instance | TASK [Ensure hostname inside hosts file] ***************************************
2026-04-25 08:37:01.415304 | instance | Saturday 25 April 2026  08:37:01 +0000 (0:00:00.746)       0:00:01.881 ********
2026-04-25 08:37:01.694909 | instance | [WARNING]: Module remote_tmp /root/.ansible/tmp did not exist and was created
2026-04-25 08:37:01.694980 | instance | with a mode of 0700, this may cause issues when running as another user. To
2026-04-25 08:37:01.694991 | instance | avoid this, create the remote_tmp dir with the correct permissions manually
2026-04-25 08:37:01.707110 | instance | changed: [instance]
2026-04-25 08:37:01.707385 | instance |
2026-04-25 08:37:01.707667 | instance | TASK [Purge "snapd" package] ***************************************************
2026-04-25 08:37:01.708009 | instance | Saturday 25 April 2026  08:37:01 +0000 (0:00:00.293)       0:00:02.174 ********
2026-04-25 08:37:02.471340 | instance | ok: [instance]
2026-04-25 08:37:02.471572 | instance |
2026-04-25 08:37:02.471855 | instance | PLAY [Create devices for Ceph] *************************************************
2026-04-25 08:37:02.472147 | instance |
2026-04-25 08:37:02.472415 | instance | TASK [Gathering Facts] *********************************************************
2026-04-25 08:37:02.472703 | instance | Saturday 25 April 2026  08:37:02 +0000 (0:00:00.764)       0:00:02.938 ********
2026-04-25 08:37:03.147627 | instance | ok: [instance]
2026-04-25 08:37:03.147859 | instance |
2026-04-25 08:37:03.148180 | instance | TASK [Install depedencies] *****************************************************
2026-04-25 08:37:03.148452 | instance | Saturday 25 April 2026  08:37:03 +0000 (0:00:00.676)       0:00:03.614 ********
2026-04-25 08:37:24.646842 | instance | changed: [instance]
2026-04-25 08:37:24.647046 | instance |
2026-04-25 08:37:24.647319 | instance | TASK [Start up service] ********************************************************
2026-04-25 08:37:24.647606 | instance | Saturday 25 April 2026  08:37:24 +0000 (0:00:21.498)       0:00:25.112 ********
2026-04-25 08:37:25.222415 | instance | ok: [instance]
2026-04-25 08:37:25.222646 | instance |
2026-04-25 08:37:25.222928 | instance | TASK [Generate lvm.conf] *******************************************************
2026-04-25 08:37:25.223208 | instance | Saturday 25 April 2026  08:37:25 +0000 (0:00:00.576)       0:00:25.689 ********
2026-04-25 08:37:25.522226 | instance | ok: [instance]
2026-04-25 08:37:25.522441 | instance |
2026-04-25 08:37:25.522715 | instance | TASK [Write /etc/lvm/lvm.conf] *************************************************
2026-04-25 08:37:25.522984 | instance | Saturday 25 April 2026  08:37:25 +0000 (0:00:00.299)       0:00:25.989 ********
2026-04-25 08:37:26.212264 | instance | changed: [instance]
2026-04-25 08:37:26.212592 | instance |
2026-04-25 08:37:26.212895 | instance | TASK [Get list of all loopback devices] ****************************************
2026-04-25 08:37:26.213171 | instance | Saturday 25 April 2026  08:37:26 +0000 (0:00:00.689)       0:00:26.678 ********
2026-04-25 08:37:26.409992 | instance | ok: [instance]
2026-04-25 08:37:26.410229 | instance |
2026-04-25 08:37:26.410517 | instance | TASK [Fail if there is any existing loopback devices] **************************
2026-04-25 08:37:26.410797 | instance | Saturday 25 April 2026  08:37:26 +0000 (0:00:00.197)       0:00:26.876 ********
2026-04-25 08:37:26.434638 | instance | skipping: [instance]
2026-04-25 08:37:26.434896 | instance |
2026-04-25 08:37:26.435170 | instance | TASK [Create devices for Ceph] *************************************************
2026-04-25 08:37:26.435440 | instance | Saturday 25 April 2026  08:37:26 +0000 (0:00:00.025)       0:00:26.901 ********
2026-04-25 08:37:26.975858 | instance | changed: [instance] => (item=osd0)
2026-04-25 08:37:26.976191 | instance | changed: [instance] => (item=osd1)
2026-04-25 08:37:26.976488 | instance | changed: [instance] => (item=osd2)
2026-04-25 08:37:26.976754 | instance |
2026-04-25 08:37:26.977057 | instance | TASK [Set permissions on loopback devices] *************************************
2026-04-25 08:37:26.977329 | instance | Saturday 25 April 2026  08:37:26 +0000 (0:00:00.540)       0:00:27.442 ********
2026-04-25 08:37:27.616915 | instance | changed: [instance] => (item=osd0)
2026-04-25 08:37:27.617055 | instance | changed: [instance] => (item=osd1)
2026-04-25 08:37:27.617247 | instance | changed: [instance] => (item=osd2)
2026-04-25 08:37:27.617411 | instance |
2026-04-25 08:37:27.617589 | instance | TASK [Start loop devices] ******************************************************
2026-04-25 08:37:27.617770 | instance | Saturday 25 April 2026  08:37:27 +0000 (0:00:00.641)       0:00:28.083 ********
2026-04-25 08:37:28.273921 | instance | changed: [instance] => (item=osd0)
2026-04-25 08:37:28.274321 | instance | changed: [instance] => (item=osd1)
2026-04-25 08:37:28.274618 | instance | changed: [instance] => (item=osd2)
2026-04-25 08:37:28.274900 | instance |
2026-04-25 08:37:28.275249 | instance | TASK [Create a volume group for each loop device] ******************************
2026-04-25 08:37:28.275560 | instance | Saturday 25 April 2026  08:37:28 +0000 (0:00:00.657)       0:00:28.740 ********
2026-04-25 08:37:31.414703 | instance | changed: [instance] => (item=osd0)
2026-04-25 08:37:31.414933 | instance | changed: [instance] => (item=osd1)
2026-04-25 08:37:31.415204 | instance | changed: [instance] => (item=osd2)
2026-04-25 08:37:31.415457 | instance |
2026-04-25 08:37:31.415760 | instance | TASK [Create a logical volume for each loop device] ****************************
2026-04-25 08:37:31.416074 | instance | Saturday 25 April 2026  08:37:31 +0000 (0:00:03.140)       0:00:31.881 ********
2026-04-25 08:37:33.312056 | instance | changed: [instance] => (item=ceph-instance-osd0)
2026-04-25 08:37:33.312135 | instance | changed: [instance] => (item=ceph-instance-osd1)
2026-04-25 08:37:33.312146 | instance | changed: [instance] => (item=ceph-instance-osd2)
2026-04-25 08:37:33.312156 | instance |
2026-04-25 08:37:33.312166 | instance | PLAY RECAP *********************************************************************
2026-04-25 08:37:33.313711 | instance | instance                   : ok=15   changed=9    unreachable=0    failed=0    skipped=1    rescued=0    ignored=0
2026-04-25 08:37:33.313764 | instance |
2026-04-25 08:37:33.313776 | instance | Saturday 25 April 2026  08:37:33 +0000 (0:00:01.896)       0:00:33.778 ********
2026-04-25 08:37:33.313786 | instance | ===============================================================================
2026-04-25 08:37:33.313796 | instance | Install depedencies ---------------------------------------------------- 21.50s
2026-04-25 08:37:33.313805 | instance | Create a volume group for each loop device ------------------------------ 3.14s
2026-04-25 08:37:33.313815 | instance | Create a logical volume for each loop device ---------------------------- 1.90s
2026-04-25 08:37:33.313824 | instance | Gathering Facts --------------------------------------------------------- 1.11s
2026-04-25 08:37:33.313838 | instance | Purge "snapd" package --------------------------------------------------- 0.76s
2026-04-25 08:37:33.314020 | instance | Configure short hostname ------------------------------------------------ 0.75s
2026-04-25 08:37:33.314238 | instance | Write /etc/lvm/lvm.conf ------------------------------------------------- 0.69s
2026-04-25 08:37:33.314443 | instance | Gathering Facts --------------------------------------------------------- 0.68s
2026-04-25 08:37:33.314648 | instance | Start loop devices ------------------------------------------------------ 0.66s
2026-04-25 08:37:33.314891 | instance | Set permissions on loopback devices ------------------------------------- 0.64s
2026-04-25 08:37:33.315106 | instance | Start up service -------------------------------------------------------- 0.58s
2026-04-25 08:37:33.315318 | instance | Create devices for Ceph ------------------------------------------------- 0.54s
2026-04-25 08:37:33.315530 | instance | Generate lvm.conf ------------------------------------------------------- 0.30s
2026-04-25 08:37:33.315745 | instance | Ensure hostname inside hosts file --------------------------------------- 0.29s
2026-04-25 08:37:33.315958 | instance | Get list of all loopback devices ---------------------------------------- 0.20s
2026-04-25 08:37:33.316218 | instance | Fail if there is any existing loopback devices -------------------------- 0.03s
2026-04-25 08:37:33.385378 | instance | INFO     [csi > prepare] Executed: Successful
2026-04-25 08:37:33.386044 | instance | INFO     Molecule executed 1 scenario (1 successful)
2026-04-25 08:37:33.879389 | instance | ok: Runtime: 0:01:21.571997
2026-04-25 08:37:33.883109 | 
2026-04-25 08:37:33.883170 | PLAY RECAP
2026-04-25 08:37:33.883236 | instance | ok: 12 changed: 9 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-04-25 08:37:33.883265 | 
2026-04-25 08:37:34.004499 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/pre.yml@main]
2026-04-25 08:37:34.008576 | RUN START: [untrusted : github.com/vexxhost/atmosphere/molecule/csi/converge.yml@main]
2026-04-25 08:37:34.561299 | 
2026-04-25 08:37:34.561424 | PLAY [all]
2026-04-25 08:37:34.572265 | 
2026-04-25 08:37:34.572343 | TASK [Build atmosphere binary]
2026-04-25 08:37:34.958865 | instance | go: downloading github.com/spf13/cobra v1.9.1
2026-04-25 08:37:34.960188 | instance | go: downloading golang.org/x/sync v0.18.0
2026-04-25 08:37:35.190518 | instance | go: downloading github.com/spf13/pflag v1.0.7
2026-04-25 08:37:41.615417 | instance | ok: Runtime: 0:00:06.238167
2026-04-25 08:37:41.620906 | 
2026-04-25 08:37:41.620997 | TASK [Deploy with parallel orchestrator]
2026-04-25 08:37:41.821196 | instance | ==> Multi-tag mode: ceph, kubernetes, csi
2026-04-25 08:37:41.821388 | instance | ==> Running preflight checks
2026-04-25 08:37:42.273392 | instance | [preflight]
2026-04-25 08:37:42.273428 | instance | [preflight] PLAY [Preflight checks] ********************************************************
2026-04-25 08:37:42.273437 | instance | [preflight]
2026-04-25 08:37:42.273442 | instance | [preflight] TASK [Fail if atmosphere_ceph_enabled is set] **********************************
2026-04-25 08:37:42.300457 | instance | [preflight] skipping: [instance]
2026-04-25 08:37:42.300490 | instance | [preflight]
2026-04-25 08:37:42.300501 | instance | [preflight] PLAY RECAP *********************************************************************
2026-04-25 08:37:42.300513 | instance | [preflight] instance                   : ok=0    changed=0    unreachable=0    failed=0    skipped=1    rescued=0    ignored=0
2026-04-25 08:37:42.300523 | instance | [preflight]
2026-04-25 08:37:42.363785 | instance | ==> Preflight checks passed
2026-04-25 08:37:42.363906 | instance | ==> Starting parallel deployment (subgraph)
2026-04-25 08:37:42.363951 | instance | ==> [ceph] Starting deployment
2026-04-25 08:37:42.364090 | instance | ==> [kubernetes] Starting deployment
2026-04-25 08:37:43.138276 | instance | [ceph/ceph]
2026-04-25 08:37:43.138330 | instance | [ceph/ceph] PLAY [all] *********************************************************************
2026-04-25 08:37:43.138344 | instance | [ceph/ceph]
2026-04-25 08:37:43.138354 | instance | [ceph/ceph] TASK [Gathering Facts] *********************************************************
2026-04-25 08:37:43.237213 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:43.237257 | instance | [kubernetes/kubernetes] PLAY [all] *********************************************************************
2026-04-25 08:37:43.237279 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:43.237289 | instance | [kubernetes/kubernetes] TASK [Gathering Facts] *********************************************************
2026-04-25 08:37:44.541692 | instance | [ceph/ceph] [WARNING]: Platform linux on host instance is using the discovered Python
2026-04-25 08:37:44.541748 | instance | [ceph/ceph] interpreter at /usr/bin/python3.10, but future installation of another Python
2026-04-25 08:37:44.541760 | instance | [ceph/ceph] interpreter could change the meaning of that path. See
2026-04-25 08:37:44.541770 | instance | [ceph/ceph] https://docs.ansible.com/ansible-
2026-04-25 08:37:44.541780 | instance | [ceph/ceph] core/2.17/reference_appendices/interpreter_discovery.html for more information.
2026-04-25 08:37:44.551767 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:37:44.551787 | instance | [ceph/ceph]
2026-04-25 08:37:44.551797 | instance | [ceph/ceph] TASK [Fail if atmosphere_ceph_enabled is set] **********************************
2026-04-25 08:37:44.595546 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:37:44.595579 | instance | [ceph/ceph]
2026-04-25 08:37:44.595590 | instance | [ceph/ceph] TASK [Set a fact with the "atmosphere_images" for other plays] *****************
2026-04-25 08:37:44.744007 | instance | [kubernetes/kubernetes] [WARNING]: Platform linux on host instance is using the discovered Python
2026-04-25 08:37:44.744061 | instance | [kubernetes/kubernetes] interpreter at /usr/bin/python3.10, but future installation of another Python
2026-04-25 08:37:44.744074 | instance | [kubernetes/kubernetes] interpreter could change the meaning of that path. See
2026-04-25 08:37:44.744084 | instance | [kubernetes/kubernetes] https://docs.ansible.com/ansible-
2026-04-25 08:37:44.744094 | instance | [kubernetes/kubernetes] core/2.17/reference_appendices/interpreter_discovery.html for more information.
2026-04-25 08:37:44.762934 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:44.762965 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:44.762976 | instance | [kubernetes/kubernetes] TASK [vexxhost.atmosphere.sysctl : Configure sysctl values] ********************
2026-04-25 08:37:44.773448 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:37:44.773481 | instance | [ceph/ceph]
2026-04-25 08:37:44.773492 | instance | [ceph/ceph] PLAY [Deploy Ceph monitors & managers] *****************************************
2026-04-25 08:37:44.773502 | instance | [ceph/ceph]
2026-04-25 08:37:44.773511 | instance | [ceph/ceph] TASK [Gathering Facts] *********************************************************
2026-04-25 08:37:45.776596 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:37:45.776871 | instance | [ceph/ceph]
2026-04-25 08:37:45.776885 | instance | [ceph/ceph] TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-04-25 08:37:46.247080 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:37:46.247134 | instance | [ceph/ceph]
2026-04-25 08:37:46.247147 | instance | [ceph/ceph] TASK [vexxhost.containers.package : Update state for tar] **********************
2026-04-25 08:37:46.289940 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:37:46.289966 | instance | [ceph/ceph]
2026-04-25 08:37:46.289976 | instance | [ceph/ceph] TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads)] ***
2026-04-25 08:37:46.777932 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:37:46.777987 | instance | [ceph/ceph]
2026-04-25 08:37:46.778000 | instance | [ceph/ceph] TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-04-25 08:37:46.856396 | instance | [ceph/ceph] ok: [instance] => {
2026-04-25 08:37:46.856447 | instance | [ceph/ceph]     "msg": "https://github.com/opencontainers/runc/releases/download/v1.4.2/runc.amd64"
2026-04-25 08:37:46.856458 | instance | [ceph/ceph] }
2026-04-25 08:37:46.856468 | instance | [ceph/ceph]
2026-04-25 08:37:46.856477 | instance | [ceph/ceph] TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-04-25 08:37:47.729349 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:37:47.729390 | instance | [ceph/ceph]
2026-04-25 08:37:47.729395 | instance | [ceph/ceph] TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-04-25 08:37:47.782164 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:37:47.782197 | instance | [ceph/ceph]
2026-04-25 08:37:47.782202 | instance | [ceph/ceph] TASK [vexxhost.containers.package : Update state for tar] **********************
2026-04-25 08:37:47.831324 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:37:47.831373 | instance | [ceph/ceph]
2026-04-25 08:37:47.831385 | instance | [ceph/ceph] TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-04-25 08:37:48.157406 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:37:48.157457 | instance | [ceph/ceph]
2026-04-25 08:37:48.157469 | instance | [ceph/ceph] TASK [vexxhost.containers.package : Update state for tar] **********************
2026-04-25 08:37:49.711250 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:37:49.711305 | instance | [ceph/ceph]
2026-04-25 08:37:49.711317 | instance | [ceph/ceph] TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-04-25 08:37:49.782487 | instance | [ceph/ceph] ok: [instance] => {
2026-04-25 08:37:49.782523 | instance | [ceph/ceph]     "msg": "https://github.com/containerd/containerd/releases/download/v2.2.3/containerd-2.2.3-linux-amd64.tar.gz"
2026-04-25 08:37:49.782533 | instance | [ceph/ceph] }
2026-04-25 08:37:49.782542 | instance | [ceph/ceph]
2026-04-25 08:37:49.782551 | instance | [ceph/ceph] TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-04-25 08:37:50.670052 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:37:50.670108 | instance | [ceph/ceph]
2026-04-25 08:37:50.670119 | instance | [ceph/ceph] TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-04-25 08:37:51.750370 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'fs.aio-max-nr', 'value': 1048576})
2026-04-25 08:37:51.750416 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv4.tcp_timestamps', 'value': 0})
2026-04-25 08:37:51.750431 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv4.tcp_sack', 'value': 1})
2026-04-25 08:37:51.750438 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.core.netdev_budget', 'value': 1000})
2026-04-25 08:37:51.750444 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.core.netdev_max_backlog', 'value': 250000})
2026-04-25 08:37:51.750450 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.core.rmem_max', 'value': 4194304})
2026-04-25 08:37:51.750455 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.core.wmem_max', 'value': 4194304})
2026-04-25 08:37:51.750461 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.core.rmem_default', 'value': 4194304})
2026-04-25 08:37:51.750467 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.core.wmem_default', 'value': 4194304})
2026-04-25 08:37:51.750482 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.core.optmem_max', 'value': 4194304})
2026-04-25 08:37:51.750494 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv4.tcp_rmem', 'value': '4096 87380 4194304'})
2026-04-25 08:37:51.750500 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv4.tcp_wmem', 'value': '4096 65536 4194304'})
2026-04-25 08:37:51.750505 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv4.tcp_low_latency', 'value': 1})
2026-04-25 08:37:51.750511 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv4.tcp_adv_win_scale', 'value': 1})
2026-04-25 08:37:51.750516 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv4.neigh.default.gc_thresh1', 'value': 128})
2026-04-25 08:37:51.750522 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv4.neigh.default.gc_thresh2', 'value': 28872})
2026-04-25 08:37:51.750528 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv4.neigh.default.gc_thresh3', 'value': 32768})
2026-04-25 08:37:51.750533 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv6.neigh.default.gc_thresh1', 'value': 128})
2026-04-25 08:37:51.750539 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv6.neigh.default.gc_thresh2', 'value': 28872})
2026-04-25 08:37:51.750544 | instance | [kubernetes/kubernetes] changed: [instance] => (item={'name': 'net.ipv6.neigh.default.gc_thresh3', 'value': 32768})
2026-04-25 08:37:51.750550 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:51.750556 | instance | [kubernetes/kubernetes] TASK [vexxhost.atmosphere.ethtool : Create folder for persistent configuration] ***
2026-04-25 08:37:52.173444 | instance | [kubernetes/kubernetes] changed: [instance]
2026-04-25 08:37:52.173501 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:52.173514 | instance | [kubernetes/kubernetes] TASK [vexxhost.atmosphere.ethtool : Install persistent "ethtool" tuning] *******
2026-04-25 08:37:52.907121 | instance | [kubernetes/kubernetes] changed: [instance]
2026-04-25 08:37:52.907167 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:52.907175 | instance | [kubernetes/kubernetes] TASK [vexxhost.atmosphere.ethtool : Run "ethtool" tuning] **********************
2026-04-25 08:37:53.398734 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:53.398785 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:53.398798 | instance | [kubernetes/kubernetes] TASK [Set a fact with the "atmosphere_images" for other plays] *****************
2026-04-25 08:37:53.534109 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:53.534147 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:53.534159 | instance | [kubernetes/kubernetes] PLAY [Configure Kubernetes VIP] ************************************************
2026-04-25 08:37:53.534169 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:53.534178 | instance | [kubernetes/kubernetes] TASK [Gathering Facts] *********************************************************
2026-04-25 08:37:53.752757 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:37:53.752799 | instance | [ceph/ceph]
2026-04-25 08:37:53.752808 | instance | [ceph/ceph] TASK [vexxhost.containers.containerd : Install SELinux packages] ***************
2026-04-25 08:37:53.791613 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:37:53.791625 | instance | [ceph/ceph]
2026-04-25 08:37:53.791631 | instance | [ceph/ceph] TASK [vexxhost.containers.containerd : Set SELinux to permissive at runtime] ***
2026-04-25 08:37:53.825736 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:37:53.825747 | instance | [ceph/ceph]
2026-04-25 08:37:53.825752 | instance | [ceph/ceph] TASK [vexxhost.containers.containerd : Persist SELinux permissive mode] ********
2026-04-25 08:37:53.863306 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:37:53.863335 | instance | [ceph/ceph]
2026-04-25 08:37:53.863345 | instance | [ceph/ceph] TASK [vexxhost.containers.containerd : Install AppArmor packages] **************
2026-04-25 08:37:54.549701 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:54.549762 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:54.549775 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.directory : Create directory (/etc/kubernetes/manifests)] ***
2026-04-25 08:37:54.868545 | instance | [kubernetes/kubernetes] changed: [instance]
2026-04-25 08:37:54.868616 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:54.868630 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kube_vip : Uninstall legacy HA stack] ****************
2026-04-25 08:37:56.326037 | instance | [kubernetes/kubernetes] ok: [instance] => (item=/etc/keepalived/keepalived.conf)
2026-04-25 08:37:56.326099 | instance | [kubernetes/kubernetes] ok: [instance] => (item=/etc/keepalived/check_apiserver.sh)
2026-04-25 08:37:56.326111 | instance | [kubernetes/kubernetes] ok: [instance] => (item=/etc/kubernetes/manifests/keepalived.yaml)
2026-04-25 08:37:56.326121 | instance | [kubernetes/kubernetes] ok: [instance] => (item=/etc/haproxy/haproxy.cfg)
2026-04-25 08:37:56.326141 | instance | [kubernetes/kubernetes] ok: [instance] => (item=/etc/kubernetes/manifests/haproxy.yaml)
2026-04-25 08:37:56.326151 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:56.326161 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kube_vip : Switch API server to run on port 6443] ****
2026-04-25 08:37:57.276550 | instance | [kubernetes/kubernetes] failed: [instance] (item=/etc/kubernetes/manifests/kube-apiserver.yaml) => {"ansible_loop_var": "item", "changed": false, "item": "/etc/kubernetes/manifests/kube-apiserver.yaml", "msg": "Path /etc/kubernetes/manifests/kube-apiserver.yaml does not exist !", "rc": 257}
2026-04-25 08:37:57.276636 | instance | [kubernetes/kubernetes] failed: [instance] (item=/etc/kubernetes/controller-manager.conf) => {"ansible_loop_var": "item", "changed": false, "item": "/etc/kubernetes/controller-manager.conf", "msg": "Path /etc/kubernetes/controller-manager.conf does not exist !", "rc": 257}
2026-04-25 08:37:57.276652 | instance | [kubernetes/kubernetes] failed: [instance] (item=/etc/kubernetes/scheduler.conf) => {"ansible_loop_var": "item", "changed": false, "item": "/etc/kubernetes/scheduler.conf", "msg": "Path /etc/kubernetes/scheduler.conf does not exist !", "rc": 257}
2026-04-25 08:37:57.276663 | instance | [kubernetes/kubernetes] ...ignoring
2026-04-25 08:37:57.276673 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:57.276684 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kube_vip : Check if super-admin.conf exists] *********
2026-04-25 08:37:57.575124 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:57.575195 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:57.575208 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kube_vip : Check if kubeadm has already run] *********
2026-04-25 08:37:57.860286 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:57.860609 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:57.860623 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kube_vip : Set fact with KUBECONFIG path] ************
2026-04-25 08:37:57.896590 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:57.896632 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:57.896644 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kube_vip : Set fact with KUBECONFIG path (with super-admin.conf)] ***
2026-04-25 08:37:57.934616 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:57.934653 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:57.934665 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kube_vip : Upload Kubernetes manifest] ***************
2026-04-25 08:37:58.606199 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:58.606262 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:58.606274 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kube_vip : Ensure kube-vip configuration file] *******
2026-04-25 08:37:58.967765 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:58.967832 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:58.967844 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kube_vip : Flush handlers] ***************************
2026-04-25 08:37:58.967854 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:58.967863 | instance | [kubernetes/kubernetes] PLAY [Install Kubernetes] ******************************************************
2026-04-25 08:37:58.967873 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:58.967883 | instance | [kubernetes/kubernetes] TASK [Gathering Facts] *********************************************************
2026-04-25 08:37:59.343714 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:37:59.343771 | instance | [ceph/ceph]
2026-04-25 08:37:59.343783 | instance | [ceph/ceph] TASK [vexxhost.containers.containerd : Create systemd service file for containerd] ***
2026-04-25 08:37:59.987493 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:37:59.987548 | instance | [kubernetes/kubernetes]
2026-04-25 08:37:59.987557 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-04-25 08:38:00.063544 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:00.063618 | instance | [ceph/ceph]
2026-04-25 08:38:00.063633 | instance | [ceph/ceph] TASK [vexxhost.containers.containerd : Create folders for configuration] *******
2026-04-25 08:38:00.300559 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:00.300609 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:00.300615 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.package : Update state for tar] **********************
2026-04-25 08:38:00.350222 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:00.350261 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:00.350267 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads)] ***
2026-04-25 08:38:00.725375 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:00.725423 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:00.725431 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-04-25 08:38:00.783246 | instance | [kubernetes/kubernetes] ok: [instance] => {
2026-04-25 08:38:00.783299 | instance | [kubernetes/kubernetes]     "msg": "https://github.com/opencontainers/runc/releases/download/v1.4.2/runc.amd64"
2026-04-25 08:38:00.783312 | instance | [kubernetes/kubernetes] }
2026-04-25 08:38:00.783324 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:00.783334 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-04-25 08:38:01.302970 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:01.303025 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:01.303038 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-04-25 08:38:01.347797 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:01.347834 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:01.347840 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-04-25 08:38:01.475469 | instance | [ceph/ceph] changed: [instance] => (item={'path': '/etc/containerd'})
2026-04-25 08:38:01.475534 | instance | [ceph/ceph] changed: [instance] => (item={'path': '/var/lib/containerd', 'mode': '0o700'})
2026-04-25 08:38:01.475546 | instance | [ceph/ceph] changed: [instance] => (item={'path': '/run/containerd', 'mode': '0o711'})
2026-04-25 08:38:01.475562 | instance | [ceph/ceph] changed: [instance] => (item={'path': '/run/containerd/io.containerd.grpc.v1.cri', 'mode': '0o700'})
2026-04-25 08:38:01.475573 | instance | [ceph/ceph] changed: [instance] => (item={'path': '/run/containerd/io.containerd.sandbox.controller.v1.shim', 'mode': '0o700'})
2026-04-25 08:38:01.475583 | instance | [ceph/ceph]
2026-04-25 08:38:01.475592 | instance | [ceph/ceph] TASK [vexxhost.containers.containerd : Create containerd config file] **********
2026-04-25 08:38:01.661829 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:01.661877 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:01.661889 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.package : Update state for tar] **********************
2026-04-25 08:38:02.130081 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:02.130150 | instance | [ceph/ceph]
2026-04-25 08:38:02.130162 | instance | [ceph/ceph] TASK [vexxhost.containers.containerd : Force any restarts if necessary] ********
2026-04-25 08:38:02.130172 | instance | [ceph/ceph]
2026-04-25 08:38:02.130182 | instance | [ceph/ceph] RUNNING HANDLER [vexxhost.containers.containerd : Reload systemd] **************
2026-04-25 08:38:03.004306 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:03.004351 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:03.004369 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-04-25 08:38:03.063498 | instance | [kubernetes/kubernetes] ok: [instance] => {
2026-04-25 08:38:03.063529 | instance | [kubernetes/kubernetes]     "msg": "https://github.com/containerd/containerd/releases/download/v2.2.3/containerd-2.2.3-linux-amd64.tar.gz"
2026-04-25 08:38:03.063539 | instance | [kubernetes/kubernetes] }
2026-04-25 08:38:03.063549 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:03.063559 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-04-25 08:38:03.111190 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:38:03.111224 | instance | [ceph/ceph]
2026-04-25 08:38:03.111235 | instance | [ceph/ceph] RUNNING HANDLER [vexxhost.containers.containerd : Restart containerd] **********
2026-04-25 08:38:03.541688 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:03.541752 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:03.541766 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-04-25 08:38:03.706961 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:03.707019 | instance | [ceph/ceph]
2026-04-25 08:38:03.707031 | instance | [ceph/ceph] TASK [vexxhost.containers.containerd : Enable and start service] ***************
2026-04-25 08:38:04.361879 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:04.361944 | instance | [ceph/ceph]
2026-04-25 08:38:04.361956 | instance | [ceph/ceph] TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-04-25 08:38:04.695298 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:38:04.695475 | instance | [ceph/ceph]
2026-04-25 08:38:04.695482 | instance | [ceph/ceph] TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-04-25 08:38:04.756642 | instance | [ceph/ceph] ok: [instance] => {
2026-04-25 08:38:04.756667 | instance | [ceph/ceph]     "msg": "https://download.docker.com/linux/static/stable/x86_64/docker-24.0.9.tgz"
2026-04-25 08:38:04.756673 | instance | [ceph/ceph] }
2026-04-25 08:38:04.756678 | instance | [ceph/ceph]
2026-04-25 08:38:04.756682 | instance | [ceph/ceph] TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-04-25 08:38:05.663947 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:05.664002 | instance | [ceph/ceph]
2026-04-25 08:38:05.664009 | instance | [ceph/ceph] TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-04-25 08:38:05.738643 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:05.738686 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:05.738698 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Install SELinux packages] ***************
2026-04-25 08:38:05.769840 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:05.769939 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:05.769953 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Set SELinux to permissive at runtime] ***
2026-04-25 08:38:05.804165 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:05.804204 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:05.804216 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Persist SELinux permissive mode] ********
2026-04-25 08:38:05.835745 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:05.835773 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:05.835781 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Install AppArmor packages] **************
2026-04-25 08:38:06.900385 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:06.900432 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:06.900441 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Create systemd service file for containerd] ***
2026-04-25 08:38:07.428933 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:07.428973 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:07.428982 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Create folders for configuration] *******
2026-04-25 08:38:08.924717 | instance | [kubernetes/kubernetes] ok: [instance] => (item={'path': '/etc/containerd'})
2026-04-25 08:38:08.924799 | instance | [kubernetes/kubernetes] ok: [instance] => (item={'path': '/var/lib/containerd', 'mode': '0o700'})
2026-04-25 08:38:08.924811 | instance | [kubernetes/kubernetes] ok: [instance] => (item={'path': '/run/containerd', 'mode': '0o711'})
2026-04-25 08:38:08.924821 | instance | [kubernetes/kubernetes] ok: [instance] => (item={'path': '/run/containerd/io.containerd.grpc.v1.cri', 'mode': '0o700'})
2026-04-25 08:38:08.924831 | instance | [kubernetes/kubernetes] ok: [instance] => (item={'path': '/run/containerd/io.containerd.sandbox.controller.v1.shim', 'mode': '0o700'})
2026-04-25 08:38:08.924841 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:08.924851 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Create containerd config file] **********
2026-04-25 08:38:09.588702 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:09.588758 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:09.588771 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Force any restarts if necessary] ********
2026-04-25 08:38:09.588781 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:09.588790 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Enable and start service] ***************
2026-04-25 08:38:10.258837 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:10.258895 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:10.258908 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kubernetes_upgrade_check : Retrieve the "kubeadm-config" ConfigMap] ***
2026-04-25 08:38:11.077426 | instance | [kubernetes/kubernetes] An exception occurred during task execution. To see the full traceback, use -vvv. The error was: ansible_collections.kubernetes.core.plugins.module_utils.k8s.exceptions.CoreException: Could not create API client: Invalid kube-config file. No configuration found.
2026-04-25 08:38:11.077490 | instance | [kubernetes/kubernetes] fatal: [instance]: FAILED! => {"changed": false, "msg": "Could not create API client: Invalid kube-config file. No configuration found."}
2026-04-25 08:38:11.077503 | instance | [kubernetes/kubernetes] ...ignoring
2026-04-25 08:38:11.077514 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:11.077525 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kubernetes_upgrade_check : Parse the ClusterConfiguration] ***
2026-04-25 08:38:11.115803 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:11.115826 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:11.115833 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kubernetes_upgrade_check : Retrieve the current Kubernetes version] ***
2026-04-25 08:38:11.132779 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:11.132799 | instance | [ceph/ceph]
2026-04-25 08:38:11.132809 | instance | [ceph/ceph] TASK [vexxhost.containers.docker : Install AppArmor packages] ******************
2026-04-25 08:38:11.148067 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:11.148084 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:11.148093 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kubernetes_upgrade_check : Extract major, minor, and patch versions] ***
2026-04-25 08:38:11.186116 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:11.186139 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:11.186147 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kubernetes_upgrade_check : Fail if we're jumping more than one minor version] ***
2026-04-25 08:38:11.227554 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:11.227576 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:11.227584 | instance | [kubernetes/kubernetes] TASK [vexxhost.kubernetes.kubernetes_upgrade_check : Set fact if we need to upgrade] ***
2026-04-25 08:38:11.273426 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:11.273462 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:11.273473 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-04-25 08:38:11.591936 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:11.591985 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:11.591991 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-04-25 08:38:11.649013 | instance | [kubernetes/kubernetes] ok: [instance] => {
2026-04-25 08:38:11.649026 | instance | [kubernetes/kubernetes]     "msg": "https://dl.k8s.io/release/v1.28.13/bin/linux/amd64/kubeadm"
2026-04-25 08:38:11.649031 | instance | [kubernetes/kubernetes] }
2026-04-25 08:38:11.649035 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:11.649039 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-04-25 08:38:12.218816 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:38:12.218876 | instance | [ceph/ceph]
2026-04-25 08:38:12.218889 | instance | [ceph/ceph] TASK [vexxhost.containers.docker : Ensure group "docker" exists] ***************
2026-04-25 08:38:12.461252 | instance | [kubernetes/kubernetes] changed: [instance]
2026-04-25 08:38:12.461298 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:12.461311 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-04-25 08:38:12.508173 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:12.508207 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:12.508218 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-04-25 08:38:12.671705 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:12.671745 | instance | [ceph/ceph]
2026-04-25 08:38:12.671757 | instance | [ceph/ceph] TASK [vexxhost.containers.docker : Create systemd service file for docker] *****
2026-04-25 08:38:12.820220 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:12.820256 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:12.820277 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-04-25 08:38:12.856170 | instance | [kubernetes/kubernetes] ok: [instance] => {
2026-04-25 08:38:12.856203 | instance | [kubernetes/kubernetes]     "msg": "https://dl.k8s.io/release/v1.28.13/bin/linux/amd64/kubectl"
2026-04-25 08:38:12.856208 | instance | [kubernetes/kubernetes] }
2026-04-25 08:38:12.856213 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:12.856218 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-04-25 08:38:13.223620 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:13.223670 | instance | [ceph/ceph]
2026-04-25 08:38:13.223683 | instance | [ceph/ceph] TASK [vexxhost.containers.docker : Create folders for configuration] ***********
2026-04-25 08:38:14.071235 | instance | [ceph/ceph] changed: [instance] => (item={'path': '/etc/docker'})
2026-04-25 08:38:14.071297 | instance | [ceph/ceph] changed: [instance] => (item={'path': '/var/lib/docker', 'mode': '0o710'})
2026-04-25 08:38:14.071310 | instance | [ceph/ceph] changed: [instance] => (item={'path': '/run/docker', 'mode': '0o711'})
2026-04-25 08:38:14.071320 | instance | [ceph/ceph]
2026-04-25 08:38:14.071329 | instance | [ceph/ceph] TASK [vexxhost.containers.docker : Create systemd socket file for docker] ******
2026-04-25 08:38:14.346065 | instance | [kubernetes/kubernetes] changed: [instance]
2026-04-25 08:38:14.346117 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:14.346129 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-04-25 08:38:14.387471 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:14.387503 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:14.387514 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Install SELinux packages] ***************
2026-04-25 08:38:14.419192 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:14.419228 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:14.419240 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Set SELinux to permissive at runtime] ***
2026-04-25 08:38:14.447165 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:14.447197 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:14.447206 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Persist SELinux permissive mode] ********
2026-04-25 08:38:14.476668 | instance | [kubernetes/kubernetes] skipping: [instance]
2026-04-25 08:38:14.476687 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:14.476693 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Install AppArmor packages] **************
2026-04-25 08:38:14.604901 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:14.604943 | instance | [ceph/ceph]
2026-04-25 08:38:14.604951 | instance | [ceph/ceph] TASK [vexxhost.containers.docker : Create docker daemon config file] ***********
2026-04-25 08:38:15.169284 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:15.169339 | instance | [ceph/ceph]
2026-04-25 08:38:15.169351 | instance | [ceph/ceph] TASK [vexxhost.containers.docker : Force any restarts if necessary] ************
2026-04-25 08:38:15.169362 | instance | [ceph/ceph]
2026-04-25 08:38:15.169371 | instance | [ceph/ceph] RUNNING HANDLER [vexxhost.containers.containerd : Reload systemd] **************
2026-04-25 08:38:15.526790 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:15.527012 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:15.527021 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Create systemd service file for containerd] ***
2026-04-25 08:38:15.961497 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:38:15.961569 | instance | [ceph/ceph]
2026-04-25 08:38:15.961582 | instance | [ceph/ceph] RUNNING HANDLER [vexxhost.containers.docker : Restart docker] ******************
2026-04-25 08:38:16.067510 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:16.067551 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:16.067564 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Create folders for configuration] *******
2026-04-25 08:38:17.093356 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:17.093430 | instance | [ceph/ceph]
2026-04-25 08:38:17.093454 | instance | [ceph/ceph] TASK [vexxhost.containers.docker : Enable and start service] *******************
2026-04-25 08:38:17.530323 | instance | [kubernetes/kubernetes] ok: [instance] => (item={'path': '/etc/containerd'})
2026-04-25 08:38:17.530418 | instance | [kubernetes/kubernetes] ok: [instance] => (item={'path': '/var/lib/containerd', 'mode': '0o700'})
2026-04-25 08:38:17.530434 | instance | [kubernetes/kubernetes] ok: [instance] => (item={'path': '/run/containerd', 'mode': '0o711'})
2026-04-25 08:38:17.530445 | instance | [kubernetes/kubernetes] ok: [instance] => (item={'path': '/run/containerd/io.containerd.grpc.v1.cri', 'mode': '0o700'})
2026-04-25 08:38:17.530456 | instance | [kubernetes/kubernetes] ok: [instance] => (item={'path': '/run/containerd/io.containerd.sandbox.controller.v1.shim', 'mode': '0o700'})
2026-04-25 08:38:17.530468 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:17.530480 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Create containerd config file] **********
2026-04-25 08:38:17.791518 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:17.791605 | instance | [ceph/ceph]
2026-04-25 08:38:17.791622 | instance | [ceph/ceph] TASK [vexxhost.ceph.cephadm : Gather variables for each operating system] ******
2026-04-25 08:38:17.850005 | instance | [ceph/ceph] ok: [instance] => (item=/home/zuul/.ansible/collections/ansible_collections/vexxhost/ceph/roles/cephadm/vars/ubuntu-22.04.yml)
2026-04-25 08:38:17.850076 | instance | [ceph/ceph]
2026-04-25 08:38:17.850089 | instance | [ceph/ceph] TASK [vexxhost.ceph.cephadm : Install packages] ********************************
2026-04-25 08:38:18.188021 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:18.188096 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:18.188110 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Force any restarts if necessary] ********
2026-04-25 08:38:18.188121 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:18.188130 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.containerd : Enable and start service] ***************
2026-04-25 08:38:18.635263 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:18.635349 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:18.635359 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.forget_package : Forget package] *********************
2026-04-25 08:38:18.944871 | instance | [kubernetes/kubernetes] ok: [instance]
2026-04-25 08:38:18.944958 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:18.944972 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-04-25 08:38:18.996938 | instance | [kubernetes/kubernetes] ok: [instance] => {
2026-04-25 08:38:18.997053 | instance | [kubernetes/kubernetes]     "msg": "https://github.com/kubernetes-sigs/cri-tools/releases/download/v1.35.0/crictl-v1.35.0-linux-amd64.tar.gz"
2026-04-25 08:38:18.997097 | instance | [kubernetes/kubernetes] }
2026-04-25 08:38:18.997105 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:18.997112 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-04-25 08:38:19.632036 | instance | [kubernetes/kubernetes] changed: [instance]
2026-04-25 08:38:19.632117 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:19.632131 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Extract archive] *****************
2026-04-25 08:38:21.160885 | instance | [kubernetes/kubernetes] changed: [instance]
2026-04-25 08:38:21.160941 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:21.160948 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Starting download of file] *******
2026-04-25 08:38:21.214555 | instance | [kubernetes/kubernetes] ok: [instance] => {
2026-04-25 08:38:21.214575 | instance | [kubernetes/kubernetes]     "msg": "https://github.com/kubernetes-sigs/cri-tools/releases/download/v1.35.0/critest-v1.35.0-linux-amd64.tar.gz"
2026-04-25 08:38:21.214582 | instance | [kubernetes/kubernetes] }
2026-04-25 08:38:21.214586 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:21.214594 | instance | [kubernetes/kubernetes] TASK [vexxhost.containers.download_artifact : Download item] *******************
2026-04-25 08:38:22.750670 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:22.750738 | instance | [ceph/ceph]
2026-04-25 08:38:22.750750 | instance | [ceph/ceph] TASK [vexxhost.ceph.cephadm : Ensure services are started] *********************
2026-04-25 08:38:23.650826 | instance | [ceph/ceph] ok: [instance] => (item=chronyd)
2026-04-25 08:38:23.650886 | instance | [ceph/ceph] ok: [instance] => (item=sshd)
2026-04-25 08:38:23.650898 | instance | [ceph/ceph]
2026-04-25 08:38:23.650907 | instance | [ceph/ceph] TASK [vexxhost.ceph.cephadm : Download "cephadm"] ******************************
2026-04-25 08:38:24.341981 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:24.342090 | instance | [ceph/ceph]
2026-04-25 08:38:24.342103 | instance | [ceph/ceph] TASK [vexxhost.ceph.cephadm : Remove cephadm from old path] ********************
2026-04-25 08:38:24.659240 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:38:24.659334 | instance | [ceph/ceph]
2026-04-25 08:38:24.659347 | instance | [ceph/ceph] TASK [vexxhost.ceph.cephadm : Ensure "cephadm" user is present] ****************
2026-04-25 08:38:25.198854 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:25.198912 | instance | [ceph/ceph]
2026-04-25 08:38:25.198925 | instance | [ceph/ceph] TASK [vexxhost.ceph.cephadm : Allow "cephadm" user to have passwordless sudo] ***
2026-04-25 08:38:25.628938 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:25.629001 | instance | [ceph/ceph]
2026-04-25 08:38:25.629013 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Get `cephadm ls` status] *****************************
2026-04-25 08:38:27.349679 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:38:27.349888 | instance | [ceph/ceph]
2026-04-25 08:38:27.349902 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Parse the `cephadm ls` output] ***********************
2026-04-25 08:38:27.400727 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:38:27.400757 | instance | [ceph/ceph]
2026-04-25 08:38:27.400768 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Assimilate existing configs in `ceph.conf`] **********
2026-04-25 08:38:27.438586 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:38:27.438629 | instance | [ceph/ceph]
2026-04-25 08:38:27.438641 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Adopt monitor to cluster] ****************************
2026-04-25 08:38:27.473710 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:38:27.473741 | instance | [ceph/ceph]
2026-04-25 08:38:27.473752 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Adopt manager to cluster] ****************************
2026-04-25 08:38:27.511327 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:38:27.511350 | instance | [ceph/ceph]
2026-04-25 08:38:27.511356 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Enable "cephadm" mgr module] *************************
2026-04-25 08:38:27.550152 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:38:27.550190 | instance | [ceph/ceph]
2026-04-25 08:38:27.550198 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Set orchestrator backend to "cephadm"] ***************
2026-04-25 08:38:27.614886 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:38:27.614921 | instance | [ceph/ceph]
2026-04-25 08:38:27.614933 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Use `cephadm` user for cephadm] **********************
2026-04-25 08:38:27.654146 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:38:27.654188 | instance | [ceph/ceph]
2026-04-25 08:38:27.654200 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Generate "cephadm" key] ******************************
2026-04-25 08:38:27.689267 | instance | [ceph/ceph] skipping: [instance]
2026-04-25 08:38:27.689311 | instance | [ceph/ceph]
2026-04-25 08:38:27.689322 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Set Ceph Monitor IP address] *************************
2026-04-25 08:38:27.805188 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:38:27.805222 | instance | [ceph/ceph]
2026-04-25 08:38:27.805234 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Check if any node is bootstrapped] *******************
2026-04-25 08:38:28.137981 | instance | [ceph/ceph] ok: [instance] => (item=instance)
2026-04-25 08:38:28.138020 | instance | [ceph/ceph]
2026-04-25 08:38:28.138026 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Select pre-existing bootstrap node if exists] ********
2026-04-25 08:38:28.192877 | instance | [ceph/ceph] ok: [instance]
2026-04-25 08:38:28.192915 | instance | [ceph/ceph]
2026-04-25 08:38:28.192921 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Bootstrap cluster] ***********************************
2026-04-25 08:38:28.265849 | instance | [ceph/ceph] included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/ceph/roles/mon/tasks/bootstrap-ceph.yml for instance
2026-04-25 08:38:28.265894 | instance | [ceph/ceph]
2026-04-25 08:38:28.265899 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Generate temporary file for "ceph.conf"] *************
2026-04-25 08:38:28.684426 | instance | [ceph/ceph] changed: [instance]
2026-04-25 08:38:28.684466 | instance | [ceph/ceph]
2026-04-25 08:38:28.684474 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Include extra configuration values] ******************
2026-04-25 08:38:29.677318 | instance | [ceph/ceph] changed: [instance] => (item={'option': 'mon allow pool size one', 'section': 'global', 'value': True})
2026-04-25 08:38:29.677355 | instance | [ceph/ceph] changed: [instance] => (item={'option': 'osd crush chooseleaf type', 'section': 'global', 'value': 0})
2026-04-25 08:38:29.677361 | instance | [ceph/ceph] changed: [instance] => (item={'option': 'auth allow insecure global id reclaim', 'section': 'mon', 'value': False})
2026-04-25 08:38:29.677366 | instance | [ceph/ceph]
2026-04-25 08:38:29.677371 | instance | [ceph/ceph] TASK [vexxhost.ceph.mon : Run Bootstrap coomand] *******************************
2026-04-25 08:38:43.413832 | instance | [kubernetes/kubernetes] FAILED - RETRYING: [instance]: Download item (4 retries left).
2026-04-25 08:38:43.413904 | instance | [kubernetes/kubernetes] FAILED - RETRYING: [instance]: Download item (3 retries left).
2026-04-25 08:38:43.413917 | instance | [kubernetes/kubernetes] FAILED - RETRYING: [instance]: Download item (2 retries left).
2026-04-25 08:38:43.413928 | instance | [kubernetes/kubernetes] FAILED - RETRYING: [instance]: Download item (1 retries left).
2026-04-25 08:38:43.413945 | instance | [kubernetes/kubernetes] fatal: [instance]: FAILED! => {"attempts": 4, "censored": "the output has been hidden due to the fact that 'no_log: true' was specified for this result", "changed": false}
2026-04-25 08:38:43.413958 | instance | [kubernetes/kubernetes]
2026-04-25 08:38:43.413970 | instance | [kubernetes/kubernetes] PLAY RECAP *********************************************************************
2026-04-25 08:38:43.413986 | instance | [kubernetes/kubernetes] instance                   : ok=48   changed=8    unreachable=0    failed=1    skipped=15   rescued=0    ignored=2
2026-04-25 08:38:43.413997 | instance | [kubernetes/kubernetes]
2026-04-25 08:39:58.003744 | instance | Error: component kubernetes failed: ansible-playbook failed for kubernetes/kubernetes: exit status 2
2026-04-25 08:39:58.003837 | instance | Usage:
2026-04-25 08:39:58.003853 | instance |   atmosphere deploy [flags]
2026-04-25 08:39:58.003867 | instance |
2026-04-25 08:39:58.003880 | instance | Flags:
2026-04-25 08:39:58.003893 | instance |       --concurrency int    Max concurrent deployments per wave (0 = unlimited)
2026-04-25 08:39:58.003905 | instance |   -h, --help               help for deploy
2026-04-25 08:39:58.003934 | instance |   -i, --inventory string   Path to Ansible inventory file (required)
2026-04-25 08:39:58.003947 | instance |   -t, --tags string        Comma-separated list of component tags to deploy
2026-04-25 08:39:58.003960 | instance |
2026-04-25 08:39:58.004009 | instance | component kubernetes failed: ansible-playbook failed for kubernetes/kubernetes: exit status 2
2026-04-25 08:39:58.323097 | instance | ERROR
2026-04-25 08:39:58.323394 | instance | {
2026-04-25 08:39:58.323448 | instance |   "delta": "0:02:16.192466",
2026-04-25 08:39:58.323488 | instance |   "end": "2026-04-25 08:39:58.005505",
2026-04-25 08:39:58.323516 | instance |   "msg": "non-zero return code",
2026-04-25 08:39:58.323541 | instance |   "rc": 1,
2026-04-25 08:39:58.323566 | instance |   "start": "2026-04-25 08:37:41.813039"
2026-04-25 08:39:58.323594 | instance | }
failure
2026-04-25 08:39:58.330630 | 
2026-04-25 08:39:58.330684 | PLAY RECAP
2026-04-25 08:39:58.330727 | instance | ok: 1 changed: 0 unreachable: 0 failed: 1 skipped: 0 rescued: 0 ignored: 0
2026-04-25 08:39:58.330749 | 
2026-04-25 08:39:58.455551 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere/molecule/csi/converge.yml@main]
2026-04-25 08:39:58.458381 | POST-RUN START: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/post.yml@main]
2026-04-25 08:39:59.054520 | 
2026-04-25 08:39:59.054647 | PLAY [all]
2026-04-25 08:39:59.068614 | 
2026-04-25 08:39:59.068692 | TASK [gather-host-logs : creating directory for system status]
2026-04-25 08:39:59.428239 | instance | changed
2026-04-25 08:39:59.436606 | 
2026-04-25 08:39:59.436719 | TASK [gather-host-logs : Get logs for each host]
2026-04-25 08:39:59.785635 | instance | + systemd-cgls --full --all --no-pager
2026-04-25 08:39:59.799858 | instance | + ip addr
2026-04-25 08:39:59.801588 | instance | + ip route
2026-04-25 08:39:59.804604 | instance | + lsblk
2026-04-25 08:39:59.810053 | instance | + mount
2026-04-25 08:39:59.812854 | instance | + docker images
2026-04-25 08:39:59.833336 | instance | + brctl show
2026-04-25 08:39:59.833831 | instance | /bin/bash: line 8: brctl: command not found
2026-04-25 08:39:59.834094 | instance | + ps aux --sort=-%mem
2026-04-25 08:39:59.849892 | instance | + dpkg -l
2026-04-25 08:39:59.863174 | instance | + CONTAINERS=($(docker ps -a --format '{{ .Names }}' --filter label=zuul))
2026-04-25 08:39:59.863738 | instance | ++ docker ps -a --format '{{ .Names }}' --filter label=zuul
2026-04-25 08:39:59.883354 | instance | + '[' '!' -z '' ']'
2026-04-25 08:39:59.974606 | instance | ok: Runtime: 0:00:00.104291
2026-04-25 08:39:59.981704 | 
2026-04-25 08:39:59.981776 | TASK [gather-host-logs : Downloads logs to executor]
2026-04-25 08:40:00.619883 | instance | changed:
2026-04-25 08:40:00.620098 | instance | created directory /var/lib/zuul/builds/d7ed201c69e94217a0409ade646dbc4f/work/logs/instance
2026-04-25 08:40:00.620125 | instance | cd+++++++++ system/
2026-04-25 08:40:00.620146 | instance | >f+++++++++ system/brctl-show.txt
2026-04-25 08:40:00.620166 | instance | >f+++++++++ system/docker-images.txt
2026-04-25 08:40:00.620185 | instance | >f+++++++++ system/ip-addr.txt
2026-04-25 08:40:00.620206 | instance | >f+++++++++ system/ip-route.txt
2026-04-25 08:40:00.620225 | instance | >f+++++++++ system/lsblk.txt
2026-04-25 08:40:00.620244 | instance | >f+++++++++ system/mount.txt
2026-04-25 08:40:00.620263 | instance | >f+++++++++ system/packages.txt
2026-04-25 08:40:00.620281 | instance | >f+++++++++ system/ps.txt
2026-04-25 08:40:00.620301 | instance | >f+++++++++ system/systemd-cgls.txt
2026-04-25 08:40:00.629733 | 
2026-04-25 08:40:00.629798 | LOOP [helm-release-status : creating directory for helm release status]
2026-04-25 08:40:00.823478 | instance | changed: "values"
2026-04-25 08:40:00.986320 | instance | changed: "releases"
2026-04-25 08:40:01.006294 | 
2026-04-25 08:40:01.006504 | TASK [helm-release-status : Gather get release status for helm charts]
2026-04-25 08:40:01.265426 | instance | E0425 08:40:01.265239   21568 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:01.266155 | instance | E0425 08:40:01.266115   21568 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:01.268399 | instance | E0425 08:40:01.268344   21568 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:01.268890 | instance | E0425 08:40:01.268855   21568 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:01.270507 | instance | E0425 08:40:01.270451   21568 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:01.270566 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:01.545997 | instance | ok: Runtime: 0:00:00.067239
2026-04-25 08:40:01.552068 | 
2026-04-25 08:40:01.552144 | TASK [helm-release-status : Downloads logs to executor]
2026-04-25 08:40:02.672401 | instance | changed:
2026-04-25 08:40:02.672620 | instance | cd+++++++++ helm/
2026-04-25 08:40:02.672656 | instance | cd+++++++++ helm/releases/
2026-04-25 08:40:02.672684 | instance | cd+++++++++ helm/values/
2026-04-25 08:40:02.684049 | 
2026-04-25 08:40:02.684113 | TASK [describe-kubernetes-objects : creating directory for cluster scoped objects]
2026-04-25 08:40:02.882986 | instance | changed
2026-04-25 08:40:02.887880 | 
2026-04-25 08:40:02.887952 | TASK [describe-kubernetes-objects : Gathering descriptions for cluster scoped objects]
2026-04-25 08:40:03.116120 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-04-25 08:40:03.116242 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-04-25 08:40:03.123086 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-04-25 08:40:03.125901 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-04-25 08:40:03.173336 | instance | E0425 08:40:03.173232   21692 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.174073 | instance | E0425 08:40:03.174007   21692 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.176003 | instance | E0425 08:40:03.175626   21692 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.176487 | instance | E0425 08:40:03.176438   21692 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.178323 | instance | E0425 08:40:03.178215   21692 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.178389 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:03.180869 | instance | E0425 08:40:03.180615   21702 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.181424 | instance | E0425 08:40:03.181384   21702 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.183049 | instance | E0425 08:40:03.183020   21702 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.183608 | instance | E0425 08:40:03.183491   21702 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.185091 | instance | E0425 08:40:03.185049   21702 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.185200 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:03.188939 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-04-25 08:40:03.192201 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-04-25 08:40:03.243387 | instance | E0425 08:40:03.243286   21734 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.243862 | instance | E0425 08:40:03.243796   21731 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.247361 | instance | E0425 08:40:03.247328   21731 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.247668 | instance | E0425 08:40:03.247641   21731 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.248102 | instance | E0425 08:40:03.248065   21734 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.249162 | instance | E0425 08:40:03.249062   21734 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.249244 | instance | E0425 08:40:03.249107   21731 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.249747 | instance | E0425 08:40:03.249597   21731 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.249793 | instance | E0425 08:40:03.249772   21734 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.250880 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:03.251565 | instance | E0425 08:40:03.251528   21734 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.251590 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:03.257758 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-04-25 08:40:03.310063 | instance | E0425 08:40:03.309949   21784 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.310340 | instance | E0425 08:40:03.310309   21784 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.312066 | instance | E0425 08:40:03.312032   21784 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.312346 | instance | E0425 08:40:03.312316   21784 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.313731 | instance | E0425 08:40:03.313700   21784 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.313745 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:03.425667 | instance | ok: Runtime: 0:00:00.210626
2026-04-25 08:40:03.432757 | 
2026-04-25 08:40:03.432841 | TASK [describe-kubernetes-objects : creating directory for namespace scoped objects]
2026-04-25 08:40:03.638711 | instance | changed
2026-04-25 08:40:03.647410 | 
2026-04-25 08:40:03.647504 | TASK [describe-kubernetes-objects : Gathering descriptions for namespace scoped objects]
2026-04-25 08:40:03.905360 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-04-25 08:40:03.905471 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-04-25 08:40:03.905906 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-04-25 08:40:03.956064 | instance | E0425 08:40:03.955789   22763 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.957581 | instance | E0425 08:40:03.957526   22763 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.958392 | instance | E0425 08:40:03.958362   22763 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.960501 | instance | E0425 08:40:03.960451   22763 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.961147 | instance | E0425 08:40:03.961123   22763 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:03.962326 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:04.223010 | instance | ok: Runtime: 0:00:00.067532
2026-04-25 08:40:04.231273 | 
2026-04-25 08:40:04.231397 | TASK [describe-kubernetes-objects : Downloads logs to executor]
2026-04-25 08:40:04.755000 | instance | changed:
2026-04-25 08:40:04.755301 | instance | cd+++++++++ objects/
2026-04-25 08:40:04.755360 | instance | cd+++++++++ objects/cluster/
2026-04-25 08:40:04.755406 | instance | cd+++++++++ objects/namespaced/
2026-04-25 08:40:04.769048 | 
2026-04-25 08:40:04.769164 | TASK [gather-pod-logs : creating directory for pod logs]
2026-04-25 08:40:04.966920 | instance | changed
2026-04-25 08:40:04.972118 | 
2026-04-25 08:40:04.972188 | TASK [gather-pod-logs : creating directory for failed pod logs]
2026-04-25 08:40:05.183304 | instance | changed
2026-04-25 08:40:05.191064 | 
2026-04-25 08:40:05.191156 | TASK [gather-pod-logs : retrieve all kubernetes logs, current and previous (if they exist)]
2026-04-25 08:40:05.478612 | instance | E0425 08:40:05.478491   23078 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:05.479248 | instance | E0425 08:40:05.479206   23078 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:05.481562 | instance | E0425 08:40:05.481524   23078 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:05.482193 | instance | E0425 08:40:05.482162   23078 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:05.484024 | instance | E0425 08:40:05.483950   23078 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:05.484064 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:05.726868 | instance | ok: Runtime: 0:00:00.085876
2026-04-25 08:40:05.734181 | 
2026-04-25 08:40:05.734250 | TASK [gather-pod-logs : Downloads pod logs to executor]
2026-04-25 08:40:06.624249 | instance | changed:
2026-04-25 08:40:06.624411 | instance | cd+++++++++ pod-logs/
2026-04-25 08:40:06.624439 | instance | cd+++++++++ pod-logs/failed-pods/
2026-04-25 08:40:06.634151 | 
2026-04-25 08:40:06.634215 | TASK [gather-prom-metrics : creating directory for helm release descriptions]
2026-04-25 08:40:06.834604 | instance | changed
2026-04-25 08:40:06.841572 | 
2026-04-25 08:40:06.841663 | TASK [gather-prom-metrics : Get metrics from exporter services in all namespaces]
2026-04-25 08:40:07.123496 | instance | E0425 08:40:07.123335   23399 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:07.124168 | instance | E0425 08:40:07.124141   23399 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:07.125932 | instance | E0425 08:40:07.125905   23399 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:07.126462 | instance | E0425 08:40:07.126445   23399 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:07.127919 | instance | E0425 08:40:07.127904   23399 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:07.127997 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:07.377978 | instance | ok: Runtime: 0:00:00.085756
2026-04-25 08:40:07.383551 | 
2026-04-25 08:40:07.383626 | TASK [gather-prom-metrics : Get ceph metrics from ceph-mgr]
2026-04-25 08:40:07.637812 | instance | E0425 08:40:07.637611   23421 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:07.638559 | instance | E0425 08:40:07.638501   23421 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:07.640567 | instance | E0425 08:40:07.640525   23421 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:07.641155 | instance | E0425 08:40:07.641114   23421 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:07.642934 | instance | E0425 08:40:07.642897   23421 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:07.642959 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:07.645803 | instance | ceph-mgr endpoints:
2026-04-25 08:40:07.922664 | instance | ok: Runtime: 0:00:00.065993
2026-04-25 08:40:07.930480 | 
2026-04-25 08:40:07.930579 | TASK [gather-prom-metrics : Get metrics from fluentd pods]
2026-04-25 08:40:08.186918 | instance | E0425 08:40:08.186762   23444 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:08.187245 | instance | E0425 08:40:08.187193   23444 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:08.189094 | instance | E0425 08:40:08.189031   23444 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:08.189398 | instance | E0425 08:40:08.189363   23444 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:08.190678 | instance | E0425 08:40:08.190647   23444 memcache.go:265] couldn't get current server API group list: Get "http://localhost:8080/api?timeout=32s": dial tcp [::1]:8080: connect: connection refused
2026-04-25 08:40:08.190709 | instance | The connection to the server localhost:8080 was refused - did you specify the right host or port?
2026-04-25 08:40:08.474517 | instance | ok: Runtime: 0:00:00.063913
2026-04-25 08:40:08.482463 | 
2026-04-25 08:40:08.482557 | TASK [gather-prom-metrics : Downloads logs to executor]
2026-04-25 08:40:08.978118 | instance | changed: cd+++++++++ prometheus/
2026-04-25 08:40:08.987986 | 
2026-04-25 08:40:08.988049 | TASK [gather-selenium-data : creating directory for helm release descriptions]
2026-04-25 08:40:09.180819 | instance | changed
2026-04-25 08:40:09.186741 | 
2026-04-25 08:40:09.186803 | TASK [gather-selenium-data : Get selenium data]
2026-04-25 08:40:09.389587 | instance | + cp '/tmp/artifacts/*' /tmp/logs/selenium/.
2026-04-25 08:40:09.391447 | instance | cp: cannot stat '/tmp/artifacts/*': No such file or directory
2026-04-25 08:40:09.720696 | instance | ERROR
2026-04-25 08:40:09.720886 | instance | {
2026-04-25 08:40:09.720916 | instance |   "delta": "0:00:00.008883",
2026-04-25 08:40:09.720938 | instance |   "end": "2026-04-25 08:40:09.391863",
2026-04-25 08:40:09.720972 | instance |   "msg": "non-zero return code",
2026-04-25 08:40:09.720992 | instance |   "rc": 1,
2026-04-25 08:40:09.721010 | instance |   "start": "2026-04-25 08:40:09.382980"
2026-04-25 08:40:09.721028 | instance | }
2026-04-25 08:40:09.721051 | instance | ERROR: Ignoring Errors
2026-04-25 08:40:09.725850 | 
2026-04-25 08:40:09.725916 | TASK [gather-selenium-data : Downloads logs to executor]
2026-04-25 08:40:10.245975 | instance | changed: cd+++++++++ selenium/
2026-04-25 08:40:10.254037 | 
2026-04-25 08:40:10.254091 | PLAY RECAP
2026-04-25 08:40:10.254137 | instance | ok: 23 changed: 23 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 1
2026-04-25 08:40:10.254161 | 
2026-04-25 08:40:10.384799 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/post.yml@main]
2026-04-25 08:40:10.387144 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main]
2026-04-25 08:40:10.976096 | 
2026-04-25 08:40:10.976232 | PLAY [all]
2026-04-25 08:40:10.987824 | 
2026-04-25 08:40:10.987911 | TASK [fetch-output : Set log path for multiple nodes]
2026-04-25 08:40:11.033288 | instance | skipping: Conditional result was False
2026-04-25 08:40:11.170030 | 
2026-04-25 08:40:11.170162 | TASK [fetch-output : Set log path for single node]
2026-04-25 08:40:11.211989 | instance | ok
2026-04-25 08:40:11.218215 | 
2026-04-25 08:40:11.218307 | LOOP [fetch-output : Ensure local output dirs]
2026-04-25 08:40:11.583573 | instance -> localhost | ok: "/var/lib/zuul/builds/d7ed201c69e94217a0409ade646dbc4f/work/logs"
2026-04-25 08:40:11.785582 | instance -> localhost | changed: "/var/lib/zuul/builds/d7ed201c69e94217a0409ade646dbc4f/work/artifacts"
2026-04-25 08:40:11.991549 | instance -> localhost | changed: "/var/lib/zuul/builds/d7ed201c69e94217a0409ade646dbc4f/work/docs"
2026-04-25 08:40:12.015211 | 
2026-04-25 08:40:12.015366 | LOOP [fetch-output : Collect logs, artifacts and docs]
2026-04-25 08:40:12.671001 | instance | changed: .d..t...... ./
2026-04-25 08:40:12.671342 | instance | changed: All items complete
2026-04-25 08:40:12.671403 | 
2026-04-25 08:40:13.106062 | instance | changed: .d..t...... ./
2026-04-25 08:40:13.555613 | instance | changed: .d..t...... ./
2026-04-25 08:40:13.584241 | 
2026-04-25 08:40:13.584381 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir]
2026-04-25 08:40:14.005056 | instance -> localhost | ok: Item: artifacts Runtime: 0:00:00.006795
2026-04-25 08:40:14.228185 | instance -> localhost | ok: Item: docs Runtime: 0:00:00.007761
2026-04-25 08:40:14.250673 | 
2026-04-25 08:40:14.250796 | PLAY [all]
2026-04-25 08:40:14.256612 | 
2026-04-25 08:40:14.256676 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes]
2026-04-25 08:40:14.665643 | instance | changed
2026-04-25 08:40:14.672170 | 
2026-04-25 08:40:14.672217 | PLAY RECAP
2026-04-25 08:40:14.672260 | instance | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0
2026-04-25 08:40:14.672282 | 
2026-04-25 08:40:14.777080 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main]
2026-04-25 08:40:14.781477 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main]
2026-04-25 08:40:15.355436 | 
2026-04-25 08:40:15.355960 | PLAY [localhost]
2026-04-25 08:40:15.366055 | 
2026-04-25 08:40:15.366128 | TASK [Generate Zuul manifest]
2026-04-25 08:40:15.399706 | localhost | ok
2026-04-25 08:40:15.416915 | 
2026-04-25 08:40:15.417016 | TASK [generate-zuul-manifest : Generate Zuul manifest]
2026-04-25 08:40:15.731631 | localhost | changed
2026-04-25 08:40:15.743618 | 
2026-04-25 08:40:15.743692 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul]
2026-04-25 08:40:15.876190 | localhost | ok
2026-04-25 08:40:15.886002 | 
2026-04-25 08:40:15.886091 | TASK [Upload logs]
2026-04-25 08:40:15.909459 | localhost | ok
2026-04-25 08:40:15.968681 | 
2026-04-25 08:40:15.968805 | TASK [Set zuul-log-path fact]
2026-04-25 08:40:15.989921 | localhost | ok
2026-04-25 08:40:16.004470 | 
2026-04-25 08:40:16.004540 | TASK [set-zuul-log-path-fact : Set log path for a build]
2026-04-25 08:40:16.035191 | localhost | ok
2026-04-25 08:40:16.046021 | 
2026-04-25 08:40:16.046090 | TASK [upload-logs : Create log directories]
2026-04-25 08:40:16.432348 | localhost | changed
2026-04-25 08:40:16.438241 | 
2026-04-25 08:40:16.438309 | TASK [upload-logs : Ensure logs are readable before uploading]
2026-04-25 08:40:16.824410 | localhost -> localhost | ok: Runtime: 0:00:00.005151
2026-04-25 08:40:16.830343 | 
2026-04-25 08:40:16.830424 | TASK [upload-logs : Upload logs to log server]
2026-04-25 08:40:17.307420 | localhost | Output suppressed because no_log was given
2026-04-25 08:40:17.310978 | 
2026-04-25 08:40:17.311045 | LOOP [upload-logs : Compress console log and json output]
2026-04-25 08:40:17.356252 | localhost | skipping: Conditional result was False
2026-04-25 08:40:17.363218 | localhost | skipping: Conditional result was False
2026-04-25 08:40:17.376334 | 
2026-04-25 08:40:17.376512 | LOOP [upload-logs : Upload compressed console log and json output]
2026-04-25 08:40:17.420056 | localhost | skipping: Conditional result was False
2026-04-25 08:40:17.420394 | 
2026-04-25 08:40:17.425118 | localhost | skipping: Conditional result was False
2026-04-25 08:40:17.437710 | 
2026-04-25 08:40:17.437895 | LOOP [upload-logs : Upload console log and json output]