2026-10-03 01:00:03.730628 | Job console starting 2026-10-03 01:00:03.751810 | Updating git repos 2026-10-03 01:00:03.796925 | Cloning repos into workspace 2026-10-03 01:00:03.913447 | Restoring repo states 2026-10-03 01:00:03.922236 | Merging changes 2026-10-03 01:00:04.477707 | Checking out repos 2026-10-03 01:00:04.509504 | Preparing playbooks 2026-10-03 01:00:06.512599 | Running Ansible setup 2026-10-03 01:00:09.911282 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-10-03 01:00:10.506665 | 2026-10-03 01:00:10.639143 | PLAY [localhost] 2026-10-03 01:00:10.662083 | 2026-10-03 01:00:10.662277 | TASK [Gathering Facts] 2026-10-03 01:00:11.634737 | localhost | ok 2026-10-03 01:00:11.644069 | 2026-10-03 01:00:11.644156 | TASK [Setup log path fact] 2026-10-03 01:00:11.675272 | localhost | ok 2026-10-03 01:00:11.705531 | 2026-10-03 01:00:11.705692 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-10-03 01:00:11.735694 | localhost | ok 2026-10-03 01:00:11.747652 | 2026-10-03 01:00:11.747767 | TASK [emit-job-header : Print job information] 2026-10-03 01:00:11.797971 | # Job Information 2026-10-03 01:00:11.798203 | Ansible Version: 2.16.18 2026-10-03 01:00:11.798267 | Job: ansible-collection-containers-molecule-docker-ubuntu-focal 2026-10-03 01:00:11.798311 | Pipeline: check 2026-10-03 01:00:11.798351 | Executor: 2d72f0692154 2026-10-03 01:00:11.798388 | Triggered by: https://github.com/vexxhost/ansible-collection-containers/pull/151 2026-10-03 01:00:11.798432 | Event ID: b0137a50-bec4-11f1-84ce-3c336adaba37 2026-10-03 01:00:11.803646 | 2026-10-03 01:00:11.803901 | LOOP [emit-job-header : Print node information] 2026-10-03 01:00:11.903058 | localhost | ok: 2026-10-03 01:00:11.903526 | localhost | # Node Information 2026-10-03 01:00:11.903569 | localhost | Inventory Hostname: ubuntu-focal 2026-10-03 01:00:11.903599 | localhost | Hostname: np0000194451 2026-10-03 01:00:11.903624 | localhost | Username: zuul 2026-10-03 01:00:11.903653 | localhost | Distro: Ubuntu 20.04 2026-10-03 01:00:11.903679 | localhost | Provider: yul1 2026-10-03 01:00:11.903703 | localhost | Region: ca-ymq-1 2026-10-03 01:00:11.903726 | localhost | Label: ubuntu-focal 2026-10-03 01:00:11.903750 | localhost | Product Name: OpenStack Nova 2026-10-03 01:00:11.903773 | localhost | Interface IP: 162.253.55.76 2026-10-03 01:00:11.927752 | 2026-10-03 01:00:11.927971 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-10-03 01:00:12.325460 | localhost -> localhost | changed 2026-10-03 01:00:12.331703 | 2026-10-03 01:00:12.331788 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-10-03 01:00:13.164677 | localhost -> localhost | changed 2026-10-03 01:00:13.175485 | 2026-10-03 01:00:13.175592 | PLAY [all] 2026-10-03 01:00:13.190314 | 2026-10-03 01:00:13.190445 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-10-03 01:00:13.438632 | ubuntu-focal -> localhost | ok 2026-10-03 01:00:13.449106 | 2026-10-03 01:00:13.449261 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-10-03 01:00:13.481889 | ubuntu-focal | ok 2026-10-03 01:00:13.513093 | ubuntu-focal | included: /var/lib/zuul/builds/d016bbc716924667bb0982e7840b1011/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-10-03 01:00:13.520640 | 2026-10-03 01:00:13.520718 | TASK [add-build-sshkey : Create Temp SSH key] 2026-10-03 01:00:14.644389 | ubuntu-focal -> localhost | Generating public/private rsa key pair. 2026-10-03 01:00:14.644676 | ubuntu-focal -> localhost | Your identification has been saved in /var/lib/zuul/builds/d016bbc716924667bb0982e7840b1011/work/d016bbc716924667bb0982e7840b1011_id_rsa 2026-10-03 01:00:14.644757 | ubuntu-focal -> localhost | Your public key has been saved in /var/lib/zuul/builds/d016bbc716924667bb0982e7840b1011/work/d016bbc716924667bb0982e7840b1011_id_rsa.pub 2026-10-03 01:00:14.644820 | ubuntu-focal -> localhost | The key fingerprint is: 2026-10-03 01:00:14.644887 | ubuntu-focal -> localhost | SHA256:QjoaRon/N/oF4QVsBroODmLkvTw5Mb+beSN4c5CmIg0 zuul-build-sshkey 2026-10-03 01:00:14.644970 | ubuntu-focal -> localhost | The key's randomart image is: 2026-10-03 01:00:14.645014 | ubuntu-focal -> localhost | +---[RSA 3072]----+ 2026-10-03 01:00:14.645080 | ubuntu-focal -> localhost | | .o. | 2026-10-03 01:00:14.645320 | ubuntu-focal -> localhost | | . o +. | 2026-10-03 01:00:14.645388 | ubuntu-focal -> localhost | |..+ oo . | 2026-10-03 01:00:14.645439 | ubuntu-focal -> localhost | |oo.. + o | 2026-10-03 01:00:14.645480 | ubuntu-focal -> localhost | |+o=+o = S | 2026-10-03 01:00:14.645518 | ubuntu-focal -> localhost | |E+.+*= o | 2026-10-03 01:00:14.645572 | ubuntu-focal -> localhost | | +o*=.+ . | 2026-10-03 01:00:14.645612 | ubuntu-focal -> localhost | |...oo*+* | 2026-10-03 01:00:14.645656 | ubuntu-focal -> localhost | |. . o*B . | 2026-10-03 01:00:14.645694 | ubuntu-focal -> localhost | +----[SHA256]-----+ 2026-10-03 01:00:14.645798 | ubuntu-focal -> localhost | ok: Runtime: 0:00:00.709375 2026-10-03 01:00:14.657481 | 2026-10-03 01:00:14.657660 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-10-03 01:00:14.692491 | ubuntu-focal | ok 2026-10-03 01:00:14.709572 | ubuntu-focal | included: /var/lib/zuul/builds/d016bbc716924667bb0982e7840b1011/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-10-03 01:00:14.721883 | 2026-10-03 01:00:14.722057 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-10-03 01:00:14.759482 | ubuntu-focal | skipping: Conditional result was False 2026-10-03 01:00:14.766687 | 2026-10-03 01:00:14.766811 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-10-03 01:00:15.226289 | ubuntu-focal | changed 2026-10-03 01:00:15.239650 | 2026-10-03 01:00:15.240077 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-10-03 01:00:15.421227 | ubuntu-focal | ok 2026-10-03 01:00:15.429007 | 2026-10-03 01:00:15.429103 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-10-03 01:00:15.908775 | ubuntu-focal | changed 2026-10-03 01:00:15.918956 | 2026-10-03 01:00:15.919080 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-10-03 01:00:16.398661 | ubuntu-focal | changed 2026-10-03 01:00:16.408317 | 2026-10-03 01:00:16.408472 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-10-03 01:00:16.433314 | ubuntu-focal | skipping: Conditional result was False 2026-10-03 01:00:16.443635 | 2026-10-03 01:00:16.443767 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-10-03 01:00:16.824461 | ubuntu-focal -> localhost | changed 2026-10-03 01:00:16.854353 | 2026-10-03 01:00:16.854485 | TASK [add-build-sshkey : Add back temp key] 2026-10-03 01:00:17.144388 | ubuntu-focal -> localhost | Identity added: /var/lib/zuul/builds/d016bbc716924667bb0982e7840b1011/work/d016bbc716924667bb0982e7840b1011_id_rsa (zuul-build-sshkey) 2026-10-03 01:00:17.144711 | ubuntu-focal -> localhost | ok: Runtime: 0:00:00.012354 2026-10-03 01:00:17.154543 | 2026-10-03 01:00:17.154665 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-10-03 01:00:17.502608 | ubuntu-focal | ok 2026-10-03 01:00:17.512200 | 2026-10-03 01:00:17.512323 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-10-03 01:00:17.538153 | ubuntu-focal | skipping: Conditional result was False 2026-10-03 01:00:17.558855 | 2026-10-03 01:00:17.559057 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-10-03 01:00:17.878165 | ubuntu-focal | ok 2026-10-03 01:00:17.891642 | 2026-10-03 01:00:17.891819 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-10-03 01:00:18.636635 | ubuntu-focal | Output suppressed because no_log was given 2026-10-03 01:00:18.654574 | 2026-10-03 01:00:18.654736 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-10-03 01:00:18.910393 | ubuntu-focal | ok: "logs" 2026-10-03 01:00:18.910619 | ubuntu-focal | ok: All items complete 2026-10-03 01:00:18.910652 | 2026-10-03 01:00:19.013047 | ubuntu-focal | ok: "artifacts" 2026-10-03 01:00:19.178851 | ubuntu-focal | ok: "docs" 2026-10-03 01:00:19.192047 | 2026-10-03 01:00:19.192132 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-10-03 01:00:19.371571 | ubuntu-focal | changed: "logs" 2026-10-03 01:00:19.516333 | ubuntu-focal | changed: "artifacts" 2026-10-03 01:00:19.642260 | ubuntu-focal | changed: "docs" 2026-10-03 01:00:19.653222 | 2026-10-03 01:00:19.653335 | PLAY RECAP 2026-10-03 01:00:19.653390 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-10-03 01:00:19.653427 | ubuntu-focal | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-10-03 01:00:19.653451 | 2026-10-03 01:00:19.802074 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-10-03 01:00:19.803552 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-10-03 01:00:20.323071 | 2026-10-03 01:00:20.323185 | PLAY [all] 2026-10-03 01:00:20.333005 | 2026-10-03 01:00:20.333107 | TASK [setup-uv : Extract archive] 2026-10-03 01:00:22.563781 | ubuntu-focal | changed 2026-10-03 01:00:22.574920 | 2026-10-03 01:00:22.575094 | TASK [setup-uv : Print version] 2026-10-03 01:00:22.933834 | ubuntu-focal | uv 0.8.13 2026-10-03 01:00:23.114820 | ubuntu-focal | ok: Runtime: 0:00:00.008340 2026-10-03 01:00:23.133046 | 2026-10-03 01:00:23.133182 | TASK [Install Ansible collection siblings] 2026-10-03 01:00:23.532210 | ubuntu-focal | ok: 2026-10-03 01:00:23.532562 | ubuntu-focal | Skipping ansible.posix: no checked-out sibling 2026-10-03 01:00:23.532657 | ubuntu-focal | Skipping community.general: no checked-out sibling 2026-10-03 01:00:23.535146 | 2026-10-03 01:00:23.535231 | PLAY RECAP 2026-10-03 01:00:23.535308 | ubuntu-focal | ok: 3 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-10-03 01:00:23.535347 | 2026-10-03 01:00:23.650752 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-10-03 01:00:23.653182 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-10-03 01:00:24.220423 | 2026-10-03 01:00:24.220584 | PLAY [all] 2026-10-03 01:00:24.230499 | 2026-10-03 01:00:24.230576 | LOOP [Check inventory directories] 2026-10-03 01:00:24.517456 | ubuntu-focal | ok: "src/github.com/vexxhost/ansible-collection-containers" 2026-10-03 01:00:24.691873 | ubuntu-focal | ok: "src/github.com/vexxhost/ansible-collection-containers/molecule/docker/inventory" 2026-10-03 01:00:24.823462 | ubuntu-focal | ok: "src/github.com/vexxhost/ansible-collection-containers/extensions/molecule/docker/inventory" 2026-10-03 01:00:24.836647 | 2026-10-03 01:00:24.836906 | LOOP [Copy inventory file for Zuul] 2026-10-03 01:00:25.621707 | ubuntu-focal | changed: 2026-10-03 01:00:25.621936 | ubuntu-focal | { 2026-10-03 01:00:25.621996 | ubuntu-focal | "ansible_loop_var": "item", 2026-10-03 01:00:25.622029 | ubuntu-focal | "changed": false, 2026-10-03 01:00:25.622058 | ubuntu-focal | "failed": false, 2026-10-03 01:00:25.622089 | ubuntu-focal | "invocation": { 2026-10-03 01:00:25.622119 | ubuntu-focal | "module_args": { 2026-10-03 01:00:25.622144 | ubuntu-focal | "checksum_algorithm": "sha1", 2026-10-03 01:00:25.622169 | ubuntu-focal | "follow": true, 2026-10-03 01:00:25.622196 | ubuntu-focal | "get_attributes": true, 2026-10-03 01:00:25.622228 | ubuntu-focal | "get_checksum": true, 2026-10-03 01:00:25.622258 | ubuntu-focal | "get_mime": true, 2026-10-03 01:00:25.622287 | ubuntu-focal | "path": "src/github.com/vexxhost/ansible-collection-containers" 2026-10-03 01:00:25.622318 | ubuntu-focal | } 2026-10-03 01:00:25.622347 | ubuntu-focal | }, 2026-10-03 01:00:25.622375 | ubuntu-focal | "item": "src/github.com/vexxhost/ansible-collection-containers", 2026-10-03 01:00:25.622419 | ubuntu-focal | "stat": { 2026-10-03 01:00:25.622451 | ubuntu-focal | "atime": 1790989218.556922, 2026-10-03 01:00:25.622481 | ubuntu-focal | "attr_flags": "e", 2026-10-03 01:00:25.622507 | ubuntu-focal | "attributes": [ 2026-10-03 01:00:25.622533 | ubuntu-focal | "extents" 2026-10-03 01:00:25.622560 | ubuntu-focal | ], 2026-10-03 01:00:25.622591 | ubuntu-focal | "block_size": 4096, 2026-10-03 01:00:25.622623 | ubuntu-focal | "blocks": 8, 2026-10-03 01:00:25.622655 | ubuntu-focal | "charset": "binary", 2026-10-03 01:00:25.622688 | ubuntu-focal | "ctime": 1790989218.556922, 2026-10-03 01:00:25.622717 | ubuntu-focal | "dev": 64513, 2026-10-03 01:00:25.622747 | ubuntu-focal | "device_type": 0, 2026-10-03 01:00:25.622778 | ubuntu-focal | "executable": true, 2026-10-03 01:00:25.622806 | ubuntu-focal | "exists": true, 2026-10-03 01:00:25.622832 | ubuntu-focal | "gid": 1000, 2026-10-03 01:00:25.622858 | ubuntu-focal | "gr_name": "zuul", 2026-10-03 01:00:25.622883 | ubuntu-focal | "inode": 1035293, 2026-10-03 01:00:25.622908 | ubuntu-focal | "isblk": false, 2026-10-03 01:00:25.622964 | ubuntu-focal | "ischr": false, 2026-10-03 01:00:25.623006 | ubuntu-focal | "isdir": true, 2026-10-03 01:00:25.623035 | ubuntu-focal | "isfifo": false, 2026-10-03 01:00:25.623064 | ubuntu-focal | "isgid": false, 2026-10-03 01:00:25.623093 | ubuntu-focal | "islnk": false, 2026-10-03 01:00:25.623120 | ubuntu-focal | "isreg": false, 2026-10-03 01:00:25.623148 | ubuntu-focal | "issock": false, 2026-10-03 01:00:25.623175 | ubuntu-focal | "isuid": false, 2026-10-03 01:00:25.623199 | ubuntu-focal | "mimetype": "inode/directory", 2026-10-03 01:00:25.623223 | ubuntu-focal | "mode": "0755", 2026-10-03 01:00:25.623250 | ubuntu-focal | "mtime": 1790989203.9487123, 2026-10-03 01:00:25.623277 | ubuntu-focal | "nlink": 11, 2026-10-03 01:00:25.623304 | ubuntu-focal | "path": "src/github.com/vexxhost/ansible-collection-containers", 2026-10-03 01:00:25.623331 | ubuntu-focal | "pw_name": "zuul", 2026-10-03 01:00:25.623358 | ubuntu-focal | "readable": true, 2026-10-03 01:00:25.623383 | ubuntu-focal | "rgrp": true, 2026-10-03 01:00:25.623408 | ubuntu-focal | "roth": true, 2026-10-03 01:00:25.623435 | ubuntu-focal | "rusr": true, 2026-10-03 01:00:25.623461 | ubuntu-focal | "size": 4096, 2026-10-03 01:00:25.623487 | ubuntu-focal | "uid": 1000, 2026-10-03 01:00:25.623513 | ubuntu-focal | "version": "2646402404", 2026-10-03 01:00:25.623542 | ubuntu-focal | "wgrp": false, 2026-10-03 01:00:25.623573 | ubuntu-focal | "woth": false, 2026-10-03 01:00:25.623601 | ubuntu-focal | "writeable": true, 2026-10-03 01:00:25.623641 | ubuntu-focal | "wusr": true, 2026-10-03 01:00:25.623669 | ubuntu-focal | "xgrp": true, 2026-10-03 01:00:25.623691 | ubuntu-focal | "xoth": true, 2026-10-03 01:00:25.623712 | ubuntu-focal | "xusr": true 2026-10-03 01:00:25.623733 | ubuntu-focal | } 2026-10-03 01:00:25.623756 | ubuntu-focal | } 2026-10-03 01:00:25.623801 | ubuntu-focal | ok: All items complete 2026-10-03 01:00:25.623828 | 2026-10-03 01:00:25.625419 | ubuntu-focal | skipping: Conditional result was False 2026-10-03 01:00:25.626128 | ubuntu-focal | skipping: Conditional result was False 2026-10-03 01:00:25.636786 | 2026-10-03 01:00:25.636886 | LOOP [Switch "ansible_host" to private IP] 2026-10-03 01:00:25.977227 | ubuntu-focal | changed: 1 replacements made 2026-10-03 01:00:25.978780 | ubuntu-focal | skipping: Conditional result was False 2026-10-03 01:00:25.986239 | ubuntu-focal | skipping: Conditional result was False 2026-10-03 01:00:25.994505 | 2026-10-03 01:00:25.994573 | TASK [Run Molecule scenario] 2026-10-03 01:00:26.673819 | ubuntu-focal | Downloading cpython-3.13.7-linux-x86_64-gnu (download) (30.9MiB) 2026-10-03 01:00:27.389155 | ubuntu-focal | Downloading cpython-3.13.7-linux-x86_64-gnu (download) 2026-10-03 01:00:27.576154 | ubuntu-focal | Using CPython 3.13.7 2026-10-03 01:00:27.576226 | ubuntu-focal | Creating virtual environment at: .venv 2026-10-03 01:00:27.914953 | ubuntu-focal | Downloading pygments (1.2MiB) 2026-10-03 01:00:27.932293 | ubuntu-focal | Downloading cryptography (4.3MiB) 2026-10-03 01:00:27.933308 | ubuntu-focal | Downloading ansible-core (2.3MiB) 2026-10-03 01:00:28.105723 | ubuntu-focal | Downloading cryptography 2026-10-03 01:00:28.146049 | ubuntu-focal | Downloading pygments 2026-10-03 01:00:28.268362 | ubuntu-focal | Downloading ansible-core 2026-10-03 01:00:28.291883 | ubuntu-focal | Installed 36 packages in 22ms 2026-10-03 01:00:29.323267 | ubuntu-focal | INFO Collection 'vexxhost.containers' detected. 2026-10-03 01:00:29.323419 | ubuntu-focal | INFO Scenarios will be used from 'extensions/molecule' 2026-10-03 01:00:30.086906 | ubuntu-focal | CRITICAL 'extensions/molecule/default/molecule.yml' glob failed. Exiting. 2026-10-03 01:00:30.087063 | ubuntu-focal | INFO default scenario not found, disabling shared state. 2026-10-03 01:00:30.087269 | ubuntu-focal | INFO [docker > discovery] scenario test matrix: dependency, cleanup, destroy, syntax, create, prepare, converge, idempotence, side_effect, verify, cleanup, destroy 2026-10-03 01:00:30.087388 | ubuntu-focal | INFO [docker > prerun] Performing prerun with role_name_check=0... 2026-10-03 01:02:00.254071 | ubuntu-focal | INFO [docker > dependency] Executing 2026-10-03 01:02:00.254587 | ubuntu-focal | WARNING [docker > dependency] Missing roles requirements file: requirements.yml 2026-10-03 01:02:00.255025 | ubuntu-focal | WARNING [docker > dependency] Missing collections requirements file: collections.yml 2026-10-03 01:02:00.255273 | ubuntu-focal | WARNING [docker > dependency] Executed: 2 missing (Remove from test_sequence to suppress) 2026-10-03 01:02:00.264988 | ubuntu-focal | INFO [docker > cleanup] Executing 2026-10-03 01:02:00.265618 | ubuntu-focal | WARNING [docker > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-10-03 01:02:00.275139 | ubuntu-focal | INFO [docker > destroy] Executing 2026-10-03 01:02:00.275325 | ubuntu-focal | WARNING [docker > destroy] Skipping, '--destroy=never' requested. 2026-10-03 01:02:00.275523 | ubuntu-focal | INFO [docker > destroy] Executed: Successful 2026-10-03 01:02:00.284942 | ubuntu-focal | INFO [docker > syntax] Executing 2026-10-03 01:02:00.783579 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-10-03 01:02:00.783806 | ubuntu-focal | [DEPRECATION WARNING]: DEFAULT_MANAGED_STR option. Reason: The `ansible_managed` variable can be set just like any other variable, or a different variable can be used. 2026-10-03 01:02:00.783929 | ubuntu-focal | Alternatives: Set the `ansible_managed` variable, or use any custom variable in templates. This feature will be removed from ansible-core version 2.23. 2026-10-03 01:02:00.784026 | ubuntu-focal | 2026-10-03 01:02:01.182727 | ubuntu-focal | 2026-10-03 01:02:01.183100 | ubuntu-focal | playbook: /home/zuul/src/github.com/vexxhost/ansible-collection-containers/extensions/molecule/docker/converge.yml 2026-10-03 01:02:01.286925 | ubuntu-focal | INFO [docker > syntax] Executed: Successful 2026-10-03 01:02:01.297514 | ubuntu-focal | INFO [docker > create] Executing 2026-10-03 01:02:01.300197 | ubuntu-focal | WARNING [docker > create] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-10-03 01:02:01.309871 | ubuntu-focal | INFO [docker > prepare] Executing 2026-10-03 01:02:01.775240 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-10-03 01:02:01.775605 | ubuntu-focal | [DEPRECATION WARNING]: DEFAULT_MANAGED_STR option. Reason: The `ansible_managed` variable can be set just like any other variable, or a different variable can be used. 2026-10-03 01:02:01.775869 | ubuntu-focal | Alternatives: Set the `ansible_managed` variable, or use any custom variable in templates. This feature will be removed from ansible-core version 2.23. 2026-10-03 01:02:01.776069 | ubuntu-focal | 2026-10-03 01:02:02.099698 | ubuntu-focal | 2026-10-03 01:02:02.100038 | ubuntu-focal | PLAY [Prepare] ***************************************************************** 2026-10-03 01:02:02.100243 | ubuntu-focal | 2026-10-03 01:02:02.100456 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-10-03 01:02:02.100703 | ubuntu-focal | Saturday 03 October 2026 01:02:02 +0000 (0:00:00.029) 0:00:00.029 ****** 2026-10-03 01:02:03.315416 | ubuntu-focal | [WARNING]: Host 'ubuntu-focal' is using the discovered Python interpreter at '/usr/bin/python3.8', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.19/reference_appendices/interpreter_discovery.html for more information. 2026-10-03 01:02:03.318410 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:03.318639 | ubuntu-focal | 2026-10-03 01:02:03.318894 | ubuntu-focal | TASK [Update "apt" cache] ****************************************************** 2026-10-03 01:02:03.319121 | ubuntu-focal | Saturday 03 October 2026 01:02:03 +0000 (0:00:01.219) 0:00:01.248 ****** 2026-10-03 01:02:08.761712 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:08.761895 | ubuntu-focal | 2026-10-03 01:02:08.761999 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-10-03 01:02:08.762109 | ubuntu-focal | ubuntu-focal : ok=2 changed=1 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-10-03 01:02:08.762199 | ubuntu-focal | 2026-10-03 01:02:08.762285 | ubuntu-focal | 2026-10-03 01:02:08.762386 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-10-03 01:02:08.762483 | ubuntu-focal | Saturday 03 October 2026 01:02:08 +0000 (0:00:05.443) 0:00:06.692 ****** 2026-10-03 01:02:08.762574 | ubuntu-focal | =============================================================================== 2026-10-03 01:02:08.762665 | ubuntu-focal | Update "apt" cache ------------------------------------------------------ 5.44s 2026-10-03 01:02:08.762757 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.22s 2026-10-03 01:02:08.871958 | ubuntu-focal | INFO [docker > prepare] Executed: Successful 2026-10-03 01:02:08.878518 | ubuntu-focal | INFO [docker > converge] Executing 2026-10-03 01:02:09.353727 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-10-03 01:02:09.354063 | ubuntu-focal | [DEPRECATION WARNING]: DEFAULT_MANAGED_STR option. Reason: The `ansible_managed` variable can be set just like any other variable, or a different variable can be used. 2026-10-03 01:02:09.354286 | ubuntu-focal | Alternatives: Set the `ansible_managed` variable, or use any custom variable in templates. This feature will be removed from ansible-core version 2.23. 2026-10-03 01:02:09.354475 | ubuntu-focal | 2026-10-03 01:02:09.714190 | ubuntu-focal | 2026-10-03 01:02:09.714477 | ubuntu-focal | PLAY [Converge] **************************************************************** 2026-10-03 01:02:09.714674 | ubuntu-focal | 2026-10-03 01:02:09.714904 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-10-03 01:02:09.715111 | ubuntu-focal | Saturday 03 October 2026 01:02:09 +0000 (0:00:00.019) 0:00:00.019 ****** 2026-10-03 01:02:10.798459 | ubuntu-focal | [WARNING]: Host 'ubuntu-focal' is using the discovered Python interpreter at '/usr/bin/python3.8', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.19/reference_appendices/interpreter_discovery.html for more information. 2026-10-03 01:02:10.802368 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:10.802593 | ubuntu-focal | 2026-10-03 01:02:10.802816 | ubuntu-focal | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-10-03 01:02:10.803052 | ubuntu-focal | Saturday 03 October 2026 01:02:10 +0000 (0:00:01.088) 0:00:01.107 ****** 2026-10-03 01:02:11.274046 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:11.274319 | ubuntu-focal | 2026-10-03 01:02:11.274550 | ubuntu-focal | TASK [vexxhost.containers.package : Update state for tar] ********************** 2026-10-03 01:02:11.274773 | ubuntu-focal | Saturday 03 October 2026 01:02:11 +0000 (0:00:00.471) 0:00:01.578 ****** 2026-10-03 01:02:11.303898 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:11.304124 | ubuntu-focal | 2026-10-03 01:02:11.304343 | ubuntu-focal | TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads)] *** 2026-10-03 01:02:11.304558 | ubuntu-focal | Saturday 03 October 2026 01:02:11 +0000 (0:00:00.030) 0:00:01.609 ****** 2026-10-03 01:02:11.698577 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:11.698880 | ubuntu-focal | 2026-10-03 01:02:11.699110 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-10-03 01:02:11.699331 | ubuntu-focal | Saturday 03 October 2026 01:02:11 +0000 (0:00:00.393) 0:00:02.003 ****** 2026-10-03 01:02:11.804320 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-10-03 01:02:11.804623 | ubuntu-focal | "msg": "https://github.com/opencontainers/runc/releases/download/v1.4.2/runc.amd64" 2026-10-03 01:02:11.804824 | ubuntu-focal | } 2026-10-03 01:02:11.805046 | ubuntu-focal | 2026-10-03 01:02:11.805256 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-10-03 01:02:11.805459 | ubuntu-focal | Saturday 03 October 2026 01:02:11 +0000 (0:00:00.105) 0:00:02.109 ****** 2026-10-03 01:02:12.627876 | ubuntu-focal | [WARNING]: Module remote_tmp /root/.ansible/tmp did not exist and was created with a mode of 0700, this may cause issues when running as another user. To avoid this, create the remote_tmp dir with the correct permissions manually 2026-10-03 01:02:12.635924 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:12.635959 | ubuntu-focal | 2026-10-03 01:02:12.635973 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-10-03 01:02:12.635985 | ubuntu-focal | Saturday 03 October 2026 01:02:12 +0000 (0:00:00.831) 0:00:02.940 ****** 2026-10-03 01:02:12.664293 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:12.664340 | ubuntu-focal | 2026-10-03 01:02:12.664351 | ubuntu-focal | TASK [vexxhost.containers.package : Update state for tar] ********************** 2026-10-03 01:02:12.664360 | ubuntu-focal | Saturday 03 October 2026 01:02:12 +0000 (0:00:00.028) 0:00:02.968 ****** 2026-10-03 01:02:12.698617 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:12.698798 | ubuntu-focal | 2026-10-03 01:02:12.698962 | ubuntu-focal | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-10-03 01:02:12.699101 | ubuntu-focal | Saturday 03 October 2026 01:02:12 +0000 (0:00:00.035) 0:00:03.003 ****** 2026-10-03 01:02:12.950378 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:12.950617 | ubuntu-focal | 2026-10-03 01:02:12.950844 | ubuntu-focal | TASK [vexxhost.containers.package : Update state for tar] ********************** 2026-10-03 01:02:12.951078 | ubuntu-focal | Saturday 03 October 2026 01:02:12 +0000 (0:00:00.251) 0:00:03.255 ****** 2026-10-03 01:02:14.097925 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:14.098252 | ubuntu-focal | 2026-10-03 01:02:14.098490 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-10-03 01:02:14.098707 | ubuntu-focal | Saturday 03 October 2026 01:02:14 +0000 (0:00:01.147) 0:00:04.402 ****** 2026-10-03 01:02:14.186897 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-10-03 01:02:14.187232 | ubuntu-focal | "msg": "https://github.com/containerd/containerd/releases/download/v1.7.34/containerd-1.7.34-linux-amd64.tar.gz" 2026-10-03 01:02:14.187499 | ubuntu-focal | } 2026-10-03 01:02:14.187701 | ubuntu-focal | 2026-10-03 01:02:14.187962 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-10-03 01:02:14.188237 | ubuntu-focal | Saturday 03 October 2026 01:02:14 +0000 (0:00:00.089) 0:00:04.491 ****** 2026-10-03 01:02:15.299810 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:15.300175 | ubuntu-focal | 2026-10-03 01:02:15.300417 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-10-03 01:02:15.300648 | ubuntu-focal | Saturday 03 October 2026 01:02:15 +0000 (0:00:01.112) 0:00:05.604 ****** 2026-10-03 01:02:19.302961 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:19.303327 | ubuntu-focal | 2026-10-03 01:02:19.303646 | ubuntu-focal | TASK [vexxhost.containers.containerd : Install SELinux packages] *************** 2026-10-03 01:02:19.303918 | ubuntu-focal | Saturday 03 October 2026 01:02:19 +0000 (0:00:04.003) 0:00:09.607 ****** 2026-10-03 01:02:19.319750 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:19.320071 | ubuntu-focal | 2026-10-03 01:02:19.320376 | ubuntu-focal | TASK [vexxhost.containers.containerd : Set SELinux to permissive at runtime] *** 2026-10-03 01:02:19.320637 | ubuntu-focal | Saturday 03 October 2026 01:02:19 +0000 (0:00:00.017) 0:00:09.625 ****** 2026-10-03 01:02:19.334680 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:19.334965 | ubuntu-focal | 2026-10-03 01:02:19.335261 | ubuntu-focal | TASK [vexxhost.containers.containerd : Persist SELinux permissive mode] ******** 2026-10-03 01:02:19.335528 | ubuntu-focal | Saturday 03 October 2026 01:02:19 +0000 (0:00:00.015) 0:00:09.640 ****** 2026-10-03 01:02:19.348844 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:19.349162 | ubuntu-focal | 2026-10-03 01:02:19.349416 | ubuntu-focal | TASK [vexxhost.containers.containerd : Install AppArmor packages] ************** 2026-10-03 01:02:19.349642 | ubuntu-focal | Saturday 03 October 2026 01:02:19 +0000 (0:00:00.014) 0:00:09.654 ****** 2026-10-03 01:02:24.949000 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:24.949295 | ubuntu-focal | 2026-10-03 01:02:24.949533 | ubuntu-focal | TASK [vexxhost.containers.containerd : Create systemd service file for containerd] *** 2026-10-03 01:02:24.949750 | ubuntu-focal | Saturday 03 October 2026 01:02:24 +0000 (0:00:05.599) 0:00:15.253 ****** 2026-10-03 01:02:25.670336 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:25.670617 | ubuntu-focal | 2026-10-03 01:02:25.670852 | ubuntu-focal | TASK [vexxhost.containers.containerd : Create folders for configuration] ******* 2026-10-03 01:02:25.671096 | ubuntu-focal | Saturday 03 October 2026 01:02:25 +0000 (0:00:00.715) 0:00:15.969 ****** 2026-10-03 01:02:26.921071 | ubuntu-focal | changed: [ubuntu-focal] => (item={'path': '/etc/containerd'}) 2026-10-03 01:02:26.921380 | ubuntu-focal | changed: [ubuntu-focal] => (item={'path': '/var/lib/containerd', 'mode': '0o700'}) 2026-10-03 01:02:26.921610 | ubuntu-focal | changed: [ubuntu-focal] => (item={'path': '/run/containerd', 'mode': '0o711'}) 2026-10-03 01:02:26.921833 | ubuntu-focal | changed: [ubuntu-focal] => (item={'path': '/run/containerd/io.containerd.grpc.v1.cri', 'mode': '0o700'}) 2026-10-03 01:02:26.922075 | ubuntu-focal | changed: [ubuntu-focal] => (item={'path': '/run/containerd/io.containerd.sandbox.controller.v1.shim', 'mode': '0o700'}) 2026-10-03 01:02:26.922274 | ubuntu-focal | 2026-10-03 01:02:26.922482 | ubuntu-focal | TASK [vexxhost.containers.containerd : Create containerd config file] ********** 2026-10-03 01:02:26.922687 | ubuntu-focal | Saturday 03 October 2026 01:02:26 +0000 (0:00:01.256) 0:00:17.225 ****** 2026-10-03 01:02:27.615739 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:27.616185 | ubuntu-focal | 2026-10-03 01:02:27.616510 | ubuntu-focal | TASK [vexxhost.containers.containerd : Force any restarts if necessary] ******** 2026-10-03 01:02:27.616824 | ubuntu-focal | Saturday 03 October 2026 01:02:27 +0000 (0:00:00.686) 0:00:17.912 ****** 2026-10-03 01:02:27.617183 | ubuntu-focal | 2026-10-03 01:02:27.617503 | ubuntu-focal | RUNNING HANDLER [vexxhost.containers.containerd : Reload systemd] ************** 2026-10-03 01:02:27.617808 | ubuntu-focal | Saturday 03 October 2026 01:02:27 +0000 (0:00:00.003) 0:00:17.915 ****** 2026-10-03 01:02:28.580496 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:28.580598 | ubuntu-focal | 2026-10-03 01:02:28.580824 | ubuntu-focal | RUNNING HANDLER [vexxhost.containers.containerd : Restart containerd] ********** 2026-10-03 01:02:28.580878 | ubuntu-focal | Saturday 03 October 2026 01:02:28 +0000 (0:00:00.970) 0:00:18.885 ****** 2026-10-03 01:02:29.130959 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:29.131476 | ubuntu-focal | 2026-10-03 01:02:29.131545 | ubuntu-focal | TASK [vexxhost.containers.containerd : Enable and start service] *************** 2026-10-03 01:02:29.131682 | ubuntu-focal | Saturday 03 October 2026 01:02:29 +0000 (0:00:00.550) 0:00:19.435 ****** 2026-10-03 01:02:29.718965 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:29.719548 | ubuntu-focal | 2026-10-03 01:02:29.719609 | ubuntu-focal | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-10-03 01:02:29.719622 | ubuntu-focal | Saturday 03 October 2026 01:02:29 +0000 (0:00:00.587) 0:00:20.023 ****** 2026-10-03 01:02:29.976796 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:29.976837 | ubuntu-focal | 2026-10-03 01:02:29.976848 | ubuntu-focal | TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads/docker-29.7.2)] *** 2026-10-03 01:02:29.976857 | ubuntu-focal | Saturday 03 October 2026 01:02:29 +0000 (0:00:00.257) 0:00:20.281 ****** 2026-10-03 01:02:30.240299 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:30.240771 | ubuntu-focal | 2026-10-03 01:02:30.240828 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-10-03 01:02:30.240839 | ubuntu-focal | Saturday 03 October 2026 01:02:30 +0000 (0:00:00.263) 0:00:20.544 ****** 2026-10-03 01:02:30.284294 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-10-03 01:02:30.284878 | ubuntu-focal | "msg": "https://download.docker.com/linux/static/stable/x86_64/docker-29.7.2.tgz" 2026-10-03 01:02:30.284900 | ubuntu-focal | } 2026-10-03 01:02:30.284923 | ubuntu-focal | 2026-10-03 01:02:30.284931 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-10-03 01:02:30.284939 | ubuntu-focal | Saturday 03 October 2026 01:02:30 +0000 (0:00:00.044) 0:00:20.589 ****** 2026-10-03 01:02:31.349253 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:31.349767 | ubuntu-focal | 2026-10-03 01:02:31.349856 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-10-03 01:02:31.349868 | ubuntu-focal | Saturday 03 October 2026 01:02:31 +0000 (0:00:01.064) 0:00:21.653 ****** 2026-10-03 01:02:36.762186 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:36.762719 | ubuntu-focal | 2026-10-03 01:02:36.762813 | ubuntu-focal | TASK [vexxhost.containers.docker : Install AppArmor packages] ****************** 2026-10-03 01:02:36.762825 | ubuntu-focal | Saturday 03 October 2026 01:02:36 +0000 (0:00:05.413) 0:00:27.066 ****** 2026-10-03 01:02:37.737485 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:37.738067 | ubuntu-focal | 2026-10-03 01:02:37.738144 | ubuntu-focal | TASK [vexxhost.containers.docker : Install SELinux packages] ******************* 2026-10-03 01:02:37.738156 | ubuntu-focal | Saturday 03 October 2026 01:02:37 +0000 (0:00:00.975) 0:00:28.041 ****** 2026-10-03 01:02:37.760158 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:37.760709 | ubuntu-focal | 2026-10-03 01:02:37.760804 | ubuntu-focal | TASK [vexxhost.containers.docker : Ensure group "docker" exists] *************** 2026-10-03 01:02:37.760816 | ubuntu-focal | Saturday 03 October 2026 01:02:37 +0000 (0:00:00.022) 0:00:28.064 ****** 2026-10-03 01:02:38.170907 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:38.171013 | ubuntu-focal | 2026-10-03 01:02:38.171606 | ubuntu-focal | TASK [vexxhost.containers.docker : Create links to Docker binaries] ************ 2026-10-03 01:02:38.171693 | ubuntu-focal | Saturday 03 October 2026 01:02:38 +0000 (0:00:00.410) 0:00:28.475 ****** 2026-10-03 01:02:39.058849 | ubuntu-focal | changed: [ubuntu-focal] => (item=docker) 2026-10-03 01:02:39.058937 | ubuntu-focal | changed: [ubuntu-focal] => (item=docker-init) 2026-10-03 01:02:39.059820 | ubuntu-focal | changed: [ubuntu-focal] => (item=dockerd) 2026-10-03 01:02:39.059913 | ubuntu-focal | changed: [ubuntu-focal] => (item=docker-proxy) 2026-10-03 01:02:39.059925 | ubuntu-focal | 2026-10-03 01:02:39.059935 | ubuntu-focal | TASK [vexxhost.containers.docker : Create systemd service file for docker] ***** 2026-10-03 01:02:39.059945 | ubuntu-focal | Saturday 03 October 2026 01:02:39 +0000 (0:00:00.887) 0:00:29.363 ****** 2026-10-03 01:02:39.643403 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:39.643892 | ubuntu-focal | 2026-10-03 01:02:39.643959 | ubuntu-focal | TASK [vexxhost.containers.docker : Create folders for configuration] *********** 2026-10-03 01:02:39.643971 | ubuntu-focal | Saturday 03 October 2026 01:02:39 +0000 (0:00:00.584) 0:00:29.948 ****** 2026-10-03 01:02:40.392777 | ubuntu-focal | changed: [ubuntu-focal] => (item={'path': '/etc/docker'}) 2026-10-03 01:02:40.393630 | ubuntu-focal | changed: [ubuntu-focal] => (item={'path': '/var/lib/docker', 'mode': '0o710'}) 2026-10-03 01:02:40.393724 | ubuntu-focal | changed: [ubuntu-focal] => (item={'path': '/run/docker', 'mode': '0o711'}) 2026-10-03 01:02:40.393736 | ubuntu-focal | 2026-10-03 01:02:40.393746 | ubuntu-focal | TASK [vexxhost.containers.docker : Create systemd socket file for docker] ****** 2026-10-03 01:02:40.393756 | ubuntu-focal | Saturday 03 October 2026 01:02:40 +0000 (0:00:00.749) 0:00:30.697 ****** 2026-10-03 01:02:40.911307 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:40.911448 | ubuntu-focal | 2026-10-03 01:02:40.911461 | ubuntu-focal | TASK [vexxhost.containers.docker : Create docker daemon config file] *********** 2026-10-03 01:02:40.911596 | ubuntu-focal | Saturday 03 October 2026 01:02:40 +0000 (0:00:00.518) 0:00:31.216 ****** 2026-10-03 01:02:41.466106 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:41.467000 | ubuntu-focal | 2026-10-03 01:02:41.467081 | ubuntu-focal | TASK [vexxhost.containers.docker : Force any restarts if necessary] ************ 2026-10-03 01:02:41.467096 | ubuntu-focal | Saturday 03 October 2026 01:02:41 +0000 (0:00:00.551) 0:00:31.767 ****** 2026-10-03 01:02:41.467105 | ubuntu-focal | 2026-10-03 01:02:41.467114 | ubuntu-focal | RUNNING HANDLER [vexxhost.containers.docker : Reload Docker systemd units] ***** 2026-10-03 01:02:41.467123 | ubuntu-focal | Saturday 03 October 2026 01:02:41 +0000 (0:00:00.003) 0:00:31.770 ****** 2026-10-03 01:02:41.958312 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:41.958803 | ubuntu-focal | 2026-10-03 01:02:41.958837 | ubuntu-focal | RUNNING HANDLER [vexxhost.containers.docker : Restart docker] ****************** 2026-10-03 01:02:41.958863 | ubuntu-focal | Saturday 03 October 2026 01:02:41 +0000 (0:00:00.492) 0:00:32.263 ****** 2026-10-03 01:02:41.989040 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:41.989611 | ubuntu-focal | 2026-10-03 01:02:41.989677 | ubuntu-focal | TASK [vexxhost.containers.docker : Enable and start service] ******************* 2026-10-03 01:02:41.989690 | ubuntu-focal | Saturday 03 October 2026 01:02:41 +0000 (0:00:00.030) 0:00:32.293 ****** 2026-10-03 01:02:43.096480 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:02:43.096559 | ubuntu-focal | 2026-10-03 01:02:43.099121 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-10-03 01:02:43.099176 | ubuntu-focal | ubuntu-focal : ok=31 changed=20 unreachable=0 failed=0 skipped=8 rescued=0 ignored=0 2026-10-03 01:02:43.099183 | ubuntu-focal | 2026-10-03 01:02:43.099189 | ubuntu-focal | 2026-10-03 01:02:43.099194 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-10-03 01:02:43.099200 | ubuntu-focal | Saturday 03 October 2026 01:02:43 +0000 (0:00:01.108) 0:00:33.401 ****** 2026-10-03 01:02:43.099205 | ubuntu-focal | =============================================================================== 2026-10-03 01:02:43.099211 | ubuntu-focal | vexxhost.containers.containerd : Install AppArmor packages -------------- 5.60s 2026-10-03 01:02:43.099216 | ubuntu-focal | vexxhost.containers.download_artifact : Extract archive ----------------- 5.41s 2026-10-03 01:02:43.099221 | ubuntu-focal | vexxhost.containers.download_artifact : Extract archive ----------------- 4.00s 2026-10-03 01:02:43.099227 | ubuntu-focal | vexxhost.containers.containerd : Create folders for configuration ------- 1.26s 2026-10-03 01:02:43.099232 | ubuntu-focal | vexxhost.containers.package : Update state for tar ---------------------- 1.15s 2026-10-03 01:02:43.099237 | ubuntu-focal | vexxhost.containers.download_artifact : Download item ------------------- 1.11s 2026-10-03 01:02:43.099243 | ubuntu-focal | vexxhost.containers.docker : Enable and start service ------------------- 1.11s 2026-10-03 01:02:43.099248 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.09s 2026-10-03 01:02:43.099255 | ubuntu-focal | vexxhost.containers.download_artifact : Download item ------------------- 1.06s 2026-10-03 01:02:43.099260 | ubuntu-focal | vexxhost.containers.docker : Install AppArmor packages ------------------ 0.98s 2026-10-03 01:02:43.099265 | ubuntu-focal | vexxhost.containers.containerd : Reload systemd ------------------------- 0.97s 2026-10-03 01:02:43.099271 | ubuntu-focal | vexxhost.containers.docker : Create links to Docker binaries ------------ 0.89s 2026-10-03 01:02:43.099276 | ubuntu-focal | vexxhost.containers.download_artifact : Download item ------------------- 0.83s 2026-10-03 01:02:43.099281 | ubuntu-focal | vexxhost.containers.docker : Create folders for configuration ----------- 0.75s 2026-10-03 01:02:43.099287 | ubuntu-focal | vexxhost.containers.containerd : Create systemd service file for containerd --- 0.72s 2026-10-03 01:02:43.099292 | ubuntu-focal | vexxhost.containers.containerd : Create containerd config file ---------- 0.69s 2026-10-03 01:02:43.099298 | ubuntu-focal | vexxhost.containers.containerd : Enable and start service --------------- 0.59s 2026-10-03 01:02:43.099303 | ubuntu-focal | vexxhost.containers.docker : Create systemd service file for docker ----- 0.58s 2026-10-03 01:02:43.099309 | ubuntu-focal | vexxhost.containers.docker : Create docker daemon config file ----------- 0.55s 2026-10-03 01:02:43.099314 | ubuntu-focal | vexxhost.containers.containerd : Restart containerd --------------------- 0.55s 2026-10-03 01:02:43.251410 | ubuntu-focal | INFO [docker > converge] Executed: Successful 2026-10-03 01:02:43.261594 | ubuntu-focal | INFO [docker > idempotence] Executing 2026-10-03 01:02:43.705097 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-10-03 01:02:43.705377 | ubuntu-focal | [DEPRECATION WARNING]: DEFAULT_MANAGED_STR option. Reason: The `ansible_managed` variable can be set just like any other variable, or a different variable can be used. 2026-10-03 01:02:43.705494 | ubuntu-focal | Alternatives: Set the `ansible_managed` variable, or use any custom variable in templates. This feature will be removed from ansible-core version 2.23. 2026-10-03 01:02:43.705587 | ubuntu-focal | 2026-10-03 01:02:44.057791 | ubuntu-focal | 2026-10-03 01:02:44.058080 | ubuntu-focal | PLAY [Converge] **************************************************************** 2026-10-03 01:02:44.058286 | ubuntu-focal | 2026-10-03 01:02:44.058498 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-10-03 01:02:44.058719 | ubuntu-focal | Saturday 03 October 2026 01:02:44 +0000 (0:00:00.018) 0:00:00.018 ****** 2026-10-03 01:02:45.107858 | ubuntu-focal | [WARNING]: Host 'ubuntu-focal' is using the discovered Python interpreter at '/usr/bin/python3.8', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.19/reference_appendices/interpreter_discovery.html for more information. 2026-10-03 01:02:45.112162 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:45.112189 | ubuntu-focal | 2026-10-03 01:02:45.112198 | ubuntu-focal | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-10-03 01:02:45.112206 | ubuntu-focal | Saturday 03 October 2026 01:02:45 +0000 (0:00:01.053) 0:00:01.072 ****** 2026-10-03 01:02:45.527573 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:45.527617 | ubuntu-focal | 2026-10-03 01:02:45.527624 | ubuntu-focal | TASK [vexxhost.containers.package : Update state for tar] ********************** 2026-10-03 01:02:45.527631 | ubuntu-focal | Saturday 03 October 2026 01:02:45 +0000 (0:00:00.415) 0:00:01.487 ****** 2026-10-03 01:02:45.555234 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:45.555277 | ubuntu-focal | 2026-10-03 01:02:45.555284 | ubuntu-focal | TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads)] *** 2026-10-03 01:02:45.555290 | ubuntu-focal | Saturday 03 October 2026 01:02:45 +0000 (0:00:00.028) 0:00:01.515 ****** 2026-10-03 01:02:45.952076 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:45.952121 | ubuntu-focal | 2026-10-03 01:02:45.952128 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-10-03 01:02:45.952135 | ubuntu-focal | Saturday 03 October 2026 01:02:45 +0000 (0:00:00.396) 0:00:01.912 ****** 2026-10-03 01:02:46.009474 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-10-03 01:02:46.009525 | ubuntu-focal | "msg": "https://github.com/opencontainers/runc/releases/download/v1.4.2/runc.amd64" 2026-10-03 01:02:46.009533 | ubuntu-focal | } 2026-10-03 01:02:46.009539 | ubuntu-focal | 2026-10-03 01:02:46.009545 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-10-03 01:02:46.009551 | ubuntu-focal | Saturday 03 October 2026 01:02:46 +0000 (0:00:00.057) 0:00:01.969 ****** 2026-10-03 01:02:46.510494 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:46.510536 | ubuntu-focal | 2026-10-03 01:02:46.510541 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-10-03 01:02:46.510546 | ubuntu-focal | Saturday 03 October 2026 01:02:46 +0000 (0:00:00.496) 0:00:02.465 ****** 2026-10-03 01:02:46.535736 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:46.536268 | ubuntu-focal | 2026-10-03 01:02:46.536304 | ubuntu-focal | TASK [vexxhost.containers.package : Update state for tar] ********************** 2026-10-03 01:02:46.536315 | ubuntu-focal | Saturday 03 October 2026 01:02:46 +0000 (0:00:00.030) 0:00:02.496 ****** 2026-10-03 01:02:46.567899 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:46.568081 | ubuntu-focal | 2026-10-03 01:02:46.568441 | ubuntu-focal | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-10-03 01:02:46.568470 | ubuntu-focal | Saturday 03 October 2026 01:02:46 +0000 (0:00:00.032) 0:00:02.528 ****** 2026-10-03 01:02:46.819676 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:46.820151 | ubuntu-focal | 2026-10-03 01:02:46.820181 | ubuntu-focal | TASK [vexxhost.containers.package : Update state for tar] ********************** 2026-10-03 01:02:46.820192 | ubuntu-focal | Saturday 03 October 2026 01:02:46 +0000 (0:00:00.251) 0:00:02.780 ****** 2026-10-03 01:02:48.045729 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:48.045797 | ubuntu-focal | 2026-10-03 01:02:48.046173 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-10-03 01:02:48.046204 | ubuntu-focal | Saturday 03 October 2026 01:02:48 +0000 (0:00:01.226) 0:00:04.006 ****** 2026-10-03 01:02:48.123783 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-10-03 01:02:48.124544 | ubuntu-focal | "msg": "https://github.com/containerd/containerd/releases/download/v1.7.34/containerd-1.7.34-linux-amd64.tar.gz" 2026-10-03 01:02:48.124595 | ubuntu-focal | } 2026-10-03 01:02:48.124606 | ubuntu-focal | 2026-10-03 01:02:48.124622 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-10-03 01:02:48.124631 | ubuntu-focal | Saturday 03 October 2026 01:02:48 +0000 (0:00:00.078) 0:00:04.084 ****** 2026-10-03 01:02:48.536052 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:48.536488 | ubuntu-focal | 2026-10-03 01:02:48.536516 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-10-03 01:02:48.536528 | ubuntu-focal | Saturday 03 October 2026 01:02:48 +0000 (0:00:00.412) 0:00:04.496 ****** 2026-10-03 01:02:51.590608 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:51.591068 | ubuntu-focal | 2026-10-03 01:02:51.591099 | ubuntu-focal | TASK [vexxhost.containers.containerd : Install SELinux packages] *************** 2026-10-03 01:02:51.591110 | ubuntu-focal | Saturday 03 October 2026 01:02:51 +0000 (0:00:03.054) 0:00:07.551 ****** 2026-10-03 01:02:51.611825 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:51.611972 | ubuntu-focal | 2026-10-03 01:02:51.612323 | ubuntu-focal | TASK [vexxhost.containers.containerd : Set SELinux to permissive at runtime] *** 2026-10-03 01:02:51.612352 | ubuntu-focal | Saturday 03 October 2026 01:02:51 +0000 (0:00:00.021) 0:00:07.572 ****** 2026-10-03 01:02:51.632961 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:51.633126 | ubuntu-focal | 2026-10-03 01:02:51.633456 | ubuntu-focal | TASK [vexxhost.containers.containerd : Persist SELinux permissive mode] ******** 2026-10-03 01:02:51.633488 | ubuntu-focal | Saturday 03 October 2026 01:02:51 +0000 (0:00:00.021) 0:00:07.593 ****** 2026-10-03 01:02:51.655423 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:02:51.655980 | ubuntu-focal | 2026-10-03 01:02:51.656073 | ubuntu-focal | TASK [vexxhost.containers.containerd : Install AppArmor packages] ************** 2026-10-03 01:02:51.656085 | ubuntu-focal | Saturday 03 October 2026 01:02:51 +0000 (0:00:00.022) 0:00:07.615 ****** 2026-10-03 01:02:52.616999 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:52.617499 | ubuntu-focal | 2026-10-03 01:02:52.617556 | ubuntu-focal | TASK [vexxhost.containers.containerd : Create systemd service file for containerd] *** 2026-10-03 01:02:52.617567 | ubuntu-focal | Saturday 03 October 2026 01:02:52 +0000 (0:00:00.961) 0:00:08.577 ****** 2026-10-03 01:02:53.143489 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:53.143548 | ubuntu-focal | 2026-10-03 01:02:53.143781 | ubuntu-focal | TASK [vexxhost.containers.containerd : Create folders for configuration] ******* 2026-10-03 01:02:53.143829 | ubuntu-focal | Saturday 03 October 2026 01:02:53 +0000 (0:00:00.526) 0:00:09.103 ****** 2026-10-03 01:02:54.317829 | ubuntu-focal | ok: [ubuntu-focal] => (item={'path': '/etc/containerd'}) 2026-10-03 01:02:54.318987 | ubuntu-focal | ok: [ubuntu-focal] => (item={'path': '/var/lib/containerd', 'mode': '0o700'}) 2026-10-03 01:02:54.319099 | ubuntu-focal | ok: [ubuntu-focal] => (item={'path': '/run/containerd', 'mode': '0o711'}) 2026-10-03 01:02:54.319111 | ubuntu-focal | ok: [ubuntu-focal] => (item={'path': '/run/containerd/io.containerd.grpc.v1.cri', 'mode': '0o700'}) 2026-10-03 01:02:54.319122 | ubuntu-focal | ok: [ubuntu-focal] => (item={'path': '/run/containerd/io.containerd.sandbox.controller.v1.shim', 'mode': '0o700'}) 2026-10-03 01:02:54.319131 | ubuntu-focal | 2026-10-03 01:02:54.319141 | ubuntu-focal | TASK [vexxhost.containers.containerd : Create containerd config file] ********** 2026-10-03 01:02:54.319150 | ubuntu-focal | Saturday 03 October 2026 01:02:54 +0000 (0:00:01.174) 0:00:10.278 ****** 2026-10-03 01:02:54.928823 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:54.928918 | ubuntu-focal | 2026-10-03 01:02:54.929744 | ubuntu-focal | TASK [vexxhost.containers.containerd : Force any restarts if necessary] ******** 2026-10-03 01:02:54.929810 | ubuntu-focal | Saturday 03 October 2026 01:02:54 +0000 (0:00:00.608) 0:00:10.886 ****** 2026-10-03 01:02:54.929822 | ubuntu-focal | 2026-10-03 01:02:54.929832 | ubuntu-focal | TASK [vexxhost.containers.containerd : Enable and start service] *************** 2026-10-03 01:02:54.929842 | ubuntu-focal | Saturday 03 October 2026 01:02:54 +0000 (0:00:00.003) 0:00:10.889 ****** 2026-10-03 01:02:55.555233 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:55.555275 | ubuntu-focal | 2026-10-03 01:02:55.555477 | ubuntu-focal | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-10-03 01:02:55.555529 | ubuntu-focal | Saturday 03 October 2026 01:02:55 +0000 (0:00:00.626) 0:00:11.516 ****** 2026-10-03 01:02:55.804738 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:55.804821 | ubuntu-focal | 2026-10-03 01:02:55.805201 | ubuntu-focal | TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads/docker-29.7.2)] *** 2026-10-03 01:02:55.805253 | ubuntu-focal | Saturday 03 October 2026 01:02:55 +0000 (0:00:00.248) 0:00:11.764 ****** 2026-10-03 01:02:56.070391 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:56.070458 | ubuntu-focal | 2026-10-03 01:02:56.070796 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-10-03 01:02:56.070829 | ubuntu-focal | Saturday 03 October 2026 01:02:56 +0000 (0:00:00.266) 0:00:12.031 ****** 2026-10-03 01:02:56.102315 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-10-03 01:02:56.102490 | ubuntu-focal | "msg": "https://download.docker.com/linux/static/stable/x86_64/docker-29.7.2.tgz" 2026-10-03 01:02:56.103110 | ubuntu-focal | } 2026-10-03 01:02:56.103139 | ubuntu-focal | 2026-10-03 01:02:56.103150 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-10-03 01:02:56.103159 | ubuntu-focal | Saturday 03 October 2026 01:02:56 +0000 (0:00:00.032) 0:00:12.063 ****** 2026-10-03 01:02:56.489258 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:02:56.489750 | ubuntu-focal | 2026-10-03 01:02:56.489810 | ubuntu-focal | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-10-03 01:02:56.489822 | ubuntu-focal | Saturday 03 October 2026 01:02:56 +0000 (0:00:00.386) 0:00:12.449 ****** 2026-10-03 01:03:00.334554 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:03:00.334992 | ubuntu-focal | 2026-10-03 01:03:00.335045 | ubuntu-focal | TASK [vexxhost.containers.docker : Install AppArmor packages] ****************** 2026-10-03 01:03:00.335056 | ubuntu-focal | Saturday 03 October 2026 01:03:00 +0000 (0:00:03.845) 0:00:16.295 ****** 2026-10-03 01:03:01.337184 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:03:01.337666 | ubuntu-focal | 2026-10-03 01:03:01.337700 | ubuntu-focal | TASK [vexxhost.containers.docker : Install SELinux packages] ******************* 2026-10-03 01:03:01.337711 | ubuntu-focal | Saturday 03 October 2026 01:03:01 +0000 (0:00:01.002) 0:00:17.297 ****** 2026-10-03 01:03:01.353899 | ubuntu-focal | skipping: [ubuntu-focal] 2026-10-03 01:03:01.354255 | ubuntu-focal | 2026-10-03 01:03:01.354310 | ubuntu-focal | TASK [vexxhost.containers.docker : Ensure group "docker" exists] *************** 2026-10-03 01:03:01.354318 | ubuntu-focal | Saturday 03 October 2026 01:03:01 +0000 (0:00:00.017) 0:00:17.314 ****** 2026-10-03 01:03:01.729423 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:03:01.729460 | ubuntu-focal | 2026-10-03 01:03:01.729730 | ubuntu-focal | TASK [vexxhost.containers.docker : Create links to Docker binaries] ************ 2026-10-03 01:03:01.729769 | ubuntu-focal | Saturday 03 October 2026 01:03:01 +0000 (0:00:00.375) 0:00:17.690 ****** 2026-10-03 01:03:02.652574 | ubuntu-focal | ok: [ubuntu-focal] => (item=docker) 2026-10-03 01:03:02.653506 | ubuntu-focal | ok: [ubuntu-focal] => (item=docker-init) 2026-10-03 01:03:02.653539 | ubuntu-focal | ok: [ubuntu-focal] => (item=dockerd) 2026-10-03 01:03:02.653551 | ubuntu-focal | ok: [ubuntu-focal] => (item=docker-proxy) 2026-10-03 01:03:02.653561 | ubuntu-focal | 2026-10-03 01:03:02.653572 | ubuntu-focal | TASK [vexxhost.containers.docker : Create systemd service file for docker] ***** 2026-10-03 01:03:02.653583 | ubuntu-focal | Saturday 03 October 2026 01:03:02 +0000 (0:00:00.923) 0:00:18.613 ****** 2026-10-03 01:03:03.128161 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:03:03.128224 | ubuntu-focal | 2026-10-03 01:03:03.128575 | ubuntu-focal | TASK [vexxhost.containers.docker : Create folders for configuration] *********** 2026-10-03 01:03:03.128607 | ubuntu-focal | Saturday 03 October 2026 01:03:03 +0000 (0:00:00.475) 0:00:19.088 ****** 2026-10-03 01:03:03.843607 | ubuntu-focal | ok: [ubuntu-focal] => (item={'path': '/etc/docker'}) 2026-10-03 01:03:03.844468 | ubuntu-focal | ok: [ubuntu-focal] => (item={'path': '/var/lib/docker', 'mode': '0o710'}) 2026-10-03 01:03:03.844530 | ubuntu-focal | ok: [ubuntu-focal] => (item={'path': '/run/docker', 'mode': '0o711'}) 2026-10-03 01:03:03.844542 | ubuntu-focal | 2026-10-03 01:03:03.844551 | ubuntu-focal | TASK [vexxhost.containers.docker : Create systemd socket file for docker] ****** 2026-10-03 01:03:03.844561 | ubuntu-focal | Saturday 03 October 2026 01:03:03 +0000 (0:00:00.715) 0:00:19.804 ****** 2026-10-03 01:03:04.343282 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:03:04.343800 | ubuntu-focal | 2026-10-03 01:03:04.343861 | ubuntu-focal | TASK [vexxhost.containers.docker : Create docker daemon config file] *********** 2026-10-03 01:03:04.343873 | ubuntu-focal | Saturday 03 October 2026 01:03:04 +0000 (0:00:00.499) 0:00:20.303 ****** 2026-10-03 01:03:04.857926 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:03:04.857985 | ubuntu-focal | 2026-10-03 01:03:04.858947 | ubuntu-focal | TASK [vexxhost.containers.docker : Force any restarts if necessary] ************ 2026-10-03 01:03:04.859026 | ubuntu-focal | Saturday 03 October 2026 01:03:04 +0000 (0:00:00.511) 0:00:20.815 ****** 2026-10-03 01:03:04.859037 | ubuntu-focal | 2026-10-03 01:03:04.859047 | ubuntu-focal | TASK [vexxhost.containers.docker : Enable and start service] ******************* 2026-10-03 01:03:04.859055 | ubuntu-focal | Saturday 03 October 2026 01:03:04 +0000 (0:00:00.003) 0:00:20.818 ****** 2026-10-03 01:03:05.254821 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:03:05.255451 | ubuntu-focal | 2026-10-03 01:03:05.255515 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-10-03 01:03:05.255529 | ubuntu-focal | ubuntu-focal : ok=28 changed=0 unreachable=0 failed=0 skipped=7 rescued=0 ignored=0 2026-10-03 01:03:05.259297 | ubuntu-focal | 2026-10-03 01:03:05.259325 | ubuntu-focal | 2026-10-03 01:03:05.259335 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-10-03 01:03:05.259345 | ubuntu-focal | Saturday 03 October 2026 01:03:05 +0000 (0:00:00.397) 0:00:21.215 ****** 2026-10-03 01:03:05.259354 | ubuntu-focal | =============================================================================== 2026-10-03 01:03:05.259426 | ubuntu-focal | vexxhost.containers.download_artifact : Extract archive ----------------- 3.85s 2026-10-03 01:03:05.259438 | ubuntu-focal | vexxhost.containers.download_artifact : Extract archive ----------------- 3.05s 2026-10-03 01:03:05.259447 | ubuntu-focal | vexxhost.containers.package : Update state for tar ---------------------- 1.23s 2026-10-03 01:03:05.259455 | ubuntu-focal | vexxhost.containers.containerd : Create folders for configuration ------- 1.17s 2026-10-03 01:03:05.259464 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.05s 2026-10-03 01:03:05.259472 | ubuntu-focal | vexxhost.containers.docker : Install AppArmor packages ------------------ 1.00s 2026-10-03 01:03:05.259480 | ubuntu-focal | vexxhost.containers.containerd : Install AppArmor packages -------------- 0.96s 2026-10-03 01:03:05.259489 | ubuntu-focal | vexxhost.containers.docker : Create links to Docker binaries ------------ 0.92s 2026-10-03 01:03:05.259497 | ubuntu-focal | vexxhost.containers.docker : Create folders for configuration ----------- 0.72s 2026-10-03 01:03:05.259505 | ubuntu-focal | vexxhost.containers.containerd : Enable and start service --------------- 0.63s 2026-10-03 01:03:05.259513 | ubuntu-focal | vexxhost.containers.containerd : Create containerd config file ---------- 0.61s 2026-10-03 01:03:05.259521 | ubuntu-focal | vexxhost.containers.containerd : Create systemd service file for containerd --- 0.53s 2026-10-03 01:03:05.259530 | ubuntu-focal | vexxhost.containers.docker : Create docker daemon config file ----------- 0.51s 2026-10-03 01:03:05.259538 | ubuntu-focal | vexxhost.containers.docker : Create systemd socket file for docker ------ 0.50s 2026-10-03 01:03:05.259546 | ubuntu-focal | vexxhost.containers.download_artifact : Download item ------------------- 0.50s 2026-10-03 01:03:05.259554 | ubuntu-focal | vexxhost.containers.docker : Create systemd service file for docker ----- 0.48s 2026-10-03 01:03:05.259562 | ubuntu-focal | vexxhost.containers.forget_package : Forget package --------------------- 0.42s 2026-10-03 01:03:05.259571 | ubuntu-focal | vexxhost.containers.download_artifact : Download item ------------------- 0.41s 2026-10-03 01:03:05.259579 | ubuntu-focal | vexxhost.containers.docker : Enable and start service ------------------- 0.40s 2026-10-03 01:03:05.259587 | ubuntu-focal | vexxhost.containers.directory : Create directory (/var/lib/downloads) --- 0.40s 2026-10-03 01:03:05.391335 | ubuntu-focal | INFO [docker > idempotence] Executed: Successful 2026-10-03 01:03:05.401699 | ubuntu-focal | INFO [docker > side_effect] Executing 2026-10-03 01:03:05.402389 | ubuntu-focal | WARNING [docker > side_effect] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-10-03 01:03:05.411921 | ubuntu-focal | INFO [docker > verify] Executing 2026-10-03 01:03:05.911509 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-10-03 01:03:05.911816 | ubuntu-focal | [DEPRECATION WARNING]: DEFAULT_MANAGED_STR option. Reason: The `ansible_managed` variable can be set just like any other variable, or a different variable can be used. 2026-10-03 01:03:05.912087 | ubuntu-focal | Alternatives: Set the `ansible_managed` variable, or use any custom variable in templates. This feature will be removed from ansible-core version 2.23. 2026-10-03 01:03:05.912280 | ubuntu-focal | 2026-10-03 01:03:06.200686 | ubuntu-focal | 2026-10-03 01:03:06.200980 | ubuntu-focal | PLAY [Verify] ****************************************************************** 2026-10-03 01:03:06.201254 | ubuntu-focal | 2026-10-03 01:03:06.201508 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-10-03 01:03:06.201717 | ubuntu-focal | Saturday 03 October 2026 01:03:06 +0000 (0:00:00.007) 0:00:00.007 ****** 2026-10-03 01:03:07.251468 | ubuntu-focal | [WARNING]: Host 'ubuntu-focal' is using the discovered Python interpreter at '/usr/bin/python3.8', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.19/reference_appendices/interpreter_discovery.html for more information. 2026-10-03 01:03:07.254756 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:03:07.254788 | ubuntu-focal | 2026-10-03 01:03:07.254800 | ubuntu-focal | TASK [Populate service facts] ************************************************** 2026-10-03 01:03:07.254810 | ubuntu-focal | Saturday 03 October 2026 01:03:07 +0000 (0:00:01.053) 0:00:01.060 ****** 2026-10-03 01:03:09.112733 | ubuntu-focal | ok: [ubuntu-focal] 2026-10-03 01:03:09.112792 | ubuntu-focal | 2026-10-03 01:03:09.112802 | ubuntu-focal | TASK [Assert that the Docker service is still up] ****************************** 2026-10-03 01:03:09.112812 | ubuntu-focal | Saturday 03 October 2026 01:03:09 +0000 (0:00:01.858) 0:00:02.918 ****** 2026-10-03 01:03:09.142754 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-10-03 01:03:09.143760 | ubuntu-focal | "changed": false, 2026-10-03 01:03:09.143813 | ubuntu-focal | "msg": "All assertions passed" 2026-10-03 01:03:09.143824 | ubuntu-focal | } 2026-10-03 01:03:09.143833 | ubuntu-focal | 2026-10-03 01:03:09.143842 | ubuntu-focal | TASK [Check if Docker version is correct] ************************************** 2026-10-03 01:03:09.143851 | ubuntu-focal | Saturday 03 October 2026 01:03:09 +0000 (0:00:00.030) 0:00:02.949 ****** 2026-10-03 01:03:09.528422 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:03:09.528910 | ubuntu-focal | 2026-10-03 01:03:09.528966 | ubuntu-focal | TASK [Check if docker ps command return 0] ************************************* 2026-10-03 01:03:09.528977 | ubuntu-focal | Saturday 03 October 2026 01:03:09 +0000 (0:00:00.385) 0:00:03.334 ****** 2026-10-03 01:03:09.774010 | ubuntu-focal | changed: [ubuntu-focal] 2026-10-03 01:03:09.774072 | ubuntu-focal | 2026-10-03 01:03:09.774084 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-10-03 01:03:09.774094 | ubuntu-focal | ubuntu-focal : ok=5 changed=2 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-10-03 01:03:09.774102 | ubuntu-focal | 2026-10-03 01:03:09.774111 | ubuntu-focal | 2026-10-03 01:03:09.774119 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-10-03 01:03:09.774127 | ubuntu-focal | Saturday 03 October 2026 01:03:09 +0000 (0:00:00.243) 0:00:03.577 ****** 2026-10-03 01:03:09.774136 | ubuntu-focal | =============================================================================== 2026-10-03 01:03:09.774144 | ubuntu-focal | Populate service facts -------------------------------------------------- 1.86s 2026-10-03 01:03:09.774152 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.05s 2026-10-03 01:03:09.774160 | ubuntu-focal | Check if Docker version is correct -------------------------------------- 0.39s 2026-10-03 01:03:09.774168 | ubuntu-focal | Check if docker ps command return 0 ------------------------------------- 0.24s 2026-10-03 01:03:09.774177 | ubuntu-focal | Assert that the Docker service is still up ------------------------------ 0.03s 2026-10-03 01:03:09.875465 | ubuntu-focal | INFO [docker > verify] Executed: Successful 2026-10-03 01:03:09.884202 | ubuntu-focal | INFO [docker > cleanup] Executing 2026-10-03 01:03:09.884774 | ubuntu-focal | WARNING [docker > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-10-03 01:03:09.894405 | ubuntu-focal | INFO [docker > destroy] Executing 2026-10-03 01:03:09.894545 | ubuntu-focal | WARNING [docker > destroy] Skipping, '--destroy=never' requested. 2026-10-03 01:03:09.894663 | ubuntu-focal | INFO [docker > destroy] Executed: Successful 2026-10-03 01:03:09.895128 | ubuntu-focal | WARNING Molecule executed 1 scenario (1 missing files) 2026-10-03 01:03:10.262081 | ubuntu-focal | ok: Runtime: 0:02:43.641208 2026-10-03 01:03:10.272405 | 2026-10-03 01:03:10.272652 | PLAY RECAP 2026-10-03 01:03:10.272781 | ubuntu-focal | ok: 4 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-10-03 01:03:10.272846 | 2026-10-03 01:03:10.421216 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-10-03 01:03:10.423556 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-10-03 01:03:10.976879 | 2026-10-03 01:03:10.977265 | PLAY [all] 2026-10-03 01:03:10.987847 | 2026-10-03 01:03:10.987944 | TASK [fetch-output : Set log path for multiple nodes] 2026-10-03 01:03:11.042801 | ubuntu-focal | skipping: Conditional result was False 2026-10-03 01:03:11.050465 | 2026-10-03 01:03:11.050607 | TASK [fetch-output : Set log path for single node] 2026-10-03 01:03:11.104030 | ubuntu-focal | ok 2026-10-03 01:03:11.114432 | 2026-10-03 01:03:11.114579 | LOOP [fetch-output : Ensure local output dirs] 2026-10-03 01:03:11.585120 | ubuntu-focal -> localhost | ok: "/var/lib/zuul/builds/d016bbc716924667bb0982e7840b1011/work/logs" 2026-10-03 01:03:11.796575 | ubuntu-focal -> localhost | changed: "/var/lib/zuul/builds/d016bbc716924667bb0982e7840b1011/work/artifacts" 2026-10-03 01:03:11.984208 | ubuntu-focal -> localhost | changed: "/var/lib/zuul/builds/d016bbc716924667bb0982e7840b1011/work/docs" 2026-10-03 01:03:12.009519 | 2026-10-03 01:03:12.009748 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-10-03 01:03:12.639642 | ubuntu-focal | ok 2026-10-03 01:03:12.639961 | ubuntu-focal | changed: All items complete 2026-10-03 01:03:12.640056 | 2026-10-03 01:03:13.071312 | ubuntu-focal | changed: .d..t...... ./ 2026-10-03 01:03:13.555356 | ubuntu-focal | changed: .d..t...... ./ 2026-10-03 01:03:13.583326 | 2026-10-03 01:03:13.584398 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-10-03 01:03:13.991807 | ubuntu-focal -> localhost | ok: Item: artifacts Runtime: 0:00:00.005675 2026-10-03 01:03:14.210710 | ubuntu-focal -> localhost | ok: Item: docs Runtime: 0:00:00.006107 2026-10-03 01:03:14.225493 | 2026-10-03 01:03:14.225627 | PLAY [all] 2026-10-03 01:03:14.236158 | 2026-10-03 01:03:14.236281 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-10-03 01:03:14.636909 | ubuntu-focal | changed 2026-10-03 01:03:14.658614 | 2026-10-03 01:03:14.658796 | PLAY RECAP 2026-10-03 01:03:14.658885 | ubuntu-focal | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-10-03 01:03:14.658928 | 2026-10-03 01:03:14.786693 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-10-03 01:03:14.789092 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main] 2026-10-03 01:03:15.331409 | 2026-10-03 01:03:15.331533 | PLAY [localhost] 2026-10-03 01:03:15.341562 | 2026-10-03 01:03:15.341644 | TASK [Generate Zuul manifest] 2026-10-03 01:03:15.358991 | localhost | ok 2026-10-03 01:03:15.372273 | 2026-10-03 01:03:15.372359 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-10-03 01:03:15.747542 | localhost | changed 2026-10-03 01:03:15.765613 | 2026-10-03 01:03:15.765788 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-10-03 01:03:15.808842 | localhost | ok 2026-10-03 01:03:15.821924 | 2026-10-03 01:03:15.822094 | TASK [Upload logs] 2026-10-03 01:03:15.843509 | localhost | ok 2026-10-03 01:03:15.912611 | 2026-10-03 01:03:15.912735 | TASK [Set zuul-log-path fact] 2026-10-03 01:03:15.931495 | localhost | ok 2026-10-03 01:03:15.947263 | 2026-10-03 01:03:15.947382 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-10-03 01:03:15.986075 | localhost | ok 2026-10-03 01:03:15.994586 | 2026-10-03 01:03:15.994672 | TASK [upload-logs : Create log directories] 2026-10-03 01:03:16.451192 | localhost | changed 2026-10-03 01:03:16.461544 | 2026-10-03 01:03:16.461695 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-10-03 01:03:16.889283 | localhost -> localhost | ok: Runtime: 0:00:00.005270 2026-10-03 01:03:16.898137 | 2026-10-03 01:03:16.898265 | TASK [upload-logs : Upload logs to log server] 2026-10-03 01:03:17.354437 | localhost | Output suppressed because no_log was given 2026-10-03 01:03:17.360980 | 2026-10-03 01:03:17.361121 | LOOP [upload-logs : Compress console log and json output] 2026-10-03 01:03:17.418891 | localhost | skipping: Conditional result was False 2026-10-03 01:03:17.427614 | localhost | skipping: Conditional result was False 2026-10-03 01:03:17.444775 | 2026-10-03 01:03:17.444943 | LOOP [upload-logs : Upload compressed console log and json output] 2026-10-03 01:03:17.506796 | localhost | skipping: Conditional result was False 2026-10-03 01:03:17.507201 | 2026-10-03 01:03:17.512152 | localhost | skipping: Conditional result was False 2026-10-03 01:03:17.528897 | 2026-10-03 01:03:17.529057 | LOOP [upload-logs : Upload console log and json output]