2026-04-07 08:59:11.463198 | Job console starting 2026-04-07 08:59:11.472346 | Updating git repos 2026-04-07 08:59:11.522317 | Cloning repos into workspace 2026-04-07 08:59:11.653639 | Restoring repo states 2026-04-07 08:59:11.673448 | Merging changes 2026-04-07 08:59:12.349620 | Checking out repos 2026-04-07 08:59:12.639372 | Preparing playbooks 2026-04-07 08:59:15.066410 | Running Ansible setup 2026-04-07 08:59:18.501094 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-07 08:59:19.112882 | 2026-04-07 08:59:19.113059 | PLAY [localhost] 2026-04-07 08:59:19.121200 | 2026-04-07 08:59:19.121273 | TASK [Gathering Facts] 2026-04-07 08:59:20.006253 | localhost | ok 2026-04-07 08:59:20.013089 | 2026-04-07 08:59:20.013171 | TASK [Setup log path fact] 2026-04-07 08:59:20.030761 | localhost | ok 2026-04-07 08:59:20.041167 | 2026-04-07 08:59:20.041248 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-07 08:59:20.071138 | localhost | ok 2026-04-07 08:59:20.079866 | 2026-04-07 08:59:20.079977 | TASK [emit-job-header : Print job information] 2026-04-07 08:59:20.118926 | # Job Information 2026-04-07 08:59:20.119083 | Ansible Version: 2.16.16 2026-04-07 08:59:20.119116 | Job: atmosphere-molecule-keycloak 2026-04-07 08:59:20.119140 | Pipeline: check 2026-04-07 08:59:20.119161 | Executor: 0a8996d2b663 2026-04-07 08:59:20.119182 | Triggered by: https://github.com/vexxhost/atmosphere/pull/3809 2026-04-07 08:59:20.119206 | Event ID: f203c010-325f-11f1-8ab8-427e3704333c 2026-04-07 08:59:20.122086 | 2026-04-07 08:59:20.122157 | LOOP [emit-job-header : Print node information] 2026-04-07 08:59:20.218416 | localhost | ok: 2026-04-07 08:59:20.218686 | localhost | # Node Information 2026-04-07 08:59:20.218735 | localhost | Inventory Hostname: instance 2026-04-07 08:59:20.218774 | localhost | Hostname: np0000163901 2026-04-07 08:59:20.218809 | localhost | Username: zuul 2026-04-07 08:59:20.218846 | localhost | Distro: Ubuntu 22.04 2026-04-07 08:59:20.218880 | localhost | Provider: yul1 2026-04-07 08:59:20.218914 | localhost | Region: ca-ymq-1 2026-04-07 08:59:20.218947 | localhost | Label: ubuntu-jammy 2026-04-07 08:59:20.218980 | localhost | Product Name: OpenStack Nova 2026-04-07 08:59:20.219012 | localhost | Interface IP: 199.204.45.153 2026-04-07 08:59:20.226309 | 2026-04-07 08:59:20.226467 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-04-07 08:59:20.624854 | localhost -> localhost | changed 2026-04-07 08:59:20.632679 | 2026-04-07 08:59:20.632778 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-04-07 08:59:21.505314 | localhost -> localhost | changed 2026-04-07 08:59:21.519102 | 2026-04-07 08:59:21.519204 | PLAY [all] 2026-04-07 08:59:21.529165 | 2026-04-07 08:59:21.529280 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-04-07 08:59:21.777817 | instance -> localhost | ok 2026-04-07 08:59:21.788277 | 2026-04-07 08:59:21.788352 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-04-07 08:59:21.814366 | instance | ok 2026-04-07 08:59:21.838576 | instance | included: /var/lib/zuul/builds/a734d292dd804e2db4b7e26dab0f0648/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-04-07 08:59:21.847734 | 2026-04-07 08:59:21.847805 | TASK [add-build-sshkey : Create Temp SSH key] 2026-04-07 08:59:23.335902 | instance -> localhost | Generating public/private rsa key pair. 2026-04-07 08:59:23.336094 | instance -> localhost | Your identification has been saved in /var/lib/zuul/builds/a734d292dd804e2db4b7e26dab0f0648/work/a734d292dd804e2db4b7e26dab0f0648_id_rsa 2026-04-07 08:59:23.336125 | instance -> localhost | Your public key has been saved in /var/lib/zuul/builds/a734d292dd804e2db4b7e26dab0f0648/work/a734d292dd804e2db4b7e26dab0f0648_id_rsa.pub 2026-04-07 08:59:23.336162 | instance -> localhost | The key fingerprint is: 2026-04-07 08:59:23.336187 | instance -> localhost | SHA256:Qcpzgu2HR42KNomg3fzsZQ6qgSzins051KcLg9p4xi4 zuul-build-sshkey 2026-04-07 08:59:23.336221 | instance -> localhost | The key's randomart image is: 2026-04-07 08:59:23.336268 | instance -> localhost | +---[RSA 3072]----+ 2026-04-07 08:59:23.336302 | instance -> localhost | | . | 2026-04-07 08:59:23.336325 | instance -> localhost | | + o o | 2026-04-07 08:59:23.336346 | instance -> localhost | |. . * = . | 2026-04-07 08:59:23.336375 | instance -> localhost | |.o + + B . | 2026-04-07 08:59:23.336396 | instance -> localhost | |. o O + S | 2026-04-07 08:59:23.336417 | instance -> localhost | |...o = + | 2026-04-07 08:59:23.336436 | instance -> localhost | |++oo * o | 2026-04-07 08:59:23.336456 | instance -> localhost | |EoBo++ = | 2026-04-07 08:59:23.336479 | instance -> localhost | |+O+=o.o . | 2026-04-07 08:59:23.336500 | instance -> localhost | +----[SHA256]-----+ 2026-04-07 08:59:23.336549 | instance -> localhost | ok: Runtime: 0:00:01.018994 2026-04-07 08:59:23.341961 | 2026-04-07 08:59:23.342025 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-04-07 08:59:23.371834 | instance | ok 2026-04-07 08:59:23.381358 | instance | included: /var/lib/zuul/builds/a734d292dd804e2db4b7e26dab0f0648/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-04-07 08:59:23.388926 | 2026-04-07 08:59:23.388998 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-04-07 08:59:23.413430 | instance | skipping: Conditional result was False 2026-04-07 08:59:23.424875 | 2026-04-07 08:59:23.424999 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-04-07 08:59:23.935954 | instance | changed 2026-04-07 08:59:23.941060 | 2026-04-07 08:59:23.941142 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-04-07 08:59:24.128626 | instance | ok 2026-04-07 08:59:24.135186 | 2026-04-07 08:59:24.182803 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-04-07 08:59:24.660335 | instance | changed 2026-04-07 08:59:24.667986 | 2026-04-07 08:59:24.668056 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-04-07 08:59:25.157832 | instance | changed 2026-04-07 08:59:25.165221 | 2026-04-07 08:59:25.165294 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-04-07 08:59:25.189517 | instance | skipping: Conditional result was False 2026-04-07 08:59:25.198858 | 2026-04-07 08:59:25.198959 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-04-07 08:59:25.606563 | instance -> localhost | changed 2026-04-07 08:59:25.623213 | 2026-04-07 08:59:25.623282 | TASK [add-build-sshkey : Add back temp key] 2026-04-07 08:59:25.911510 | instance -> localhost | Identity added: /var/lib/zuul/builds/a734d292dd804e2db4b7e26dab0f0648/work/a734d292dd804e2db4b7e26dab0f0648_id_rsa (zuul-build-sshkey) 2026-04-07 08:59:25.911745 | instance -> localhost | ok: Runtime: 0:00:00.019100 2026-04-07 08:59:25.917869 | 2026-04-07 08:59:25.917946 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-04-07 08:59:26.255256 | instance | ok 2026-04-07 08:59:26.261415 | 2026-04-07 08:59:26.261490 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-04-07 08:59:26.285910 | instance | skipping: Conditional result was False 2026-04-07 08:59:26.302476 | 2026-04-07 08:59:26.302606 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-04-07 08:59:26.671462 | instance | ok 2026-04-07 08:59:26.679916 | 2026-04-07 08:59:26.680055 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-04-07 08:59:28.430147 | instance | Output suppressed because no_log was given 2026-04-07 08:59:28.439908 | 2026-04-07 08:59:28.439985 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-04-07 08:59:28.627614 | instance | ok: "logs" 2026-04-07 08:59:28.627846 | instance | ok: All items complete 2026-04-07 08:59:28.627874 | 2026-04-07 08:59:28.786175 | instance | ok: "artifacts" 2026-04-07 08:59:28.948981 | instance | ok: "docs" 2026-04-07 08:59:28.967247 | 2026-04-07 08:59:28.967654 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-04-07 08:59:29.152433 | instance | changed: "logs" 2026-04-07 08:59:29.302651 | instance | changed: "artifacts" 2026-04-07 08:59:29.464540 | instance | changed: "docs" 2026-04-07 08:59:29.487960 | 2026-04-07 08:59:29.488090 | PLAY RECAP 2026-04-07 08:59:29.488139 | instance | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-04-07 08:59:29.488167 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-07 08:59:29.488190 | 2026-04-07 08:59:29.607130 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-07 08:59:29.612742 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-04-07 08:59:30.172479 | 2026-04-07 08:59:30.173082 | PLAY [all] 2026-04-07 08:59:30.186580 | 2026-04-07 08:59:30.186693 | TASK [setup-uv : Extract archive] 2026-04-07 08:59:32.376461 | instance | changed 2026-04-07 08:59:32.382691 | 2026-04-07 08:59:32.382780 | TASK [setup-uv : Print version] 2026-04-07 08:59:32.173081 | instance | uv 0.8.13 2026-04-07 08:59:32.919162 | instance | ok: Runtime: 0:00:00.018649 2026-04-07 08:59:32.927416 | 2026-04-07 08:59:32.927476 | PLAY RECAP 2026-04-07 08:59:32.927525 | instance | ok: 2 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-07 08:59:32.927550 | 2026-04-07 08:59:33.045798 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-04-07 08:59:33.048862 | PRE-RUN START: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/pre.yml@main] 2026-04-07 08:59:33.645590 | 2026-04-07 08:59:33.645718 | PLAY [all] 2026-04-07 08:59:33.657246 | 2026-04-07 08:59:33.657357 | TASK [Install "jq" for log collection] 2026-04-07 08:59:55.303488 | instance | changed 2026-04-07 08:59:55.306146 | 2026-04-07 08:59:55.306300 | PLAY RECAP 2026-04-07 08:59:55.306380 | instance | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-07 08:59:55.306464 | 2026-04-07 08:59:55.418543 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/pre.yml@main] 2026-04-07 08:59:55.421634 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-04-07 08:59:55.974237 | 2026-04-07 08:59:55.974367 | PLAY [all] 2026-04-07 08:59:55.985661 | 2026-04-07 08:59:55.985738 | TASK [Copy inventory file for Zuul] 2026-04-07 08:59:56.832435 | instance | changed 2026-04-07 08:59:56.838374 | 2026-04-07 08:59:56.838451 | TASK [Switch "ansible_host" to private IP] 2026-04-07 08:59:57.128011 | instance | changed: 1 replacements made 2026-04-07 08:59:57.133703 | 2026-04-07 08:59:57.133777 | TASK [Run Molecule scenario] 2026-04-07 08:59:57.549314 | instance | Using CPython 3.10.12 interpreter at: /usr/bin/python3 2026-04-07 08:59:57.549467 | instance | Creating virtual environment at: .venv 2026-04-07 08:59:57.574462 | instance | Building atmosphere @ file:///home/zuul/src/github.com/vexxhost/atmosphere 2026-04-07 08:59:57.590627 | instance | Downloading pygments (1.2MiB) 2026-04-07 08:59:57.609216 | instance | Downloading ansible-core (2.1MiB) 2026-04-07 08:59:57.609438 | instance | Downloading netaddr (2.2MiB) 2026-04-07 08:59:57.610130 | instance | Downloading rjsonnet (1.2MiB) 2026-04-07 08:59:57.610466 | instance | Downloading pydantic-core (2.0MiB) 2026-04-07 08:59:57.611383 | instance | Downloading setuptools (1.1MiB) 2026-04-07 08:59:57.621601 | instance | Downloading cryptography (4.2MiB) 2026-04-07 08:59:57.628366 | instance | Downloading openstacksdk (1.7MiB) 2026-04-07 08:59:57.675607 | instance | Downloading kubernetes (1.9MiB) 2026-04-07 08:59:57.921231 | instance | Downloading rjsonnet 2026-04-07 08:59:57.922067 | instance | Building pyperclip==1.9.0 2026-04-07 08:59:58.023511 | instance | Downloading pydantic-core 2026-04-07 08:59:58.058821 | instance | Downloading netaddr 2026-04-07 08:59:58.069566 | instance | Downloading pygments 2026-04-07 08:59:58.141982 | instance | Downloading setuptools 2026-04-07 08:59:58.143022 | instance | Downloading cryptography 2026-04-07 08:59:58.199466 | instance | Downloading kubernetes 2026-04-07 08:59:58.224824 | instance | Downloading ansible-core 2026-04-07 08:59:58.258744 | instance | Downloading openstacksdk 2026-04-07 08:59:58.648133 | instance | Built pyperclip==1.9.0 2026-04-07 08:59:58.802230 | instance | Built atmosphere @ file:///home/zuul/src/github.com/vexxhost/atmosphere 2026-04-07 08:59:58.843052 | instance | Installed 83 packages in 39ms 2026-04-07 08:59:59.447131 | instance | WARNING Molecule scenarios should migrate to 'extensions/molecule' 2026-04-07 09:00:00.172923 | instance | INFO [keycloak > discovery] scenario test matrix: dependency, cleanup, destroy, syntax, create, prepare, converge, idempotence, side_effect, verify, cleanup, destroy 2026-04-07 09:00:00.173193 | instance | INFO [keycloak > prerun] Performing prerun with role_name_check=0... 2026-04-07 09:02:17.189456 | instance | INFO [keycloak > dependency] Executing 2026-04-07 09:02:17.189630 | instance | WARNING [keycloak > dependency] Missing roles requirements file: requirements.yml 2026-04-07 09:02:17.189820 | instance | WARNING [keycloak > dependency] Missing collections requirements file: collections.yml 2026-04-07 09:02:17.189966 | instance | WARNING [keycloak > dependency] Executed: 2 missing (Remove from test_sequence to suppress) 2026-04-07 09:02:17.200452 | instance | INFO [keycloak > cleanup] Executing 2026-04-07 09:02:17.200766 | instance | WARNING [keycloak > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-07 09:02:17.242610 | instance | INFO [keycloak > destroy] Executing 2026-04-07 09:02:17.242679 | instance | WARNING [keycloak > destroy] Skipping, '--destroy=never' requested. 2026-04-07 09:02:17.242782 | instance | INFO [keycloak > destroy] Executed: Successful 2026-04-07 09:02:17.257764 | instance | INFO [keycloak > syntax] Executing 2026-04-07 09:02:18.511838 | instance | 2026-04-07 09:02:18.512163 | instance | playbook: /home/zuul/src/github.com/vexxhost/atmosphere/molecule/keycloak/converge.yml 2026-04-07 09:02:18.574670 | instance | INFO [keycloak > syntax] Executed: Successful 2026-04-07 09:02:18.670571 | instance | INFO [keycloak > create] Executing 2026-04-07 09:02:18.709751 | instance | WARNING [keycloak > create] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-07 09:02:18.723878 | instance | INFO [keycloak > prepare] Executing 2026-04-07 09:02:19.955865 | instance | 2026-04-07 09:02:19.956104 | instance | PLAY [Prepare] ***************************************************************** 2026-04-07 09:02:19.956377 | instance | 2026-04-07 09:02:19.956664 | instance | TASK [Gathering Facts] ********************************************************* 2026-04-07 09:02:19.956951 | instance | Tuesday 07 April 2026 09:02:19 +0000 (0:00:00.035) 0:00:00.035 ********* 2026-04-07 09:02:20.998617 | instance | ok: [instance] 2026-04-07 09:02:20.998900 | instance | 2026-04-07 09:02:20.999243 | instance | TASK [Configure short hostname] ************************************************ 2026-04-07 09:02:20.999494 | instance | Tuesday 07 April 2026 09:02:20 +0000 (0:00:01.043) 0:00:01.079 ********* 2026-04-07 09:02:21.829804 | instance | changed: [instance] 2026-04-07 09:02:21.830027 | instance | 2026-04-07 09:02:21.830279 | instance | TASK [Ensure hostname inside hosts file] *************************************** 2026-04-07 09:02:21.830507 | instance | Tuesday 07 April 2026 09:02:21 +0000 (0:00:00.831) 0:00:01.910 ********* 2026-04-07 09:02:22.160529 | instance | changed: [instance] 2026-04-07 09:02:22.160738 | instance | 2026-04-07 09:02:22.161026 | instance | TASK [Install "dirmngr" for GPG keyserver operations] ************************** 2026-04-07 09:02:22.161310 | instance | Tuesday 07 April 2026 09:02:22 +0000 (0:00:00.330) 0:00:02.240 ********* 2026-04-07 09:02:23.874522 | instance | ok: [instance] 2026-04-07 09:02:23.874767 | instance | 2026-04-07 09:02:23.875040 | instance | TASK [Purge "snapd" package] *************************************************** 2026-04-07 09:02:23.875321 | instance | Tuesday 07 April 2026 09:02:23 +0000 (0:00:01.712) 0:00:03.953 ********* 2026-04-07 09:02:25.167256 | instance | ok: [instance] 2026-04-07 09:02:25.167378 | instance | 2026-04-07 09:02:25.167601 | instance | PLAY [Generate workspace for Atmosphere] *************************************** 2026-04-07 09:02:25.167780 | instance | 2026-04-07 09:02:25.167950 | instance | TASK [Create folders for workspace] ******************************************** 2026-04-07 09:02:25.168128 | instance | Tuesday 07 April 2026 09:02:25 +0000 (0:00:01.294) 0:00:05.248 ********* 2026-04-07 09:02:26.381459 | instance | changed: [localhost] => (item=group_vars) 2026-04-07 09:02:26.381728 | instance | changed: [localhost] => (item=group_vars/all) 2026-04-07 09:02:26.382085 | instance | changed: [localhost] => (item=group_vars/controllers) 2026-04-07 09:02:26.382387 | instance | changed: [localhost] => (item=group_vars/cephs) 2026-04-07 09:02:26.382690 | instance | changed: [localhost] => (item=group_vars/computes) 2026-04-07 09:02:26.382997 | instance | changed: [localhost] => (item=host_vars) 2026-04-07 09:02:26.383412 | instance | 2026-04-07 09:02:26.383560 | instance | PLAY [Generate Ceph control plane configuration for workspace] ***************** 2026-04-07 09:02:26.383821 | instance | 2026-04-07 09:02:26.384117 | instance | TASK [Ensure the Ceph control plane configuration file exists] ***************** 2026-04-07 09:02:26.384407 | instance | Tuesday 07 April 2026 09:02:26 +0000 (0:00:01.214) 0:00:06.462 ********* 2026-04-07 09:02:26.615818 | instance | changed: [localhost] 2026-04-07 09:02:26.615906 | instance | 2026-04-07 09:02:26.616070 | instance | TASK [Load the current Ceph control plane configuration into a variable] ******* 2026-04-07 09:02:26.616247 | instance | Tuesday 07 April 2026 09:02:26 +0000 (0:00:00.234) 0:00:06.696 ********* 2026-04-07 09:02:26.646817 | instance | ok: [localhost] 2026-04-07 09:02:26.647059 | instance | 2026-04-07 09:02:26.647377 | instance | TASK [Generate Ceph control plane values for missing variables] **************** 2026-04-07 09:02:26.647636 | instance | Tuesday 07 April 2026 09:02:26 +0000 (0:00:00.030) 0:00:06.727 ********* 2026-04-07 09:02:26.702765 | instance | ok: [localhost] => (item={'key': 'ceph_fsid', 'value': '980e2a21-709c-57cb-9d05-566bc45c30dd'}) 2026-04-07 09:02:26.702860 | instance | ok: [localhost] => (item={'key': 'ceph_mon_public_network', 'value': '10.96.240.0/24'}) 2026-04-07 09:02:26.703073 | instance | 2026-04-07 09:02:26.703387 | instance | TASK [Write new Ceph control plane configuration file to disk] ***************** 2026-04-07 09:02:26.703794 | instance | Tuesday 07 April 2026 09:02:26 +0000 (0:00:00.055) 0:00:06.782 ********* 2026-04-07 09:02:27.323085 | instance | changed: [localhost] 2026-04-07 09:02:27.323361 | instance | 2026-04-07 09:02:27.323664 | instance | PLAY [Generate Ceph OSD configuration for workspace] *************************** 2026-04-07 09:02:27.323920 | instance | 2026-04-07 09:02:27.324196 | instance | TASK [Ensure the Ceph OSDs configuration file exists] ************************** 2026-04-07 09:02:27.324506 | instance | Tuesday 07 April 2026 09:02:27 +0000 (0:00:00.621) 0:00:07.403 ********* 2026-04-07 09:02:27.525750 | instance | changed: [localhost] 2026-04-07 09:02:27.525875 | instance | 2026-04-07 09:02:27.526094 | instance | TASK [Load the current Ceph OSDs configuration into a variable] **************** 2026-04-07 09:02:27.526274 | instance | Tuesday 07 April 2026 09:02:27 +0000 (0:00:00.202) 0:00:07.606 ********* 2026-04-07 09:02:27.550423 | instance | ok: [localhost] 2026-04-07 09:02:27.550681 | instance | 2026-04-07 09:02:27.550927 | instance | TASK [Generate Ceph OSDs values for missing variables] ************************* 2026-04-07 09:02:27.551169 | instance | Tuesday 07 April 2026 09:02:27 +0000 (0:00:00.024) 0:00:07.630 ********* 2026-04-07 09:02:27.586142 | instance | ok: [localhost] => (item={'key': 'ceph_osd_devices', 'value': ['/dev/vdb', '/dev/vdc', '/dev/vdd']}) 2026-04-07 09:02:27.586256 | instance | 2026-04-07 09:02:27.586437 | instance | TASK [Write new Ceph OSDs configuration file to disk] ************************** 2026-04-07 09:02:27.586617 | instance | Tuesday 07 April 2026 09:02:27 +0000 (0:00:00.036) 0:00:07.666 ********* 2026-04-07 09:02:27.973493 | instance | changed: [localhost] 2026-04-07 09:02:27.973749 | instance | 2026-04-07 09:02:27.974163 | instance | PLAY [Generate Kubernetes configuration for workspace] ************************* 2026-04-07 09:02:27.974443 | instance | 2026-04-07 09:02:27.974740 | instance | TASK [Ensure the Kubernetes configuration file exists] ************************* 2026-04-07 09:02:27.975021 | instance | Tuesday 07 April 2026 09:02:27 +0000 (0:00:00.387) 0:00:08.054 ********* 2026-04-07 09:02:28.168286 | instance | changed: [localhost] 2026-04-07 09:02:28.168620 | instance | 2026-04-07 09:02:28.169032 | instance | TASK [Load the current Kubernetes configuration into a variable] *************** 2026-04-07 09:02:28.169451 | instance | Tuesday 07 April 2026 09:02:28 +0000 (0:00:00.194) 0:00:08.248 ********* 2026-04-07 09:02:28.193615 | instance | ok: [localhost] 2026-04-07 09:02:28.193772 | instance | 2026-04-07 09:02:28.194025 | instance | TASK [Generate Kubernetes values for missing variables] ************************ 2026-04-07 09:02:28.194262 | instance | Tuesday 07 April 2026 09:02:28 +0000 (0:00:00.025) 0:00:08.274 ********* 2026-04-07 09:02:28.249042 | instance | ok: [localhost] => (item={'key': 'kubernetes_hostname', 'value': '10.96.240.10'}) 2026-04-07 09:02:28.249237 | instance | ok: [localhost] => (item={'key': 'kubernetes_keepalived_vrid', 'value': 42}) 2026-04-07 09:02:28.249434 | instance | ok: [localhost] => (item={'key': 'kubernetes_keepalived_vip', 'value': '10.96.240.10'}) 2026-04-07 09:02:28.249600 | instance | 2026-04-07 09:02:28.249779 | instance | TASK [Write new Kubernetes configuration file to disk] ************************* 2026-04-07 09:02:28.250067 | instance | Tuesday 07 April 2026 09:02:28 +0000 (0:00:00.054) 0:00:08.329 ********* 2026-04-07 09:02:28.629369 | instance | changed: [localhost] 2026-04-07 09:02:28.629504 | instance | 2026-04-07 09:02:28.629701 | instance | PLAY [Generate Keepalived configuration for workspace] ************************* 2026-04-07 09:02:28.629887 | instance | 2026-04-07 09:02:28.630098 | instance | TASK [Ensure the Keeaplived configuration file exists] ************************* 2026-04-07 09:02:28.630346 | instance | Tuesday 07 April 2026 09:02:28 +0000 (0:00:00.380) 0:00:08.710 ********* 2026-04-07 09:02:28.854391 | instance | changed: [localhost] 2026-04-07 09:02:28.854471 | instance | 2026-04-07 09:02:28.854819 | instance | TASK [Load the current Keepalived configuration into a variable] *************** 2026-04-07 09:02:28.854989 | instance | Tuesday 07 April 2026 09:02:28 +0000 (0:00:00.224) 0:00:08.934 ********* 2026-04-07 09:02:28.885144 | instance | ok: [localhost] 2026-04-07 09:02:28.885279 | instance | 2026-04-07 09:02:28.885437 | instance | TASK [Generate Keepalived values for missing variables] ************************ 2026-04-07 09:02:28.885603 | instance | Tuesday 07 April 2026 09:02:28 +0000 (0:00:00.030) 0:00:08.965 ********* 2026-04-07 09:02:28.927536 | instance | ok: [localhost] => (item={'key': 'keepalived_interface', 'value': 'br-ex'}) 2026-04-07 09:02:28.927770 | instance | ok: [localhost] => (item={'key': 'keepalived_vip', 'value': '10.96.250.10'}) 2026-04-07 09:02:28.928041 | instance | 2026-04-07 09:02:28.928335 | instance | TASK [Write new Keepalived configuration file to disk] ************************* 2026-04-07 09:02:28.928657 | instance | Tuesday 07 April 2026 09:02:28 +0000 (0:00:00.041) 0:00:09.007 ********* 2026-04-07 09:02:29.309984 | instance | changed: [localhost] 2026-04-07 09:02:29.310218 | instance | 2026-04-07 09:02:29.310535 | instance | PLAY [Generate endpoints for workspace] **************************************** 2026-04-07 09:02:29.310803 | instance | 2026-04-07 09:02:29.311113 | instance | TASK [Gathering Facts] ********************************************************* 2026-04-07 09:02:29.311389 | instance | Tuesday 07 April 2026 09:02:29 +0000 (0:00:00.383) 0:00:09.390 ********* 2026-04-07 09:02:30.058915 | instance | ok: [localhost] 2026-04-07 09:02:30.059084 | instance | 2026-04-07 09:02:30.059261 | instance | TASK [Ensure the endpoints file exists] **************************************** 2026-04-07 09:02:30.059524 | instance | Tuesday 07 April 2026 09:02:30 +0000 (0:00:00.749) 0:00:10.139 ********* 2026-04-07 09:02:30.268788 | instance | changed: [localhost] 2026-04-07 09:02:30.269002 | instance | 2026-04-07 09:02:30.269279 | instance | TASK [Load the current endpoints into a variable] ****************************** 2026-04-07 09:02:30.269546 | instance | Tuesday 07 April 2026 09:02:30 +0000 (0:00:00.209) 0:00:10.349 ********* 2026-04-07 09:02:30.300074 | instance | ok: [localhost] 2026-04-07 09:02:30.300310 | instance | 2026-04-07 09:02:30.300578 | instance | TASK [Generate endpoint skeleton for missing variables] ************************ 2026-04-07 09:02:30.300850 | instance | Tuesday 07 April 2026 09:02:30 +0000 (0:00:00.031) 0:00:10.381 ********* 2026-04-07 09:02:31.074287 | instance | ok: [localhost] => (item=keycloak_host) 2026-04-07 09:02:31.074578 | instance | ok: [localhost] => (item=kube_prometheus_stack_grafana_host) 2026-04-07 09:02:31.074886 | instance | ok: [localhost] => (item=kube_prometheus_stack_alertmanager_host) 2026-04-07 09:02:31.075180 | instance | ok: [localhost] => (item=kube_prometheus_stack_prometheus_host) 2026-04-07 09:02:31.075610 | instance | ok: [localhost] => (item=openstack_helm_endpoints_region_name) 2026-04-07 09:02:31.075912 | instance | ok: [localhost] => (item=openstack_helm_endpoints_keystone_api_host) 2026-04-07 09:02:31.076189 | instance | ok: [localhost] => (item=openstack_helm_endpoints_glance_api_host) 2026-04-07 09:02:31.076496 | instance | ok: [localhost] => (item=openstack_helm_endpoints_cinder_api_host) 2026-04-07 09:02:31.076802 | instance | ok: [localhost] => (item=openstack_helm_endpoints_placement_api_host) 2026-04-07 09:02:31.077064 | instance | ok: [localhost] => (item=openstack_helm_endpoints_barbican_api_host) 2026-04-07 09:02:31.077334 | instance | ok: [localhost] => (item=openstack_helm_endpoints_neutron_api_host) 2026-04-07 09:02:31.077634 | instance | ok: [localhost] => (item=openstack_helm_endpoints_nova_api_host) 2026-04-07 09:02:31.077905 | instance | ok: [localhost] => (item=openstack_helm_endpoints_nova_novnc_host) 2026-04-07 09:02:31.078229 | instance | ok: [localhost] => (item=openstack_helm_endpoints_ironic_api_host) 2026-04-07 09:02:31.078508 | instance | ok: [localhost] => (item=openstack_helm_endpoints_designate_api_host) 2026-04-07 09:02:31.078886 | instance | ok: [localhost] => (item=openstack_helm_endpoints_octavia_api_host) 2026-04-07 09:02:31.079227 | instance | ok: [localhost] => (item=openstack_helm_endpoints_magnum_api_host) 2026-04-07 09:02:31.079582 | instance | ok: [localhost] => (item=openstack_helm_endpoints_magnum_registry_host) 2026-04-07 09:02:31.079919 | instance | ok: [localhost] => (item=openstack_helm_endpoints_heat_api_host) 2026-04-07 09:02:31.080183 | instance | ok: [localhost] => (item=openstack_helm_endpoints_heat_cfn_api_host) 2026-04-07 09:02:31.080460 | instance | ok: [localhost] => (item=openstack_helm_endpoints_horizon_api_host) 2026-04-07 09:02:31.080624 | instance | ok: [localhost] => (item=openstack_helm_endpoints_rgw_host) 2026-04-07 09:02:31.080822 | instance | ok: [localhost] => (item=openstack_helm_endpoints_manila_api_host) 2026-04-07 09:02:31.080968 | instance | 2026-04-07 09:02:31.081136 | instance | TASK [Write new endpoints file to disk] **************************************** 2026-04-07 09:02:31.081307 | instance | Tuesday 07 April 2026 09:02:31 +0000 (0:00:00.773) 0:00:11.154 ********* 2026-04-07 09:02:31.471500 | instance | changed: [localhost] 2026-04-07 09:02:31.471893 | instance | 2026-04-07 09:02:31.472273 | instance | TASK [Ensure the endpoints file exists] **************************************** 2026-04-07 09:02:31.472608 | instance | Tuesday 07 April 2026 09:02:31 +0000 (0:00:00.397) 0:00:11.552 ********* 2026-04-07 09:02:31.684182 | instance | changed: [localhost] 2026-04-07 09:02:31.684398 | instance | 2026-04-07 09:02:31.684677 | instance | PLAY [Generate Neutron configuration for workspace] **************************** 2026-04-07 09:02:31.684934 | instance | 2026-04-07 09:02:31.685207 | instance | TASK [Ensure the Neutron configuration file exists] **************************** 2026-04-07 09:02:31.685570 | instance | Tuesday 07 April 2026 09:02:31 +0000 (0:00:00.212) 0:00:11.764 ********* 2026-04-07 09:02:31.894785 | instance | changed: [localhost] 2026-04-07 09:02:31.895052 | instance | 2026-04-07 09:02:31.895373 | instance | TASK [Load the current Neutron configuration into a variable] ****************** 2026-04-07 09:02:31.895669 | instance | Tuesday 07 April 2026 09:02:31 +0000 (0:00:00.210) 0:00:11.975 ********* 2026-04-07 09:02:31.925041 | instance | ok: [localhost] 2026-04-07 09:02:31.925291 | instance | 2026-04-07 09:02:31.925576 | instance | TASK [Generate Neutron values for missing variables] *************************** 2026-04-07 09:02:31.925910 | instance | Tuesday 07 April 2026 09:02:31 +0000 (0:00:00.030) 0:00:12.005 ********* 2026-04-07 09:02:31.965490 | instance | ok: [localhost] => (item={'key': 'neutron_networks', 'value': [{'name': 'public', 'external': True, 'shared': True, 'mtu_size': 1500, 'port_security_enabled': True, 'provider_network_type': 'flat', 'provider_physical_network': 'external', 'subnets': [{'name': 'public-subnet', 'cidr': '10.96.250.0/24', 'gateway_ip': '10.96.250.10', 'allocation_pool_start': '10.96.250.200', 'allocation_pool_end': '10.96.250.220', 'enable_dhcp': True}]}]}) 2026-04-07 09:02:31.965745 | instance | 2026-04-07 09:02:31.966067 | instance | TASK [Write new Neutron configuration file to disk] **************************** 2026-04-07 09:02:31.966347 | instance | Tuesday 07 April 2026 09:02:31 +0000 (0:00:00.039) 0:00:12.045 ********* 2026-04-07 09:02:32.335565 | instance | changed: [localhost] 2026-04-07 09:02:32.335667 | instance | 2026-04-07 09:02:32.335856 | instance | PLAY [Generate Nova configuration for workspace] ******************************* 2026-04-07 09:02:32.336050 | instance | 2026-04-07 09:02:32.336241 | instance | TASK [Ensure the Nova configuration file exists] ******************************* 2026-04-07 09:02:32.336425 | instance | Tuesday 07 April 2026 09:02:32 +0000 (0:00:00.370) 0:00:12.416 ********* 2026-04-07 09:02:32.530388 | instance | changed: [localhost] 2026-04-07 09:02:32.530548 | instance | 2026-04-07 09:02:32.530819 | instance | TASK [Load the current Nova configuration into a variable] ********************* 2026-04-07 09:02:32.531044 | instance | Tuesday 07 April 2026 09:02:32 +0000 (0:00:00.194) 0:00:12.611 ********* 2026-04-07 09:02:32.561791 | instance | ok: [localhost] 2026-04-07 09:02:32.562135 | instance | 2026-04-07 09:02:32.562406 | instance | TASK [Generate Nova values for missing variables] ****************************** 2026-04-07 09:02:32.562675 | instance | Tuesday 07 April 2026 09:02:32 +0000 (0:00:00.031) 0:00:12.642 ********* 2026-04-07 09:02:32.599999 | instance | ok: [localhost] => (item={'key': 'nova_flavors', 'value': [{'name': 'm1.tiny', 'ram': 512, 'disk': 1, 'vcpus': 1}, {'name': 'm1.small', 'ram': 2048, 'disk': 20, 'vcpus': 1}, {'name': 'm1.medium', 'ram': 4096, 'disk': 40, 'vcpus': 2}, {'name': 'm1.large', 'ram': 8192, 'disk': 80, 'vcpus': 4}, {'name': 'm1.xlarge', 'ram': 16384, 'disk': 160, 'vcpus': 8}]}) 2026-04-07 09:02:32.600202 | instance | 2026-04-07 09:02:32.600521 | instance | TASK [Write new Nova configuration file to disk] ******************************* 2026-04-07 09:02:32.600878 | instance | Tuesday 07 April 2026 09:02:32 +0000 (0:00:00.037) 0:00:12.680 ********* 2026-04-07 09:02:32.966710 | instance | changed: [localhost] 2026-04-07 09:02:32.967016 | instance | 2026-04-07 09:02:32.967361 | instance | PLAY [Generate secrets for workspace] ****************************************** 2026-04-07 09:02:32.967625 | instance | 2026-04-07 09:02:32.967891 | instance | TASK [Ensure the secrets file exists] ****************************************** 2026-04-07 09:02:32.968158 | instance | Tuesday 07 April 2026 09:02:32 +0000 (0:00:00.366) 0:00:13.047 ********* 2026-04-07 09:02:33.167882 | instance | changed: [localhost] 2026-04-07 09:02:33.168040 | instance | 2026-04-07 09:02:33.168314 | instance | TASK [Load the current secrets into a variable] ******************************** 2026-04-07 09:02:33.168838 | instance | Tuesday 07 April 2026 09:02:33 +0000 (0:00:00.201) 0:00:13.248 ********* 2026-04-07 09:02:33.198941 | instance | ok: [localhost] 2026-04-07 09:02:33.199228 | instance | 2026-04-07 09:02:33.199542 | instance | TASK [Generate secrets for missing variables] ********************************** 2026-04-07 09:02:33.199849 | instance | Tuesday 07 April 2026 09:02:33 +0000 (0:00:00.030) 0:00:13.279 ********* 2026-04-07 09:02:33.702179 | instance | ok: [localhost] => (item=heat_auth_encryption_key) 2026-04-07 09:02:33.702335 | instance | ok: [localhost] => (item=keepalived_password) 2026-04-07 09:02:33.702363 | instance | ok: [localhost] => (item=keycloak_admin_password) 2026-04-07 09:02:33.702373 | instance | ok: [localhost] => (item=keycloak_database_password) 2026-04-07 09:02:33.702382 | instance | ok: [localhost] => (item=keystone_keycloak_client_secret) 2026-04-07 09:02:33.702391 | instance | ok: [localhost] => (item=keystone_oidc_crypto_passphrase) 2026-04-07 09:02:33.702402 | instance | ok: [localhost] => (item=kube_prometheus_stack_grafana_admin_password) 2026-04-07 09:02:33.702412 | instance | ok: [localhost] => (item=octavia_heartbeat_key) 2026-04-07 09:02:33.702423 | instance | ok: [localhost] => (item=openstack_helm_endpoints_rabbitmq_admin_password) 2026-04-07 09:02:33.702441 | instance | ok: [localhost] => (item=openstack_helm_endpoints_memcached_secret_key) 2026-04-07 09:02:33.702451 | instance | ok: [localhost] => (item=openstack_helm_endpoints_keystone_admin_password) 2026-04-07 09:02:33.703497 | instance | ok: [localhost] => (item=openstack_helm_endpoints_keystone_mariadb_password) 2026-04-07 09:02:33.703550 | instance | ok: [localhost] => (item=openstack_helm_endpoints_keystone_rabbitmq_password) 2026-04-07 09:02:33.703556 | instance | ok: [localhost] => (item=openstack_helm_endpoints_glance_keystone_password) 2026-04-07 09:02:33.703564 | instance | ok: [localhost] => (item=openstack_helm_endpoints_glance_mariadb_password) 2026-04-07 09:02:33.703813 | instance | ok: [localhost] => (item=openstack_helm_endpoints_glance_rabbitmq_password) 2026-04-07 09:02:33.704221 | instance | ok: [localhost] => (item=openstack_helm_endpoints_cinder_keystone_password) 2026-04-07 09:02:33.704576 | instance | ok: [localhost] => (item=openstack_helm_endpoints_cinder_mariadb_password) 2026-04-07 09:02:33.704987 | instance | ok: [localhost] => (item=openstack_helm_endpoints_cinder_rabbitmq_password) 2026-04-07 09:02:33.705343 | instance | ok: [localhost] => (item=openstack_helm_endpoints_placement_keystone_password) 2026-04-07 09:02:33.705578 | instance | ok: [localhost] => (item=openstack_helm_endpoints_placement_mariadb_password) 2026-04-07 09:02:33.705784 | instance | ok: [localhost] => (item=openstack_helm_endpoints_barbican_keystone_password) 2026-04-07 09:02:33.706010 | instance | ok: [localhost] => (item=openstack_helm_endpoints_barbican_mariadb_password) 2026-04-07 09:02:33.706220 | instance | ok: [localhost] => (item=openstack_helm_endpoints_neutron_keystone_password) 2026-04-07 09:02:33.706427 | instance | ok: [localhost] => (item=openstack_helm_endpoints_neutron_mariadb_password) 2026-04-07 09:02:33.706634 | instance | ok: [localhost] => (item=openstack_helm_endpoints_neutron_rabbitmq_password) 2026-04-07 09:02:33.706841 | instance | ok: [localhost] => (item=openstack_helm_endpoints_neutron_metadata_secret) 2026-04-07 09:02:33.707045 | instance | ok: [localhost] => (item=openstack_helm_endpoints_nova_keystone_password) 2026-04-07 09:02:33.707250 | instance | ok: [localhost] => (item=openstack_helm_endpoints_nova_mariadb_password) 2026-04-07 09:02:33.707455 | instance | ok: [localhost] => (item=openstack_helm_endpoints_nova_rabbitmq_password) 2026-04-07 09:02:33.707659 | instance | ok: [localhost] => (item=openstack_helm_endpoints_ironic_keystone_password) 2026-04-07 09:02:33.707864 | instance | ok: [localhost] => (item=openstack_helm_endpoints_ironic_mariadb_password) 2026-04-07 09:02:33.708070 | instance | ok: [localhost] => (item=openstack_helm_endpoints_ironic_rabbitmq_password) 2026-04-07 09:02:33.708274 | instance | ok: [localhost] => (item=openstack_helm_endpoints_designate_keystone_password) 2026-04-07 09:02:33.708479 | instance | ok: [localhost] => (item=openstack_helm_endpoints_designate_mariadb_password) 2026-04-07 09:02:33.708685 | instance | ok: [localhost] => (item=openstack_helm_endpoints_designate_rabbitmq_password) 2026-04-07 09:02:33.708913 | instance | ok: [localhost] => (item=openstack_helm_endpoints_octavia_keystone_password) 2026-04-07 09:02:33.709124 | instance | ok: [localhost] => (item=openstack_helm_endpoints_octavia_mariadb_password) 2026-04-07 09:02:33.709334 | instance | ok: [localhost] => (item=openstack_helm_endpoints_octavia_rabbitmq_password) 2026-04-07 09:02:33.709581 | instance | ok: [localhost] => (item=openstack_helm_endpoints_magnum_keystone_password) 2026-04-07 09:02:33.709791 | instance | ok: [localhost] => (item=openstack_helm_endpoints_magnum_mariadb_password) 2026-04-07 09:02:33.710021 | instance | ok: [localhost] => (item=openstack_helm_endpoints_magnum_rabbitmq_password) 2026-04-07 09:02:33.710251 | instance | ok: [localhost] => (item=openstack_helm_endpoints_heat_keystone_password) 2026-04-07 09:02:33.710468 | instance | ok: [localhost] => (item=openstack_helm_endpoints_heat_trustee_keystone_password) 2026-04-07 09:02:33.710681 | instance | ok: [localhost] => (item=openstack_helm_endpoints_heat_stack_user_keystone_password) 2026-04-07 09:02:33.710888 | instance | ok: [localhost] => (item=openstack_helm_endpoints_heat_mariadb_password) 2026-04-07 09:02:33.711096 | instance | ok: [localhost] => (item=openstack_helm_endpoints_heat_rabbitmq_password) 2026-04-07 09:02:33.711302 | instance | ok: [localhost] => (item=openstack_helm_endpoints_horizon_mariadb_password) 2026-04-07 09:02:33.711508 | instance | ok: [localhost] => (item=openstack_helm_endpoints_tempest_keystone_password) 2026-04-07 09:02:33.711720 | instance | ok: [localhost] => (item=openstack_helm_endpoints_openstack_exporter_keystone_password) 2026-04-07 09:02:33.711937 | instance | ok: [localhost] => (item=openstack_helm_endpoints_rgw_keystone_password) 2026-04-07 09:02:33.712147 | instance | ok: [localhost] => (item=openstack_helm_endpoints_manila_keystone_password) 2026-04-07 09:02:33.712356 | instance | ok: [localhost] => (item=openstack_helm_endpoints_manila_mariadb_password) 2026-04-07 09:02:33.712567 | instance | ok: [localhost] => (item=openstack_helm_endpoints_staffeln_mariadb_password) 2026-04-07 09:02:33.712785 | instance | 2026-04-07 09:02:33.712997 | instance | TASK [Generate base64 encoded secrets] ***************************************** 2026-04-07 09:02:33.713210 | instance | Tuesday 07 April 2026 09:02:33 +0000 (0:00:00.500) 0:00:13.780 ********* 2026-04-07 09:02:33.754886 | instance | ok: [localhost] => (item=barbican_kek) 2026-04-07 09:02:33.755158 | instance | 2026-04-07 09:02:33.755362 | instance | TASK [Generate temporary files for generating keys for missing variables] ****** 2026-04-07 09:02:33.755562 | instance | Tuesday 07 April 2026 09:02:33 +0000 (0:00:00.055) 0:00:13.835 ********* 2026-04-07 09:02:34.233593 | instance | changed: [localhost] => (item=manila_ssh_key) 2026-04-07 09:02:34.233692 | instance | changed: [localhost] => (item=nova_ssh_key) 2026-04-07 09:02:34.234089 | instance | 2026-04-07 09:02:34.234189 | instance | TASK [Generate SSH keys for missing variables] ********************************* 2026-04-07 09:02:34.234212 | instance | Tuesday 07 April 2026 09:02:34 +0000 (0:00:00.478) 0:00:14.314 ********* 2026-04-07 09:02:36.713770 | instance | changed: [localhost] => (item=manila_ssh_key) 2026-04-07 09:02:36.713876 | instance | changed: [localhost] => (item=nova_ssh_key) 2026-04-07 09:02:36.714527 | instance | 2026-04-07 09:02:36.714593 | instance | TASK [Set values for SSH keys] ************************************************* 2026-04-07 09:02:36.714601 | instance | Tuesday 07 April 2026 09:02:36 +0000 (0:00:02.480) 0:00:16.794 ********* 2026-04-07 09:02:36.773146 | instance | ok: [localhost] => (item=manila_ssh_key) 2026-04-07 09:02:36.773813 | instance | ok: [localhost] => (item=nova_ssh_key) 2026-04-07 09:02:36.773887 | instance | 2026-04-07 09:02:36.773895 | instance | TASK [Delete the temporary files generated for SSH keys] *********************** 2026-04-07 09:02:36.773903 | instance | Tuesday 07 April 2026 09:02:36 +0000 (0:00:00.058) 0:00:16.853 ********* 2026-04-07 09:02:37.177631 | instance | changed: [localhost] => (item=manila_ssh_key) 2026-04-07 09:02:37.178000 | instance | changed: [localhost] => (item=nova_ssh_key) 2026-04-07 09:02:37.178112 | instance | 2026-04-07 09:02:37.178432 | instance | TASK [Write new secrets file to disk] ****************************************** 2026-04-07 09:02:37.178482 | instance | Tuesday 07 April 2026 09:02:37 +0000 (0:00:00.405) 0:00:17.258 ********* 2026-04-07 09:02:37.552977 | instance | changed: [localhost] 2026-04-07 09:02:37.553066 | instance | 2026-04-07 09:02:37.553329 | instance | TASK [Encrypt secrets file with Vault password] ******************************** 2026-04-07 09:02:37.553344 | instance | Tuesday 07 April 2026 09:02:37 +0000 (0:00:00.375) 0:00:17.634 ********* 2026-04-07 09:02:37.598473 | instance | skipping: [localhost] 2026-04-07 09:02:37.598573 | instance | 2026-04-07 09:02:37.599067 | instance | PLAY [all] ********************************************************************* 2026-04-07 09:02:37.599111 | instance | 2026-04-07 09:02:37.599116 | instance | TASK [Gathering Facts] ********************************************************* 2026-04-07 09:02:37.599121 | instance | Tuesday 07 April 2026 09:02:37 +0000 (0:00:00.045) 0:00:17.679 ********* 2026-04-07 09:02:38.332006 | instance | ok: [instance] 2026-04-07 09:02:38.332048 | instance | 2026-04-07 09:02:38.332055 | instance | TASK [vexxhost.atmosphere.sysctl : Configure sysctl values] ******************** 2026-04-07 09:02:38.332060 | instance | Tuesday 07 April 2026 09:02:38 +0000 (0:00:00.732) 0:00:18.412 ********* 2026-04-07 09:02:43.582080 | instance | changed: [instance] => (item={'name': 'fs.aio-max-nr', 'value': 1048576}) 2026-04-07 09:02:43.582184 | instance | changed: [instance] => (item={'name': 'net.ipv4.tcp_timestamps', 'value': 0}) 2026-04-07 09:02:43.582196 | instance | changed: [instance] => (item={'name': 'net.ipv4.tcp_sack', 'value': 1}) 2026-04-07 09:02:43.582206 | instance | changed: [instance] => (item={'name': 'net.core.netdev_budget', 'value': 1000}) 2026-04-07 09:02:43.582215 | instance | changed: [instance] => (item={'name': 'net.core.netdev_max_backlog', 'value': 250000}) 2026-04-07 09:02:43.582225 | instance | changed: [instance] => (item={'name': 'net.core.rmem_max', 'value': 4194304}) 2026-04-07 09:02:43.582234 | instance | changed: [instance] => (item={'name': 'net.core.wmem_max', 'value': 4194304}) 2026-04-07 09:02:43.582243 | instance | changed: [instance] => (item={'name': 'net.core.rmem_default', 'value': 4194304}) 2026-04-07 09:02:43.582262 | instance | changed: [instance] => (item={'name': 'net.core.wmem_default', 'value': 4194304}) 2026-04-07 09:02:43.582271 | instance | changed: [instance] => (item={'name': 'net.core.optmem_max', 'value': 4194304}) 2026-04-07 09:02:43.583870 | instance | changed: [instance] => (item={'name': 'net.ipv4.tcp_rmem', 'value': '4096 87380 4194304'}) 2026-04-07 09:02:43.583928 | instance | changed: [instance] => (item={'name': 'net.ipv4.tcp_wmem', 'value': '4096 65536 4194304'}) 2026-04-07 09:02:43.583934 | instance | changed: [instance] => (item={'name': 'net.ipv4.tcp_low_latency', 'value': 1}) 2026-04-07 09:02:43.583939 | instance | changed: [instance] => (item={'name': 'net.ipv4.tcp_adv_win_scale', 'value': 1}) 2026-04-07 09:02:43.583944 | instance | changed: [instance] => (item={'name': 'net.ipv4.neigh.default.gc_thresh1', 'value': 128}) 2026-04-07 09:02:43.583948 | instance | changed: [instance] => (item={'name': 'net.ipv4.neigh.default.gc_thresh2', 'value': 28872}) 2026-04-07 09:02:43.583952 | instance | changed: [instance] => (item={'name': 'net.ipv4.neigh.default.gc_thresh3', 'value': 32768}) 2026-04-07 09:02:43.583956 | instance | changed: [instance] => (item={'name': 'net.ipv6.neigh.default.gc_thresh1', 'value': 128}) 2026-04-07 09:02:43.583961 | instance | changed: [instance] => (item={'name': 'net.ipv6.neigh.default.gc_thresh2', 'value': 28872}) 2026-04-07 09:02:43.583965 | instance | changed: [instance] => (item={'name': 'net.ipv6.neigh.default.gc_thresh3', 'value': 32768}) 2026-04-07 09:02:43.583969 | instance | 2026-04-07 09:02:43.583974 | instance | TASK [vexxhost.atmosphere.ethtool : Create folder for persistent configuration] *** 2026-04-07 09:02:43.583978 | instance | Tuesday 07 April 2026 09:02:43 +0000 (0:00:05.249) 0:00:23.662 ********* 2026-04-07 09:02:43.809705 | instance | changed: [instance] 2026-04-07 09:02:43.809794 | instance | 2026-04-07 09:02:43.810255 | instance | TASK [vexxhost.atmosphere.ethtool : Install persistent "ethtool" tuning] ******* 2026-04-07 09:02:43.810333 | instance | Tuesday 07 April 2026 09:02:43 +0000 (0:00:00.228) 0:00:23.890 ********* 2026-04-07 09:02:44.223458 | instance | changed: [instance] 2026-04-07 09:02:44.223593 | instance | 2026-04-07 09:02:44.223930 | instance | TASK [vexxhost.atmosphere.ethtool : Run "ethtool" tuning] ********************** 2026-04-07 09:02:44.223951 | instance | Tuesday 07 April 2026 09:02:44 +0000 (0:00:00.413) 0:00:24.303 ********* 2026-04-07 09:02:44.569064 | instance | ok: [instance] 2026-04-07 09:02:44.569143 | instance | 2026-04-07 09:02:44.569460 | instance | TASK [Set a fact with the "atmosphere_images" for other plays] ***************** 2026-04-07 09:02:44.569523 | instance | Tuesday 07 April 2026 09:02:44 +0000 (0:00:00.346) 0:00:24.650 ********* 2026-04-07 09:02:44.720806 | instance | ok: [instance] 2026-04-07 09:02:44.720884 | instance | 2026-04-07 09:02:44.721481 | instance | PLAY [Configure Kubernetes VIP] ************************************************ 2026-04-07 09:02:44.721499 | instance | 2026-04-07 09:02:44.721504 | instance | TASK [Gathering Facts] ********************************************************* 2026-04-07 09:02:44.721508 | instance | Tuesday 07 April 2026 09:02:44 +0000 (0:00:00.151) 0:00:24.801 ********* 2026-04-07 09:02:45.449119 | instance | ok: [instance] 2026-04-07 09:02:45.449203 | instance | 2026-04-07 09:02:45.449481 | instance | TASK [vexxhost.containers.directory : Create directory (/etc/kubernetes/manifests)] *** 2026-04-07 09:02:45.449540 | instance | Tuesday 07 April 2026 09:02:45 +0000 (0:00:00.727) 0:00:25.529 ********* 2026-04-07 09:02:45.697894 | instance | changed: [instance] 2026-04-07 09:02:45.697999 | instance | 2026-04-07 09:02:45.698123 | instance | TASK [vexxhost.kubernetes.kube_vip : Uninstall legacy HA stack] **************** 2026-04-07 09:02:45.698244 | instance | Tuesday 07 April 2026 09:02:45 +0000 (0:00:00.248) 0:00:25.778 ********* 2026-04-07 09:02:46.692053 | instance | ok: [instance] => (item=/etc/keepalived/keepalived.conf) 2026-04-07 09:02:46.692295 | instance | ok: [instance] => (item=/etc/keepalived/check_apiserver.sh) 2026-04-07 09:02:46.692568 | instance | ok: [instance] => (item=/etc/kubernetes/manifests/keepalived.yaml) 2026-04-07 09:02:46.692835 | instance | ok: [instance] => (item=/etc/haproxy/haproxy.cfg) 2026-04-07 09:02:46.693101 | instance | ok: [instance] => (item=/etc/kubernetes/manifests/haproxy.yaml) 2026-04-07 09:02:46.693349 | instance | 2026-04-07 09:02:46.693623 | instance | TASK [vexxhost.kubernetes.kube_vip : Switch API server to run on port 6443] **** 2026-04-07 09:02:46.693891 | instance | Tuesday 07 April 2026 09:02:46 +0000 (0:00:00.993) 0:00:26.772 ********* 2026-04-07 09:02:46.974305 | instance | 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-07 09:02:47.149901 | instance | 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-07 09:02:47.330468 | instance | 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-07 09:02:47.342132 | instance | ...ignoring 2026-04-07 09:02:47.342466 | instance | 2026-04-07 09:02:47.342825 | instance | TASK [vexxhost.kubernetes.kube_vip : Check if super-admin.conf exists] ********* 2026-04-07 09:02:47.343176 | instance | Tuesday 07 April 2026 09:02:47 +0000 (0:00:00.650) 0:00:27.422 ********* 2026-04-07 09:02:47.662936 | instance | ok: [instance] 2026-04-07 09:02:47.663176 | instance | 2026-04-07 09:02:47.663455 | instance | TASK [vexxhost.kubernetes.kube_vip : Check if kubeadm has already run] ********* 2026-04-07 09:02:47.663788 | instance | Tuesday 07 April 2026 09:02:47 +0000 (0:00:00.320) 0:00:27.743 ********* 2026-04-07 09:02:47.875464 | instance | ok: [instance] 2026-04-07 09:02:47.875543 | instance | 2026-04-07 09:02:47.875555 | instance | TASK [vexxhost.kubernetes.kube_vip : Set fact with KUBECONFIG path] ************ 2026-04-07 09:02:47.875565 | instance | Tuesday 07 April 2026 09:02:47 +0000 (0:00:00.211) 0:00:27.955 ********* 2026-04-07 09:02:47.907459 | instance | ok: [instance] 2026-04-07 09:02:47.908539 | instance | 2026-04-07 09:02:47.908614 | instance | TASK [vexxhost.kubernetes.kube_vip : Set fact with KUBECONFIG path (with super-admin.conf)] *** 2026-04-07 09:02:47.908627 | instance | Tuesday 07 April 2026 09:02:47 +0000 (0:00:00.032) 0:00:27.987 ********* 2026-04-07 09:02:47.950976 | instance | ok: [instance] 2026-04-07 09:02:47.951095 | instance | 2026-04-07 09:02:47.951345 | instance | TASK [vexxhost.kubernetes.kube_vip : Upload Kubernetes manifest] *************** 2026-04-07 09:02:47.951606 | instance | Tuesday 07 April 2026 09:02:47 +0000 (0:00:00.043) 0:00:28.031 ********* 2026-04-07 09:02:48.107075 | instance | An exception occurred during task execution. To see the full traceback, use -vvv. The error was: ansible.errors.AnsibleUndefinedVariable: {{ keepalived_vip | default(kubernetes_keepalived_vip) }}: 'kubernetes_keepalived_vip' is undefined 2026-04-07 09:02:48.107578 | instance | fatal: [instance]: FAILED! => {"changed": false, "msg": "AnsibleUndefinedVariable: {{ keepalived_vip | default(kubernetes_keepalived_vip) }}: 'kubernetes_keepalived_vip' is undefined"} 2026-04-07 09:02:48.109947 | instance | 2026-04-07 09:02:48.110199 | instance | PLAY RECAP ********************************************************************* 2026-04-07 09:02:48.114059 | instance | instance : ok=19 changed=6 unreachable=0 failed=1 skipped=0 rescued=0 ignored=1 2026-04-07 09:02:48.114152 | instance | localhost : ok=40 changed=21 unreachable=0 failed=0 skipped=1 rescued=0 ignored=0 2026-04-07 09:02:48.114166 | instance | 2026-04-07 09:02:48.114178 | instance | Tuesday 07 April 2026 09:02:48 +0000 (0:00:00.160) 0:00:28.191 ********* 2026-04-07 09:02:48.114189 | instance | =============================================================================== 2026-04-07 09:02:48.114199 | instance | vexxhost.atmosphere.sysctl : Configure sysctl values -------------------- 5.25s 2026-04-07 09:02:48.114209 | instance | Generate SSH keys for missing variables --------------------------------- 2.48s 2026-04-07 09:02:48.114219 | instance | Install "dirmngr" for GPG keyserver operations -------------------------- 1.71s 2026-04-07 09:02:48.114229 | instance | Purge "snapd" package --------------------------------------------------- 1.29s 2026-04-07 09:02:48.114238 | instance | Create folders for workspace -------------------------------------------- 1.21s 2026-04-07 09:02:48.114248 | instance | Gathering Facts --------------------------------------------------------- 1.04s 2026-04-07 09:02:48.114258 | instance | vexxhost.kubernetes.kube_vip : Uninstall legacy HA stack ---------------- 0.99s 2026-04-07 09:02:48.114268 | instance | Configure short hostname ------------------------------------------------ 0.83s 2026-04-07 09:02:48.114277 | instance | Generate endpoint skeleton for missing variables ------------------------ 0.77s 2026-04-07 09:02:48.114287 | instance | Gathering Facts --------------------------------------------------------- 0.75s 2026-04-07 09:02:48.114297 | instance | Gathering Facts --------------------------------------------------------- 0.73s 2026-04-07 09:02:48.114306 | instance | Gathering Facts --------------------------------------------------------- 0.73s 2026-04-07 09:02:48.114316 | instance | vexxhost.kubernetes.kube_vip : Switch API server to run on port 6443 ---- 0.65s 2026-04-07 09:02:48.114326 | instance | Write new Ceph control plane configuration file to disk ----------------- 0.62s 2026-04-07 09:02:48.114336 | instance | Generate secrets for missing variables ---------------------------------- 0.50s 2026-04-07 09:02:48.114352 | instance | Generate temporary files for generating keys for missing variables ------ 0.48s 2026-04-07 09:02:48.114362 | instance | vexxhost.atmosphere.ethtool : Install persistent "ethtool" tuning ------- 0.41s 2026-04-07 09:02:48.114565 | instance | Delete the temporary files generated for SSH keys ----------------------- 0.41s 2026-04-07 09:02:48.114797 | instance | Write new endpoints file to disk ---------------------------------------- 0.40s 2026-04-07 09:02:48.115025 | instance | Write new Ceph OSDs configuration file to disk -------------------------- 0.39s 2026-04-07 09:02:48.215389 | instance | CRITICAL Ansible return code was 2, command was: ansible-playbook --inventory /home/zuul/.ansible/tmp/molecule.v9Wo.keycloak/inventory --skip-tags molecule-notest,notest /home/zuul/src/github.com/vexxhost/atmosphere/molecule/keycloak/prepare.yml 2026-04-07 09:02:48.215787 | instance | ERROR [keycloak > prepare] Executed: Failed 2026-04-07 09:02:48.216062 | instance | ERROR Ansible return code was 2, command was: ansible-playbook --inventory /home/zuul/.ansible/tmp/molecule.v9Wo.keycloak/inventory --skip-tags molecule-notest,notest /home/zuul/src/github.com/vexxhost/atmosphere/molecule/keycloak/prepare.yml 2026-04-07 09:02:48.482021 | instance | ERROR 2026-04-07 09:02:48.482228 | instance | { 2026-04-07 09:02:48.482272 | instance | "delta": "0:02:50.850234", 2026-04-07 09:02:48.482304 | instance | "end": "2026-04-07 09:02:48.335369", 2026-04-07 09:02:48.482341 | instance | "msg": "non-zero return code", 2026-04-07 09:02:48.482369 | instance | "rc": 2, 2026-04-07 09:02:48.482398 | instance | "start": "2026-04-07 08:59:57.485135" 2026-04-07 09:02:48.482423 | instance | } failure 2026-04-07 09:02:48.489689 | 2026-04-07 09:02:48.489758 | PLAY RECAP 2026-04-07 09:02:48.489805 | instance | ok: 2 changed: 2 unreachable: 0 failed: 1 skipped: 0 rescued: 0 ignored: 0 2026-04-07 09:02:48.489828 | 2026-04-07 09:02:48.608136 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-04-07 09:02:48.612339 | POST-RUN START: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/post.yml@main] 2026-04-07 09:02:49.192311 | 2026-04-07 09:02:49.192436 | PLAY [all] 2026-04-07 09:02:49.206334 | 2026-04-07 09:02:49.206424 | TASK [gather-host-logs : creating directory for system status] 2026-04-07 09:02:49.552405 | instance | changed 2026-04-07 09:02:49.559354 | 2026-04-07 09:02:49.559455 | TASK [gather-host-logs : Get logs for each host] 2026-04-07 09:02:49.895332 | instance | + systemd-cgls --full --all --no-pager 2026-04-07 09:02:49.910003 | instance | + ip addr 2026-04-07 09:02:49.911533 | instance | + ip route 2026-04-07 09:02:49.912714 | instance | + lsblk 2026-04-07 09:02:49.915006 | instance | + mount 2026-04-07 09:02:49.916396 | instance | + docker images 2026-04-07 09:02:49.916859 | instance | /bin/bash: line 7: docker: command not found 2026-04-07 09:02:49.917145 | instance | + brctl show 2026-04-07 09:02:49.917565 | instance | /bin/bash: line 8: brctl: command not found 2026-04-07 09:02:49.917800 | instance | + ps aux --sort=-%mem 2026-04-07 09:02:49.928744 | instance | + dpkg -l 2026-04-07 09:02:49.936380 | instance | + CONTAINERS=($(docker ps -a --format '{{ .Names }}' --filter label=zuul)) 2026-04-07 09:02:49.936909 | instance | ++ docker ps -a --format '{{ .Names }}' --filter label=zuul 2026-04-07 09:02:49.936943 | instance | /bin/bash: line 11: docker: command not found 2026-04-07 09:02:49.937288 | instance | + '[' '!' -z '' ']' 2026-04-07 09:02:50.097004 | instance | ok: Runtime: 0:00:00.046790 2026-04-07 09:02:50.105376 | 2026-04-07 09:02:50.105446 | TASK [gather-host-logs : Downloads logs to executor] 2026-04-07 09:02:50.737609 | instance | changed: 2026-04-07 09:02:50.737820 | instance | created directory /var/lib/zuul/builds/a734d292dd804e2db4b7e26dab0f0648/work/logs/instance 2026-04-07 09:02:50.737863 | instance | cd+++++++++ system/ 2026-04-07 09:02:50.737896 | instance | >f+++++++++ system/brctl-show.txt 2026-04-07 09:02:50.737929 | instance | >f+++++++++ system/docker-images.txt 2026-04-07 09:02:50.737959 | instance | >f+++++++++ system/ip-addr.txt 2026-04-07 09:02:50.737994 | instance | >f+++++++++ system/ip-route.txt 2026-04-07 09:02:50.738025 | instance | >f+++++++++ system/lsblk.txt 2026-04-07 09:02:50.738053 | instance | >f+++++++++ system/mount.txt 2026-04-07 09:02:50.738084 | instance | >f+++++++++ system/packages.txt 2026-04-07 09:02:50.738113 | instance | >f+++++++++ system/ps.txt 2026-04-07 09:02:50.738141 | instance | >f+++++++++ system/systemd-cgls.txt 2026-04-07 09:02:50.749849 | 2026-04-07 09:02:50.749920 | LOOP [helm-release-status : creating directory for helm release status] 2026-04-07 09:02:50.954473 | instance | changed: "values" 2026-04-07 09:02:51.136186 | instance | changed: "releases" 2026-04-07 09:02:51.149839 | 2026-04-07 09:02:51.149972 | TASK [helm-release-status : Gather get release status for helm charts] 2026-04-07 09:02:51.382970 | instance | /bin/bash: line 3: kubectl: command not found 2026-04-07 09:02:51.691350 | instance | ok: Runtime: 0:00:00.007423 2026-04-07 09:02:51.697256 | 2026-04-07 09:02:51.697338 | TASK [helm-release-status : Downloads logs to executor] 2026-04-07 09:02:52.173478 | instance | changed: 2026-04-07 09:02:52.173694 | instance | cd+++++++++ helm/ 2026-04-07 09:02:52.173734 | instance | cd+++++++++ helm/releases/ 2026-04-07 09:02:52.173763 | instance | cd+++++++++ helm/values/ 2026-04-07 09:02:52.185685 | 2026-04-07 09:02:52.185824 | TASK [describe-kubernetes-objects : creating directory for cluster scoped objects] 2026-04-07 09:02:52.393723 | instance | changed 2026-04-07 09:02:52.401458 | 2026-04-07 09:02:52.401601 | TASK [describe-kubernetes-objects : Gathering descriptions for cluster scoped objects] 2026-04-07 09:02:52.612620 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-07 09:02:52.613227 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-07 09:02:52.618284 | instance | environment: line 1: kubectl: command not found 2026-04-07 09:02:52.619808 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-07 09:02:52.621493 | instance | environment: line 1: kubectl: command not found 2026-04-07 09:02:52.622984 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-07 09:02:52.623670 | instance | environment: line 1: kubectl: command not found 2026-04-07 09:02:52.624717 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-07 09:02:52.626060 | instance | environment: line 1: kubectl: command not found 2026-04-07 09:02:52.627477 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-07 09:02:52.628334 | instance | environment: line 1: kubectl: command not found 2026-04-07 09:02:52.629378 | instance | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-07 09:02:52.940927 | instance | ok: Runtime: 0:00:00.025619 2026-04-07 09:02:52.948387 | 2026-04-07 09:02:52.948583 | TASK [describe-kubernetes-objects : creating directory for namespace scoped objects] 2026-04-07 09:02:53.145737 | instance | changed 2026-04-07 09:02:53.151004 | 2026-04-07 09:02:53.151092 | TASK [describe-kubernetes-objects : Gathering descriptions for namespace scoped objects] 2026-04-07 09:02:53.383784 | instance | environment: line 5: kubectl: command not found 2026-04-07 09:02:53.384075 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-07 09:02:53.384950 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-07 09:02:53.385303 | instance | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-07 09:02:53.716157 | instance | ok: Runtime: 0:00:00.011121 2026-04-07 09:02:53.722586 | 2026-04-07 09:02:53.722662 | TASK [describe-kubernetes-objects : Downloads logs to executor] 2026-04-07 09:02:54.210679 | instance | changed: 2026-04-07 09:02:54.210943 | instance | cd+++++++++ objects/ 2026-04-07 09:02:54.211003 | instance | cd+++++++++ objects/cluster/ 2026-04-07 09:02:54.211051 | instance | cd+++++++++ objects/namespaced/ 2026-04-07 09:02:54.221255 | 2026-04-07 09:02:54.221318 | TASK [gather-pod-logs : creating directory for pod logs] 2026-04-07 09:02:54.416074 | instance | changed 2026-04-07 09:02:54.422849 | 2026-04-07 09:02:54.422946 | TASK [gather-pod-logs : creating directory for failed pod logs] 2026-04-07 09:02:54.619676 | instance | changed 2026-04-07 09:02:54.624426 | 2026-04-07 09:02:54.624494 | TASK [gather-pod-logs : retrieve all kubernetes logs, current and previous (if they exist)] 2026-04-07 09:02:54.844114 | instance | environment: line 3: kubectl: command not found 2026-04-07 09:02:55.158497 | instance | ok: Runtime: 0:00:00.008042 2026-04-07 09:02:55.165936 | 2026-04-07 09:02:55.166005 | TASK [gather-pod-logs : Downloads pod logs to executor] 2026-04-07 09:02:55.654805 | instance | changed: 2026-04-07 09:02:55.655028 | instance | cd+++++++++ pod-logs/ 2026-04-07 09:02:55.655070 | instance | cd+++++++++ pod-logs/failed-pods/ 2026-04-07 09:02:55.668604 | 2026-04-07 09:02:55.668744 | TASK [gather-prom-metrics : creating directory for helm release descriptions] 2026-04-07 09:02:55.862968 | instance | changed 2026-04-07 09:02:55.868999 | 2026-04-07 09:02:55.869070 | TASK [gather-prom-metrics : Get metrics from exporter services in all namespaces] 2026-04-07 09:02:56.145093 | instance | /bin/bash: line 2: kubectl: command not found 2026-04-07 09:02:56.410980 | instance | ok: Runtime: 0:00:00.041967 2026-04-07 09:02:56.416647 | 2026-04-07 09:02:56.416786 | TASK [gather-prom-metrics : Get ceph metrics from ceph-mgr] 2026-04-07 09:02:56.642238 | instance | /bin/bash: line 2: kubectl: command not found 2026-04-07 09:02:56.671296 | instance | ceph-mgr endpoints: 2026-04-07 09:02:56.954674 | instance | ok: Runtime: 0:00:00.037703 2026-04-07 09:02:56.971999 | 2026-04-07 09:02:56.972094 | TASK [gather-prom-metrics : Get metrics from fluentd pods] 2026-04-07 09:02:57.180019 | instance | /bin/bash: line 4: kubectl: command not found 2026-04-07 09:02:57.505888 | instance | ok: Runtime: 0:00:00.035688 2026-04-07 09:02:57.511145 | 2026-04-07 09:02:57.511210 | TASK [gather-prom-metrics : Downloads logs to executor] 2026-04-07 09:02:58.001498 | instance | changed: cd+++++++++ prometheus/ 2026-04-07 09:02:58.012277 | 2026-04-07 09:02:58.012357 | TASK [gather-selenium-data : creating directory for helm release descriptions] 2026-04-07 09:02:58.220200 | instance | changed 2026-04-07 09:02:58.225202 | 2026-04-07 09:02:58.225274 | TASK [gather-selenium-data : Get selenium data] 2026-04-07 09:02:58.429058 | instance | + cp '/tmp/artifacts/*' /tmp/logs/selenium/. 2026-04-07 09:02:58.430468 | instance | cp: cannot stat '/tmp/artifacts/*': No such file or directory 2026-04-07 09:02:58.757714 | instance | ERROR 2026-04-07 09:02:58.757945 | instance | { 2026-04-07 09:02:58.757988 | instance | "delta": "0:00:00.006578", 2026-04-07 09:02:58.758020 | instance | "end": "2026-04-07 09:02:58.430776", 2026-04-07 09:02:58.758047 | instance | "msg": "non-zero return code", 2026-04-07 09:02:58.758074 | instance | "rc": 1, 2026-04-07 09:02:58.758101 | instance | "start": "2026-04-07 09:02:58.424198" 2026-04-07 09:02:58.758127 | instance | } 2026-04-07 09:02:58.758160 | instance | ERROR: Ignoring Errors 2026-04-07 09:02:58.764826 | 2026-04-07 09:02:58.764905 | TASK [gather-selenium-data : Downloads logs to executor] 2026-04-07 09:02:59.265216 | instance | changed: cd+++++++++ selenium/ 2026-04-07 09:02:59.271029 | 2026-04-07 09:02:59.271078 | PLAY RECAP 2026-04-07 09:02:59.271122 | instance | ok: 23 changed: 23 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 1 2026-04-07 09:02:59.271144 | 2026-04-07 09:02:59.387527 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/atmosphere/test-playbooks/molecule/post.yml@main] 2026-04-07 09:02:59.393554 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-07 09:02:59.983338 | 2026-04-07 09:02:59.983459 | PLAY [all] 2026-04-07 09:02:59.994981 | 2026-04-07 09:02:59.995068 | TASK [fetch-output : Set log path for multiple nodes] 2026-04-07 09:03:00.039407 | instance | skipping: Conditional result was False 2026-04-07 09:03:00.049916 | 2026-04-07 09:03:00.050029 | TASK [fetch-output : Set log path for single node] 2026-04-07 09:03:00.085157 | instance | ok 2026-04-07 09:03:00.089830 | 2026-04-07 09:03:00.089896 | LOOP [fetch-output : Ensure local output dirs] 2026-04-07 09:03:00.454127 | instance -> localhost | ok: "/var/lib/zuul/builds/a734d292dd804e2db4b7e26dab0f0648/work/logs" 2026-04-07 09:03:00.644638 | instance -> localhost | changed: "/var/lib/zuul/builds/a734d292dd804e2db4b7e26dab0f0648/work/artifacts" 2026-04-07 09:03:00.845393 | instance -> localhost | changed: "/var/lib/zuul/builds/a734d292dd804e2db4b7e26dab0f0648/work/docs" 2026-04-07 09:03:00.868436 | 2026-04-07 09:03:00.869022 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-04-07 09:03:01.517499 | instance | changed: .d..t...... ./ 2026-04-07 09:03:01.517853 | instance | changed: All items complete 2026-04-07 09:03:01.517933 | 2026-04-07 09:03:01.963418 | instance | changed: .d..t...... ./ 2026-04-07 09:03:02.442487 | instance | changed: .d..t...... ./ 2026-04-07 09:03:02.459186 | 2026-04-07 09:03:02.459310 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-04-07 09:03:02.899242 | instance -> localhost | ok: Item: artifacts Runtime: 0:00:00.009071 2026-04-07 09:03:03.109888 | instance -> localhost | ok: Item: docs Runtime: 0:00:00.007686 2026-04-07 09:03:03.133320 | 2026-04-07 09:03:03.133490 | PLAY [all] 2026-04-07 09:03:03.139971 | 2026-04-07 09:03:03.140057 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-04-07 09:03:03.539440 | instance | changed 2026-04-07 09:03:03.545119 | 2026-04-07 09:03:03.545195 | PLAY RECAP 2026-04-07 09:03:03.545242 | instance | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-04-07 09:03:03.545266 | 2026-04-07 09:03:03.669455 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-07 09:03:03.671930 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main] 2026-04-07 09:03:04.235036 | 2026-04-07 09:03:04.235172 | PLAY [localhost] 2026-04-07 09:03:04.245542 | 2026-04-07 09:03:04.245628 | TASK [Generate Zuul manifest] 2026-04-07 09:03:04.265547 | localhost | ok 2026-04-07 09:03:04.282470 | 2026-04-07 09:03:04.282561 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-04-07 09:03:04.626997 | localhost | changed 2026-04-07 09:03:04.637006 | 2026-04-07 09:03:04.637107 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-04-07 09:03:04.668640 | localhost | ok 2026-04-07 09:03:04.681427 | 2026-04-07 09:03:04.681515 | TASK [Upload logs] 2026-04-07 09:03:04.701720 | localhost | ok 2026-04-07 09:03:04.759084 | 2026-04-07 09:03:04.759216 | TASK [Set zuul-log-path fact] 2026-04-07 09:03:04.779470 | localhost | ok 2026-04-07 09:03:04.791736 | 2026-04-07 09:03:04.791804 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-07 09:03:04.823108 | localhost | ok 2026-04-07 09:03:04.831881 | 2026-04-07 09:03:04.831964 | TASK [upload-logs : Create log directories] 2026-04-07 09:03:05.215683 | localhost | changed 2026-04-07 09:03:05.220378 | 2026-04-07 09:03:05.220449 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-04-07 09:03:05.619952 | localhost -> localhost | ok: Runtime: 0:00:00.004247 2026-04-07 09:03:05.624759 | 2026-04-07 09:03:05.624822 | TASK [upload-logs : Upload logs to log server] 2026-04-07 09:03:06.069457 | localhost | Output suppressed because no_log was given 2026-04-07 09:03:06.074467 | 2026-04-07 09:03:06.074562 | LOOP [upload-logs : Compress console log and json output] 2026-04-07 09:03:06.121381 | localhost | skipping: Conditional result was False 2026-04-07 09:03:06.128803 | localhost | skipping: Conditional result was False 2026-04-07 09:03:06.139025 | 2026-04-07 09:03:06.139225 | LOOP [upload-logs : Upload compressed console log and json output] 2026-04-07 09:03:06.178751 | localhost | skipping: Conditional result was False 2026-04-07 09:03:06.179168 | 2026-04-07 09:03:06.182892 | localhost | skipping: Conditional result was False 2026-04-07 09:03:06.192670 | 2026-04-07 09:03:06.192836 | LOOP [upload-logs : Upload console log and json output]