2025-12-05 00:49:53.194544 | Job console starting...
2025-12-05 00:49:53.428717 | Updating repositories
2025-12-05 00:49:54.163195 | Preparing job workspace
2025-12-05 00:50:01.226058 | Running Ansible setup...
2025-12-05 00:50:04.099899 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/pre.yaml@master]
2025-12-05 00:50:04.588031 | 
2025-12-05 00:50:04.588112 | PLAY [localhost]
2025-12-05 00:50:04.595899 | 
2025-12-05 00:50:04.595983 | TASK [Gathering Facts]
2025-12-05 00:50:05.443762 | localhost | ok
2025-12-05 00:50:05.456351 | 
2025-12-05 00:50:05.456446 | TASK [log-inventory : Ensure Zuul Ansible directory exists]
2025-12-05 00:50:05.775250 | localhost -> localhost | changed
2025-12-05 00:50:05.780605 | 
2025-12-05 00:50:05.780680 | TASK [log-inventory : Copy ansible inventory to logs dir]
2025-12-05 00:50:06.466454 | localhost -> localhost | changed
2025-12-05 00:50:06.474055 | 
2025-12-05 00:50:06.474125 | TASK [Setup log path fact]
2025-12-05 00:50:06.490822 | localhost | ok
2025-12-05 00:50:06.501268 | 
2025-12-05 00:50:06.501335 | TASK [set-zuul-log-path-fact : Set log path for a build]
2025-12-05 00:50:06.517941 | localhost | ok
2025-12-05 00:50:06.524763 | 
2025-12-05 00:50:06.524826 | TASK [emit-job-header : Print job information]
2025-12-05 00:50:06.551680 | # Job Information
2025-12-05 00:50:06.551808 | Ansible Version: 2.15.12
2025-12-05 00:50:06.551837 | Job: edpm-ansible-molecule-edpm_telemetry_power_monitoring
2025-12-05 00:50:06.551860 | Pipeline: github-check
2025-12-05 00:50:06.551880 | Executor: ibm-bm4-ze.softwarefactory-project.io
2025-12-05 00:50:06.551900 | Triggered by: https://github.com/openstack-k8s-operators/edpm-ansible/pull/1054
2025-12-05 00:50:06.551941 | Log URL (when completed): https://logserver.rdoproject.org/d3d/rdoproject.org/d3d23dab5269493ea0aa69ff2b07e958/
2025-12-05 00:50:06.551964 | Event ID: 2ad06f80-d174-11f0-873a-1243110dde74
2025-12-05 00:50:06.555269 | 
2025-12-05 00:50:06.555334 | LOOP [emit-job-header : Print node information]
2025-12-05 00:50:06.639768 | localhost | ok:
2025-12-05 00:50:06.639951 | localhost | # Node Information
2025-12-05 00:50:06.639990 | localhost | Inventory Hostname: controller
2025-12-05 00:50:06.640021 | localhost | Hostname: np0005546242
2025-12-05 00:50:06.640048 | localhost | Username: zuul
2025-12-05 00:50:06.640076 | localhost | Distro: CentOS 9
2025-12-05 00:50:06.640101 | localhost | Provider: ibm-bm4-nodepool
2025-12-05 00:50:06.640126 | localhost | Region: regionOne
2025-12-05 00:50:06.640149 | localhost | Label: cloud-centos-9-stream-tripleo-ibm
2025-12-05 00:50:06.640174 | localhost | Product Name: OpenStack Compute
2025-12-05 00:50:06.640197 | localhost | Interface IP: 192.168.26.104
2025-12-05 00:50:06.667480 | 
2025-12-05 00:50:06.667534 | PLAY [all]
2025-12-05 00:50:06.673281 | 
2025-12-05 00:50:06.673339 | TASK [Gather network facts]
2025-12-05 00:50:07.037697 | controller | ok
2025-12-05 00:50:07.051360 | 
2025-12-05 00:50:07.051436 | TASK [include_role : start-zuul-console]
2025-12-05 00:50:07.069174 | controller | ok
2025-12-05 00:50:07.081382 | 
2025-12-05 00:50:07.081452 | TASK [start-zuul-console : Start zuul_console daemon.]
2025-12-05 00:50:07.383510 | controller | ok
2025-12-05 00:50:07.399936 | 
2025-12-05 00:50:07.400044 | TASK [include_role : add-build-sshkey]
2025-12-05 00:50:07.422609 | controller | ok
2025-12-05 00:50:07.435720 | 
2025-12-05 00:50:07.435788 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build]
2025-12-05 00:50:07.651894 | controller -> localhost | ok
2025-12-05 00:50:07.656932 | 
2025-12-05 00:50:07.656996 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID]
2025-12-05 00:50:07.674671 | controller | ok
2025-12-05 00:50:07.687101 | controller | included: /var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml
2025-12-05 00:50:07.692179 | 
2025-12-05 00:50:07.692237 | TASK [add-build-sshkey : Create Temp SSH key]
2025-12-05 00:50:08.281830 | controller -> localhost | Generating public/private rsa key pair.
2025-12-05 00:50:08.282053 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/d3d23dab5269493ea0aa69ff2b07e958_id_rsa.
2025-12-05 00:50:08.282092 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/d3d23dab5269493ea0aa69ff2b07e958_id_rsa.pub.
2025-12-05 00:50:08.282119 | controller -> localhost | The key fingerprint is:
2025-12-05 00:50:08.282140 | controller -> localhost | SHA256:0ZRoPowhYaJx74JSxhQcEb7LD+w5PzQK6WwMGpePZzM zuul-build-sshkey
2025-12-05 00:50:08.282172 | controller -> localhost | The key's randomart image is:
2025-12-05 00:50:08.282191 | controller -> localhost | +---[RSA 3072]----+
2025-12-05 00:50:08.282208 | controller -> localhost | |..O=o.   ...     |
2025-12-05 00:50:08.282226 | controller -> localhost | | B.+. . oo.      |
2025-12-05 00:50:08.282243 | controller -> localhost | |. = .. *. .      |
2025-12-05 00:50:08.282262 | controller -> localhost | | + o  . +.       |
2025-12-05 00:50:08.282281 | controller -> localhost | |o.o..   S.       |
2025-12-05 00:50:08.282298 | controller -> localhost | |*oooo            |
2025-12-05 00:50:08.282314 | controller -> localhost | |*+== .           |
2025-12-05 00:50:08.282331 | controller -> localhost | |.*++E            |
2025-12-05 00:50:08.282347 | controller -> localhost | |. o=o+           |
2025-12-05 00:50:08.282363 | controller -> localhost | +----[SHA256]-----+
2025-12-05 00:50:08.282409 | controller -> localhost | ok: Runtime: 0:00:00.273167
2025-12-05 00:50:08.288807 | 
2025-12-05 00:50:08.288866 | TASK [add-build-sshkey : Remote setup ssh keys (linux)]
2025-12-05 00:50:08.306347 | controller | ok
2025-12-05 00:50:08.315715 | controller | included: /var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml
2025-12-05 00:50:08.322680 | 
2025-12-05 00:50:08.322747 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey]
2025-12-05 00:50:08.346521 | controller | skipping: Conditional result was False
2025-12-05 00:50:08.351107 | 
2025-12-05 00:50:08.351166 | TASK [add-build-sshkey : Enable access via build key on all nodes]
2025-12-05 00:50:08.703684 | controller | changed
2025-12-05 00:50:08.708452 | 
2025-12-05 00:50:08.708531 | TASK [add-build-sshkey : Make sure user has a .ssh]
2025-12-05 00:50:08.939150 | controller | ok
2025-12-05 00:50:08.943762 | 
2025-12-05 00:50:08.943840 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes]
2025-12-05 00:50:09.498371 | controller | changed
2025-12-05 00:50:09.503110 | 
2025-12-05 00:50:09.503168 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes]
2025-12-05 00:50:10.068359 | controller | changed
2025-12-05 00:50:10.072679 | 
2025-12-05 00:50:10.072749 | TASK [add-build-sshkey : Remote setup ssh keys (windows)]
2025-12-05 00:50:10.085886 | controller | skipping: Conditional result was False
2025-12-05 00:50:10.091293 | 
2025-12-05 00:50:10.091355 | TASK [remove-zuul-sshkey : Remove master key from local agent]
2025-12-05 00:50:10.388833 | controller -> localhost | changed
2025-12-05 00:50:10.398107 | 
2025-12-05 00:50:10.398186 | TASK [add-build-sshkey : Add back temp key]
2025-12-05 00:50:10.619845 | controller -> localhost | Identity added: /var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/d3d23dab5269493ea0aa69ff2b07e958_id_rsa (zuul-build-sshkey)
2025-12-05 00:50:10.620021 | controller -> localhost | ok: Runtime: 0:00:00.006727
2025-12-05 00:50:10.625114 | 
2025-12-05 00:50:10.625172 | TASK [add-build-sshkey : Verify we can still SSH to all nodes]
2025-12-05 00:50:10.897873 | controller | ok
2025-12-05 00:50:10.902035 | 
2025-12-05 00:50:10.902099 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)]
2025-12-05 00:50:10.932718 | controller | skipping: Conditional result was False
2025-12-05 00:50:10.941328 | 
2025-12-05 00:50:10.941400 | TASK [include_role : validate-host]
2025-12-05 00:50:10.957671 | controller | ok
2025-12-05 00:50:10.976017 | 
2025-12-05 00:50:10.976081 | TASK [validate-host : Define zuul_info_dir fact]
2025-12-05 00:50:11.002919 | controller | ok
2025-12-05 00:50:11.007317 | 
2025-12-05 00:50:11.007375 | TASK [validate-host : Ensure Zuul Ansible directory exists]
2025-12-05 00:50:11.192361 | controller -> localhost | ok
2025-12-05 00:50:11.197400 | 
2025-12-05 00:50:11.197468 | TASK [validate-host : Collect information about the host]
2025-12-05 00:50:11.825144 | controller | ok
2025-12-05 00:50:11.832897 | 
2025-12-05 00:50:11.832987 | TASK [validate-host : Sanitize hostname]
2025-12-05 00:50:11.902514 | controller | ok
2025-12-05 00:50:11.909608 | 
2025-12-05 00:50:11.909724 | TASK [validate-host : Write out all ansible variables/facts known for each host]
2025-12-05 00:50:12.277901 | controller -> localhost | changed
2025-12-05 00:50:12.282379 | 
2025-12-05 00:50:12.282436 | TASK [validate-host : Collect information about zuul worker]
2025-12-05 00:50:12.608761 | controller | ok
2025-12-05 00:50:12.613359 | 
2025-12-05 00:50:12.613426 | TASK [validate-host : Write out all zuul information for each host]
2025-12-05 00:50:12.950505 | controller -> localhost | changed
2025-12-05 00:50:12.959353 | 
2025-12-05 00:50:12.959425 | TASK [include_role : prepare-workspace-openshift]
2025-12-05 00:50:12.982790 | controller | skipping: Conditional result was False
2025-12-05 00:50:12.987856 | 
2025-12-05 00:50:12.987937 | TASK [include_role : remove-zuul-sshkey]
2025-12-05 00:50:13.001245 | controller | skipping: Conditional result was False
2025-12-05 00:50:13.006354 | 
2025-12-05 00:50:13.006424 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them]
2025-12-05 00:50:13.198321 | controller | ok: "logs"
2025-12-05 00:50:13.198527 | controller | ok: All items complete
2025-12-05 00:50:13.198558 | 
2025-12-05 00:50:13.364787 | controller | ok: "artifacts"
2025-12-05 00:50:13.537455 | controller | ok: "docs"
2025-12-05 00:50:13.544163 | 
2025-12-05 00:50:13.544240 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist]
2025-12-05 00:50:13.741430 | controller | changed: "logs"
2025-12-05 00:50:13.909650 | controller | changed: "artifacts"
2025-12-05 00:50:14.079545 | controller | changed: "docs"
2025-12-05 00:50:14.106094 | 
2025-12-05 00:50:14.106169 | PLAY RECAP
2025-12-05 00:50:14.106218 | controller | ok: 22 changed: 9 unreachable: 0 failed: 0 skipped: 5 rescued: 0 ignored: 0
2025-12-05 00:50:14.106268 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2025-12-05 00:50:14.106290 | 
2025-12-05 00:50:14.178274 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/base-minimal/pre.yaml@master]
2025-12-05 00:50:14.179065 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/ci-framework-rdo-base/pre.yaml@master]
2025-12-05 00:50:14.716645 | 
2025-12-05 00:50:14.716754 | PLAY [all]
2025-12-05 00:50:14.734480 | 
2025-12-05 00:50:14.734552 | TASK [mirror-info-fork : Set mirror_fqdn if not defined]
2025-12-05 00:50:14.782514 | controller | ok
2025-12-05 00:50:14.787763 | 
2025-12-05 00:50:14.787853 | TASK [mirror-info-fork : Create /etc/ci]
2025-12-05 00:50:15.130460 | controller | changed
2025-12-05 00:50:15.135795 | 
2025-12-05 00:50:15.135872 | TASK [mirror-info-fork : Install ci_mirror script]
2025-12-05 00:50:15.965170 | controller | changed
2025-12-05 00:50:15.976071 | 
2025-12-05 00:50:15.976167 | LOOP [add-authorized-keys : Enable access via build key on all nodes]
2025-12-05 00:50:16.330824 | controller | changed:
2025-12-05 00:50:16.331004 | controller | {
2025-12-05 00:50:16.331037 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAABIwAAAQEA4Z/c9osaGGtU6X8fgELwfj/yayRurfcKA0HMFfdpPxev2dbwljysMuzoVp4OZmW1gvGtyYPSNRvnzgsaabPNKNo2ym5NToCP6UM+KSe93aln4BcM/24mXChYAbXJQ5Bqq/pIzsGs/pKetQN+vwvMxLOwTvpcsCJBXaa981RKML6xj9l/UZ7IIq1HSEKMvPLxZMWdu0Ut8DkCd5F4nOw9Wgml2uYpDCj5LLCrQQ9ChdOMz8hz6SighhNlRpPkvPaet3OXxr/ytFMu7j7vv06CaEnuMMiY2aTWN1Imin9eHAylIqFHta/3gFfQSWt9jXM7owkBLKL7ATzhaAn+fjNupw== arxcruz@redhat.com"
2025-12-05 00:50:16.331066 | controller | }
2025-12-05 00:50:16.540658 | controller | changed:
2025-12-05 00:50:16.540744 | controller | {
2025-12-05 00:50:16.540771 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQDS4Fn6k4deCnIlOtLWqZJyksbepjQt04j8Ed8CGx9EKkj0fKiAxiI4TadXQYPuNHMixZy4Nevjb6aDhL5Z906TfvNHKUrjrG7G26a0k8vdc61NEQ7FmcGMWRLwwc6ReDO7lFpzYKBMk4YqfWgBuGU/K6WLKiVW2cVvwIuGIaYrE1OiiX0iVUUk7KApXlDJMXn7qjSYynfO4mF629NIp8FJal38+Kv+HA+0QkE5Y2xXnzD4Lar5+keymiCHRntPppXHeLIRzbt0gxC7v3L72hpQ3BTBEzwHpeS8KY+SX1y5lRMN45thCHfJqGmARJREDjBvWG8JXOPmVIKQtZmVcD5b mandreou@redhat.com"
2025-12-05 00:50:16.540791 | controller | }
2025-12-05 00:50:16.753282 | controller | changed:
2025-12-05 00:50:16.753365 | controller | {
2025-12-05 00:50:16.753392 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQC9MiLfy30deHA7xPOAlew5qUq3UP2gmRMYJi8PtkjFB20/DKeWwWNnkZPqP9AayruRoo51SIiVg870gbZE2jYl+Ncx/FYDe56JeC3ySZsXoAVkC9bP7gkOGqOmJjirvAgPMI7bogVz8i+66Q4Ar7OKTp3762G4IuWPPEg4ce4Y7lx9qWocZapHYq4cYKMxrOZ7SEbFSATBbe2bPZAPKTw8do/Eny+Hq/LkHFhIeyra6cqTFQYShr+zPln0Cr+ro/pDX3bB+1ubFgTpjpkkkQsLhDfR6cCdCWM2lgnS3BTtYj5Ct9/JRPR5YOphqZz+uB+OEu2IL68hmU9vNTth1KeX rlandy@redhat.com"
2025-12-05 00:50:16.753413 | controller | }
2025-12-05 00:50:16.958538 | controller | changed:
2025-12-05 00:50:16.958611 | controller | {
2025-12-05 00:50:16.958636 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIFCbgz8gdERiJlk2IKOtkjQxEXejrio6ZYMJAVJYpOIp raukadah@gmail.com"
2025-12-05 00:50:16.958656 | controller | }
2025-12-05 00:50:17.178717 | controller | changed:
2025-12-05 00:50:17.178803 | controller | {
2025-12-05 00:50:17.178830 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIBqb3Q/9uDf4LmihQ7xeJ9gA/STIQUFPSfyyV0m8AoQi bshewale@redhat.com"
2025-12-05 00:50:17.178850 | controller | }
2025-12-05 00:50:17.392766 | controller | changed:
2025-12-05 00:50:17.392845 | controller | {
2025-12-05 00:50:17.392872 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQC0I8QqQx0Az2ysJt2JuffucLijhBqnsXKEIx5GyHwxVULROa8VtNFXUDH6ZKZavhiMcmfHB2+TBTda+lDP4FldYj06dGmzCY+IYGa+uDRdxHNGYjvCfLFcmLlzRK6fNbTcui+KlUFUdKe0fb9CRoGKyhlJD5GRkM1Dv+Yb6Bj+RNnmm1fVGYxzmrD2utvffYEb0SZGWxq2R9gefx1q/3wCGjeqvufEV+AskPhVGc5T7t9eyZ4qmslkLh1/nMuaIBFcr9AUACRajsvk6mXrAN1g3HlBf2gQlhi1UEyfbqIQvzzFtsbLDlSum/KmKjy818GzvWjERfQ0VkGzCd9bSLVL dviroel@redhat.com"
2025-12-05 00:50:17.392893 | controller | }
2025-12-05 00:50:17.618510 | controller | changed:
2025-12-05 00:50:17.618590 | controller | {
2025-12-05 00:50:17.618616 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABgQDLOQd4ZLtkZXQGY6UwAr/06ppWQK4fDO3HaqxPk98csyOCBXsliSKK39Bso828+5srIXiW7aI6aC9P5mwi4mUZlGPfJlQbfrcGvY+b/SocuvaGK+1RrHLoJCT52LBhwgrzlXio2jeksZeein8iaTrhsPrOAs7KggIL/rB9hEiB3NaOPWhhoCP4vlW6MEMExGcqB/1FVxXFBPnLkEyW0Lk7ycVflZl2ocRxbfjZi0+tI1Wlinp8PvSQSc/WVrAcDgKjc/mB4ODPOyYy3G8FHgfMsrXSDEyjBKgLKMsdCrAUcqJQWjkqXleXSYOV4q3pzL+9umK+q/e3P/bIoSFQzmJKTU1eDfuvPXmow9F5H54fii/Da7ezlMJ+wPGHJrRAkmzvMbALy7xwswLhZMkOGNtRcPqaKYRmIBKpw3o6bCTtcNUHOtOQnzwY8JzrM2eBWJBXAANYw+9/ho80JIiwhg29CFNpVBuHbql2YxJQNrnl90guN65rYNpDxdIluweyUf8= anbanerj@kaermorhen"
2025-12-05 00:50:17.618638 | controller | }
2025-12-05 00:50:17.843213 | controller | changed:
2025-12-05 00:50:17.843294 | controller | {
2025-12-05 00:50:17.843323 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABgQC3VwV8Im9kRm49lt3tM36hj4Zv27FxGo4C1Q/0jqhzFmHY7RHbmeRr8ObhwWoHjXSozKWg8FL5ER0z3hTwL0W6lez3sL7hUaCmSuZmG5Hnl3x4vTSxDI9JZ/Y65rtYiiWQo2fC5xJhU/4+0e5e/pseCm8cKRSu+SaxhO+sd6FDojA2x1BzOzKiQRDy/1zWGp/cZkxcEuB1wHI5LMzN03c67vmbu+fhZRAUO4dQkvcnj2LrhQtpa+ytvnSjr8icMDosf1OsbSffwZFyHB/hfWGAfe0eIeSA2XPraxiPknXxiPKx2MJsaUTYbsZcm3EjFdHBBMumw5rBI74zLrMRvCO9GwBEmGT4rFng1nP+yw5DB8sn2zqpOsPg1LYRwCPOUveC13P6pgsZZPh812e8v5EKnETct+5XI3dVpdw6CnNiLwAyVAF15DJvBGT/u1k0Myg/bQn+Gv9k2MSj6LvQmf6WbZu2Wgjm30z3FyCneBqTL7mLF19YXzeC0ufHz5pnO1E= dasm@fedora"
2025-12-05 00:50:17.843344 | controller | }
2025-12-05 00:50:18.058267 | controller | changed:
2025-12-05 00:50:18.058387 | controller | {
2025-12-05 00:50:18.058440 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIHUnwjB20UKmsSed9X73eGNV5AOEFccQ3NYrRW776pEk cjeanner"
2025-12-05 00:50:18.058465 | controller | }
2025-12-05 00:50:18.258678 | controller | changed:
2025-12-05 00:50:18.258785 | controller | {
2025-12-05 00:50:18.258812 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDercCMGn8rW1C4P67tHgtflPdTeXlpyUJYH+6XDd2lR jgilaber@redhat.com"
2025-12-05 00:50:18.258832 | controller | }
2025-12-05 00:50:18.462597 | controller | changed:
2025-12-05 00:50:18.462679 | controller | {
2025-12-05 00:50:18.462716 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIAMI6kkg9Wg0sG7jIJmyZemEBwUn1yzNpQQd3gnulOmZ adrianfuscoarnejo@gmail.com"
2025-12-05 00:50:18.462737 | controller | }
2025-12-05 00:50:18.677311 | controller | changed:
2025-12-05 00:50:18.677388 | controller | {
2025-12-05 00:50:18.677412 | controller |   "public_key": "ecdsa-sha2-nistp256 AAAAE2VjZHNhLXNoYTItbmlzdHAyNTYAAAAIbmlzdHAyNTYAAABBBPijwpQu/3jhhhBZInXNOLEH57DrknPc3PLbsRvYyJIFzwYjX+WD4a7+nGnMYS42MuZk6TJcVqgnqofVx4isoD4= ramishra@redhat.com"
2025-12-05 00:50:18.677431 | controller | }
2025-12-05 00:50:18.875111 | controller | changed:
2025-12-05 00:50:18.875174 | controller | {
2025-12-05 00:50:18.875200 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIGpU/BepK3qX0NRf5Np+dOBDqzQEefhNrw2DCZaH3uWW rebtoor@monolith"
2025-12-05 00:50:18.875221 | controller | }
2025-12-05 00:50:19.074584 | controller | changed:
2025-12-05 00:50:19.074671 | controller | {
2025-12-05 00:50:19.074708 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDK0iKdi8jQTpQrDdLVH/AAgLVYyTXF7AQ1gjc/5uT3t ykarel@yatinkarel"
2025-12-05 00:50:19.074731 | controller | }
2025-12-05 00:50:19.275319 | controller | changed:
2025-12-05 00:50:19.275538 | controller | {
2025-12-05 00:50:19.275577 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIF/V/cLotA6LZeO32VL45Hd78skuA2lJA425Sm2LlQeZ fmount@horcrux"
2025-12-05 00:50:19.275601 | controller | }
2025-12-05 00:50:19.504922 | controller | changed:
2025-12-05 00:50:19.504993 | controller | {
2025-12-05 00:50:19.505020 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDa7QCjuDMVmRPo1rREbGwzYeBCYVN+Ou/3WKXZEC6Sr"
2025-12-05 00:50:19.505042 | controller | }
2025-12-05 00:50:19.721135 | controller | changed:
2025-12-05 00:50:19.721214 | controller | {
2025-12-05 00:50:19.721244 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAACAQCfNtF7NvKl915TGsGGoseUb06Hj8L/S4toWf0hExeY+F00woL6NvBlJD0nDct+P5a22I4EhvoQCRQ8reaPCm1lybR3uiRIJsj+8zkVvLwby9LXzfZorlNG9ofjd00FEmB09uW/YvTl6Q9XwwwX6tInzIOv3TMqTHHGOL74ibbj8J/FJR0cFEyj0z4WQRvtkh32xAHl83gbuINryMt0sqRI+clj2381NKL55DRLQrVw0gsfqqxiHAnXg21qWmc4J+b9e9kiuAFQjcjwTVkwJCcg3xbPwC/qokYRby/Y5S40UUd7/jEARGXT7RZgpzTuDd1oZiCVrnrqJNPaMNdVv5MLeFdf1B7iIe5aa/fGouX7AO4SdKhZUdnJmCFAGvjC6S3JMZ2wAcUl+OHnssfmdj7XL50cLo27vjuzMtLAgSqi6N99m92WCF2s8J9aVzszX7Xz9OKZCeGsiVJp3/NdABKzSEAyM9xBD/5Vho894Sav+otpySHe3p6RUTgbB5Zu8VyZRZ/UtB3ueXxyo764yrc6qWIDqrehm84Xm9g+/jpIBzGPl07NUNJpdt/6Sgf9RIKXw/7XypO5yZfUcuFNGTxLfqjTNrtgLZNcjfav6sSdVXVcMPL//XNuRdKmVFaO76eV/oGMQGr1fGcCD+N+CpI7+Q+fCNB6VFWG4nZFuI/Iuw== averdagu@redhat.com"
2025-12-05 00:50:19.721267 | controller | }
2025-12-05 00:50:19.941291 | controller | changed:
2025-12-05 00:50:19.941355 | controller | {
2025-12-05 00:50:19.941381 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABgQDq8l27xI+QlQVdS4djp9ogSoyrNE2+Ox6vKPdhSNL1J3PE5w+WCSvMz9A5gnNuH810zwbekEApbxTze/gLQJwBHA52CChfURpXrFaxY7ePXRElwKAL3mJfzBWY/c5jnNL9TCVmFJTGZkFZP3Nh+BMgZvL6xBkt3WKm6Uq18qzd9XeKcZusrA+O+uLv1fVeQnadY9RIqOCyeFYCzLWrUfTyE8x/XG0hAWIM7qpnF2cALQS2h9n4hW5ybiUN790H08wf9hFwEf5nxY9Z9dVkPFQiTSGKNBzmnCXU9skxS/xhpFjJ5duGSZdtAHe9O+nGZm9c67hxgtf8e5PDuqAdXEv2cf6e3VBAt+Bz8EKI3yosTj0oZHfwr42Yzb1l/SKy14Rggsrc9KAQlrGXan6+u2jcQqqx7l+SWmnpFiWTV9u5cWj2IgOhApOitmRBPYqk9rE2usfO0hLn/Pj/R/Nau4803e1/EikdLE7Ps95s9mX5jRDjAoUa2JwFF5RsVFyL910= ashigupt@ashigupt.remote.csb"
2025-12-05 00:50:19.941409 | controller | }
2025-12-05 00:50:20.165078 | controller | changed:
2025-12-05 00:50:20.165166 | controller | {
2025-12-05 00:50:20.165195 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIOKLl0NYKwoZ/JY5KeZU8VwRAggeOxqQJeoqp3dsAaY9"
2025-12-05 00:50:20.165217 | controller | }
2025-12-05 00:50:20.380046 | controller | changed:
2025-12-05 00:50:20.380132 | controller | {
2025-12-05 00:50:20.380158 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIASASQOH2BcOyLKuuDOdWZlPi2orcjcA8q4400T73DLH evallesp@fedora"
2025-12-05 00:50:20.380179 | controller | }
2025-12-05 00:50:20.592295 | controller | changed:
2025-12-05 00:50:20.592373 | controller | {
2025-12-05 00:50:20.592401 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAILeBWlamUph+jRKV2qrx1PGU7vWuGIt5+z9k96I8WehW amsinha@amsinha-mac"
2025-12-05 00:50:20.592423 | controller | }
2025-12-05 00:50:20.799902 | controller | changed:
2025-12-05 00:50:20.799999 | controller | {
2025-12-05 00:50:20.800027 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIANvVgvJBlK3gb1yz5uef/JqIGq4HLEmY2dYA8e37swb morenod@redhat-laptop"
2025-12-05 00:50:20.800048 | controller | }
2025-12-05 00:50:21.005217 | controller | changed:
2025-12-05 00:50:21.005301 | controller | {
2025-12-05 00:50:21.005331 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAACAQDZdI7t1cxYx65heVI24HTV4F7oQLW1zyfxHreL2TIJKxjyrUUKIFEUmTutcBlJRLNT2Eoix6x1sOw9YrchloCLcn//SGfTElr9mSc5jbjb7QXEU+zJMhtxyEJ1Po3CUGnj7ckiIXw7wcawZtrEOAQ9pH3ExYCJcEMiyNjRQZCxT3tPK+S4B95EWh5Fsrz9CkwpjNRPPH7LigCeQTM3Wc7r97utAslBUUvYceDSLA7rMgkitJE38b7rZBeYzsGQ8YYUBjTCtehqQXxCRjizbHWaaZkBU+N3zkKB6n/iCNGIO690NK7A/qb6msTijiz1PeuM8ThOsi9qXnbX5v0PoTpcFSojV7NHAQ71f0XXuS43FhZctT+Dcx44dT8Fb5vJu2cJGrk+qF8ZgJYNpRS7gPg0EG2EqjK7JMf9ULdjSu0r+KlqIAyLvtzT4eOnQipoKlb/WG5D/0ohKv7OMQ352ggfkBFIQsRXyyTCT98Ft9juqPuahi3CAQmP4H9dyE+7+Kz437PEtsxLmfm6naNmWi7Ee1DqWPwS8rEajsm4sNM4wW9gdBboJQtc0uZw0DfLj1I9r3Mc8Ol0jYtz0yNQDSzVLrGCaJlC311trU70tZ+ZkAVV6Mn8lOhSbj1cK0lvSr6ZK4dgqGl3I1eTZJJhbLNdg7UOVaiRx9543+C/p/As7w== brjackma@redhat.com"
2025-12-05 00:50:21.005354 | controller | }
2025-12-05 00:50:21.218188 | controller | changed:
2025-12-05 00:50:21.218308 | controller | {
2025-12-05 00:50:21.218341 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIKwedoZ0TWPJX/z/4TAbO/kKcDZOQVgRH0hAqrL5UCI1 vcastell@redhat.com"
2025-12-05 00:50:21.218364 | controller | }
2025-12-05 00:50:21.424384 | controller | changed:
2025-12-05 00:50:21.424457 | controller | {
2025-12-05 00:50:21.424483 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIEmv8sE8GCk6ZTPIqF0FQrttBdL3mq7rCm/IJy0xDFh7 michburk@redhat.com"
2025-12-05 00:50:21.424504 | controller | }
2025-12-05 00:50:21.627809 | controller | changed:
2025-12-05 00:50:21.627945 | controller | {
2025-12-05 00:50:21.627982 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAICy6GpGEtwevXEEn4mmLR5lmSLe23dGgAvzkB9DMNbkf rsafrono@rsafrono"
2025-12-05 00:50:21.628006 | controller | }
2025-12-05 00:50:21.652124 | 
2025-12-05 00:50:21.652192 | TASK [Set timezone to UTC]
2025-12-05 00:50:22.066664 | controller | changed: executed `/bin/timedatectl set-timezone UTC`
2025-12-05 00:50:22.071896 | 
2025-12-05 00:50:22.071976 | TASK [Create nodepool directory]
2025-12-05 00:50:22.292203 | controller | changed
2025-12-05 00:50:22.297441 | 
2025-12-05 00:50:22.297508 | TASK [Create nodepool sub_nodes file]
2025-12-05 00:50:22.832735 | controller | changed
2025-12-05 00:50:22.837610 | 
2025-12-05 00:50:22.837677 | TASK [Create nodepool sub_nodes_private file]
2025-12-05 00:50:23.390861 | controller | changed
2025-12-05 00:50:23.395785 | 
2025-12-05 00:50:23.395864 | LOOP [Populate nodepool sub_nodes file]
2025-12-05 00:50:23.424726 | 
2025-12-05 00:50:23.424871 | LOOP [Populate nodepool sub_nodes_private file]
2025-12-05 00:50:23.454130 | 
2025-12-05 00:50:23.454262 | TASK [Create nodepool primary file]
2025-12-05 00:50:23.477937 | controller | skipping: Conditional result was False
2025-12-05 00:50:23.483204 | 
2025-12-05 00:50:23.483272 | TASK [Create nodepool node_private for this node]
2025-12-05 00:50:24.067858 | controller | changed
2025-12-05 00:50:24.074698 | 
2025-12-05 00:50:24.074777 | LOOP [Copy ssh keys to nodepool directory]
2025-12-05 00:50:24.393550 | controller | ok: Item: id_rsa Runtime: 0:00:00.004649
2025-12-05 00:50:24.393744 | 
2025-12-05 00:50:24.563147 | controller | ok: Item: id_rsa.pub Runtime: 0:00:00.006538
2025-12-05 00:50:24.569802 | 
2025-12-05 00:50:24.569875 | TASK [Add sudoers role for zuul-sudo-grep.sh]
2025-12-05 00:50:25.178437 | controller | changed
2025-12-05 00:50:25.183335 | 
2025-12-05 00:50:25.183405 | TASK [Validate sudoers config after edits]
2025-12-05 00:50:25.440297 | controller | /etc/sudoers: parsed OK
2025-12-05 00:50:25.440359 | controller | /etc/sudoers.d/90-cloud-init-users: parsed OK
2025-12-05 00:50:25.440420 | controller | /etc/sudoers.d/zuul: parsed OK
2025-12-05 00:50:25.440433 | controller | /etc/sudoers.d/zuul-sudo-grep: parsed OK
2025-12-05 00:50:25.715367 | controller | ok: Runtime: 0:00:00.011688
2025-12-05 00:50:25.720355 | 
2025-12-05 00:50:25.720421 | TASK [Show the environment passed in to job shell scripts]
2025-12-05 00:50:25.936802 | controller | SHELL=/bin/bash
2025-12-05 00:50:25.936865 | controller | ZUUL_PROJECT=openstack-k8s-operators/edpm-ansible
2025-12-05 00:50:25.936874 | controller | ZUUL_SHORT_PROJECT_NAME=edpm-ansible
2025-12-05 00:50:25.936880 | controller | ZUUL_CHANGES=openstack-k8s-operators/edpm-ansible:main:refs/changes/54/1054/6d46fbc420dc97092b3ca79140f49f9e0e053033
2025-12-05 00:50:25.936885 | controller | PWD=/home/zuul
2025-12-05 00:50:25.936890 | controller | ZUUL_PIPELINE=github-check
2025-12-05 00:50:25.936895 | controller | LOGNAME=zuul
2025-12-05 00:50:25.936900 | controller | XDG_SESSION_TYPE=tty
2025-12-05 00:50:25.936905 | controller | _=/usr/bin/env
2025-12-05 00:50:25.936910 | controller | MOTD_SHOWN=pam
2025-12-05 00:50:25.936938 | controller | HOME=/home/zuul
2025-12-05 00:50:25.936944 | controller | LANG=en_US.UTF-8
2025-12-05 00:50:25.936949 | controller | SSH_CONNECTION=192.168.26.12 54652 192.168.26.104 22
2025-12-05 00:50:25.936954 | controller | TOX_TESTENV_PASSENV=ZUUL_UUID ZUUL_PROJECT ZUUL_SHORT_PROJECT_NAME ZUUL_PIPELINE ZUUL_VOTING WORKSPACE BUILD_TIMEOUT ZUUL_BRANCH ZUUL_CHANGES ZUUL_CHANGE_IDS ZUUL_CHANGE ZUUL_PATCHSET
2025-12-05 00:50:25.936962 | controller | ZUUL_CHANGE_IDS=1054,6d46fbc420dc97092b3ca79140f49f9e0e053033
2025-12-05 00:50:25.936967 | controller | WORKSPACE=/home/zuul/workspace
2025-12-05 00:50:25.936972 | controller | XDG_SESSION_CLASS=user
2025-12-05 00:50:25.936977 | controller | SELINUX_ROLE_REQUESTED=
2025-12-05 00:50:25.936982 | controller | LESSOPEN=||/usr/bin/lesspipe.sh %s
2025-12-05 00:50:25.936987 | controller | USER=zuul
2025-12-05 00:50:25.936992 | controller | ZUUL_VOTING=True
2025-12-05 00:50:25.936997 | controller | BUILD_TIMEOUT=1800000
2025-12-05 00:50:25.937001 | controller | SELINUX_USE_CURRENT_RANGE=
2025-12-05 00:50:25.937006 | controller | SHLVL=1
2025-12-05 00:50:25.937011 | controller | ZUUL_PATCHSET=6d46fbc420dc97092b3ca79140f49f9e0e053033
2025-12-05 00:50:25.937016 | controller | XDG_SESSION_ID=1
2025-12-05 00:50:25.937021 | controller | ZUUL_BRANCH=main
2025-12-05 00:50:25.937026 | controller | XDG_RUNTIME_DIR=/run/user/1000
2025-12-05 00:50:25.937030 | controller | SSH_CLIENT=192.168.26.12 54652 22
2025-12-05 00:50:25.937037 | controller | DEBUGINFOD_URLS=https://debuginfod.centos.org/
2025-12-05 00:50:25.937042 | controller | DEBUGINFOD_IMA_CERT_PATH=/etc/keys/ima:
2025-12-05 00:50:25.937047 | controller | which_declare=declare -f
2025-12-05 00:50:25.937052 | controller | PATH=/home/zuul/.local/bin:/home/zuul/bin:/usr/local/bin:/usr/bin:/usr/local/sbin:/usr/sbin
2025-12-05 00:50:25.937057 | controller | SELINUX_LEVEL_REQUESTED=
2025-12-05 00:50:25.937062 | controller | ZUUL_CHANGE=1054
2025-12-05 00:50:25.937066 | controller | DBUS_SESSION_BUS_ADDRESS=unix:path=/run/user/1000/bus
2025-12-05 00:50:25.937071 | controller | ZUUL_UUID=d3d23dab5269493ea0aa69ff2b07e958
2025-12-05 00:50:25.937076 | controller | BASH_FUNC_which%%=() {  ( alias;
2025-12-05 00:50:25.937081 | controller |  eval ${which_declare} ) | /usr/bin/which --tty-only --read-alias --read-functions --show-tilde --show-dot $@
2025-12-05 00:50:25.937086 | controller | }
2025-12-05 00:50:26.248349 | controller | ok: Runtime: 0:00:00.007768
2025-12-05 00:50:26.253386 | 
2025-12-05 00:50:26.253448 | TASK [Workaround hardcoded /home/zuul/workspace in zuul_legacy_vars]
2025-12-05 00:50:26.266640 | controller | skipping: Conditional result was False
2025-12-05 00:50:26.271865 | 
2025-12-05 00:50:26.271944 | TASK [Symlink /home/zuul-worker/workspace]
2025-12-05 00:50:26.796333 | controller | skipping: Conditional result was False
2025-12-05 00:50:26.802424 | 
2025-12-05 00:50:26.802493 | TASK [Ensure legacy workspace directory]
2025-12-05 00:50:27.002729 | controller | changed
2025-12-05 00:50:27.020444 | 
2025-12-05 00:50:27.020510 | PLAY RECAP
2025-12-05 00:50:27.020564 | controller | ok: 14 changed: 11 unreachable: 0 failed: 0 skipped: 5 rescued: 0 ignored: 0
2025-12-05 00:50:27.020595 | 
2025-12-05 00:50:27.102720 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/ci-framework-rdo-base/pre.yaml@master]
2025-12-05 00:50:27.103451 | PRE-RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/dump_zuul_data.yml@main]
2025-12-05 00:50:27.601709 | 
2025-12-05 00:50:27.601806 | PLAY [Run ci/playbooks/dump_zuul_data.yml]
2025-12-05 00:50:27.622863 | 
2025-12-05 00:50:27.622961 | TASK [Create zuul-output directory]
2025-12-05 00:50:27.945264 | controller | changed
2025-12-05 00:50:27.950131 | 
2025-12-05 00:50:27.950205 | TASK [Slurp Zuul inventory test]
2025-12-05 00:50:28.216346 | controller -> localhost | ok
2025-12-05 00:50:28.222605 | 
2025-12-05 00:50:28.222674 | TASK [Save zuul inventory]
2025-12-05 00:50:28.969408 | controller | changed
2025-12-05 00:50:28.974224 | 
2025-12-05 00:50:28.974288 | TASK [Save zuul vars without the change_message]
2025-12-05 00:50:29.539925 | controller | changed
2025-12-05 00:50:29.557014 | 
2025-12-05 00:50:29.557064 | PLAY RECAP
2025-12-05 00:50:29.557105 | controller | ok: 4 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2025-12-05 00:50:29.557127 | 
2025-12-05 00:50:29.619750 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/dump_zuul_data.yml@main]
2025-12-05 00:50:29.620472 | PRE-RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-prepare.yml@main]
2025-12-05 00:50:30.148281 | 
2025-12-05 00:50:30.148376 | PLAY [Run ci/playbooks/molecule-prepare.yml]
2025-12-05 00:50:30.168544 | 
2025-12-05 00:50:30.168621 | TASK [Execute mirror info role to configure /etc/ci/mirror_info.sh]
2025-12-05 00:50:30.186600 | controller | ok
2025-12-05 00:50:30.203206 | 
2025-12-05 00:50:30.203296 | TASK [mirror-info-fork : Set mirror_fqdn if not defined]
2025-12-05 00:50:30.226857 | controller | skipping: Conditional result was False
2025-12-05 00:50:30.232368 | 
2025-12-05 00:50:30.232440 | TASK [mirror-info-fork : Create /etc/ci]
2025-12-05 00:50:30.544565 | controller | ok
2025-12-05 00:50:30.550056 | 
2025-12-05 00:50:30.550129 | TASK [mirror-info-fork : Install ci_mirror script]
2025-12-05 00:50:31.228092 | controller | ok
2025-12-05 00:50:31.237858 | 
2025-12-05 00:50:31.237941 | TASK [Prepare workspace]
2025-12-05 00:50:31.255402 | controller | ok
2025-12-05 00:50:31.271507 | 
2025-12-05 00:50:31.271577 | TASK [prepare-workspace : Start zuul_console daemon.]
2025-12-05 00:50:31.553078 | controller | ok
2025-12-05 00:50:31.559040 | 
2025-12-05 00:50:31.559102 | TASK [prepare-workspace : Synchronize src repos to workspace directory.]
2025-12-05 00:50:33.831448 | controller | Output suppressed because no_log was given
2025-12-05 00:50:33.840317 | 
2025-12-05 00:50:33.840378 | LOOP [Create zuul-output directory]
2025-12-05 00:50:34.018665 | controller | changed: "/home/zuul/ci-framework-data/logs"
2025-12-05 00:50:34.167416 | controller | ok: "/home/zuul/zuul-output/logs"
2025-12-05 00:50:34.173790 | 
2025-12-05 00:50:34.173926 | TASK [Install required packages]
2025-12-05 00:51:19.319405 | controller | changed
2025-12-05 00:51:19.324238 | 
2025-12-05 00:51:19.324299 | TASK [Install venv]
2025-12-05 00:52:22.481961 | controller | changed
2025-12-05 00:52:22.505078 | 
2025-12-05 00:52:22.505139 | PLAY RECAP
2025-12-05 00:52:22.505183 | controller | ok: 7 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0
2025-12-05 00:52:22.505205 | 
2025-12-05 00:52:22.566865 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-prepare.yml@main]
2025-12-05 00:52:22.567680 | RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-test.yml@main]
2025-12-05 00:52:23.036652 | 
2025-12-05 00:52:23.036756 | PLAY [Run ci/playbooks/molecule-test.yml]
2025-12-05 00:52:23.056397 | 
2025-12-05 00:52:23.056465 | TASK [Gather required facts]
2025-12-05 00:52:23.511962 | controller | ok
2025-12-05 00:52:23.517139 | 
2025-12-05 00:52:23.517216 | TASK [Load environment var if instructed to]
2025-12-05 00:52:23.540767 | controller | skipping: Conditional result was False
2025-12-05 00:52:23.545884 | 
2025-12-05 00:52:23.545966 | TASK [Ensure group_vars dir exists]
2025-12-05 00:52:23.847433 | controller | changed
2025-12-05 00:52:23.853437 | 
2025-12-05 00:52:23.853500 | TASK [Print related variables]
2025-12-05 00:52:23.882034 | controller | ok:
2025-12-05 00:52:23.882167 | controller | mol_config_dir: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/.config/molecule/config_edpm_ansible.yml
2025-12-05 00:52:23.882198 | controller | roles_dir: /home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/roles/edpm_telemetry_power_monitoring
2025-12-05 00:52:23.886770 | 
2025-12-05 00:52:23.886832 | TASK [Run molecule]
2025-12-05 00:52:24.846460 | controller | INFO     Performing prerun with role_name_check=0...
2025-12-05 00:52:25.591587 | controller | INFO     Running default > dependency
2025-12-05 00:52:25.591947 | controller | WARNING  Skipping, missing the requirements file.
2025-12-05 00:52:26.053054 | controller | [WARNING]: The specified collections path '/home/zuul/.cache/molecule/edpm_tele
2025-12-05 00:52:26.053249 | controller | metry_power_monitoring/default/collections' is not part of the configured
2025-12-05 00:52:26.053446 | controller | Ansible collections paths '/home/zuul/.cache/ansible-compat/9c8f65/collections:
2025-12-05 00:52:26.053545 | controller | /home/zuul/.ansible/collections:/usr/share/ansible/collections'. The installed
2025-12-05 00:52:26.053631 | controller | collection will not be picked up in an Ansible run, unless within a playbook-
2025-12-05 00:52:26.053746 | controller | adjacent collections directory.
2025-12-05 00:52:47.785306 | controller | Starting galaxy collection install process
2025-12-05 00:52:47.785355 | controller | Process install dependency map
2025-12-05 00:52:47.785387 | controller | Starting collection install process
2025-12-05 00:52:47.785546 | controller | Downloading https://galaxy.ansible.com/api/v3/plugin/ansible/content/published/collections/artifacts/community-crypto-3.0.5.tar.gz to /home/zuul/.ansible/tmp/ansible-local-29216ehhqw92v/tmpasa4xt91/community-crypto-3.0.5-fxnauypf
2025-12-05 00:52:47.785603 | controller | Installing 'community.crypto:3.0.5' to '/home/zuul/.cache/molecule/edpm_telemetry_power_monitoring/default/collections/ansible_collections/community/crypto'
2025-12-05 00:52:47.785697 | controller | community.crypto:3.0.5 was installed successfully
2025-12-05 00:52:47.785851 | controller | Downloading https://galaxy.ansible.com/api/v3/plugin/ansible/content/published/collections/artifacts/community-general-12.1.0.tar.gz to /home/zuul/.ansible/tmp/ansible-local-29216ehhqw92v/tmpasa4xt91/community-general-12.1.0-k1e_v0wa
2025-12-05 00:52:47.785906 | controller | Installing 'community.general:12.1.0' to '/home/zuul/.cache/molecule/edpm_telemetry_power_monitoring/default/collections/ansible_collections/community/general'
2025-12-05 00:52:47.785999 | controller | community.general:12.1.0 was installed successfully
2025-12-05 00:52:47.819513 | controller | INFO     Dependency completed successfully.
2025-12-05 00:52:47.828135 | controller | INFO     Running default > destroy
2025-12-05 00:52:47.828428 | controller | WARNING  Skipping, instances are delegated.
2025-12-05 00:52:47.836328 | controller | INFO     Running default > create
2025-12-05 00:52:47.837209 | controller | WARNING  Skipping, instances are delegated.
2025-12-05 00:52:47.845285 | controller | INFO     Running default > prepare
2025-12-05 00:52:48.257308 | controller |
2025-12-05 00:52:48.257449 | controller | PLAY [Prepare test_deps] *******************************************************
2025-12-05 00:52:48.257561 | controller |
2025-12-05 00:52:48.257677 | controller | TASK [../../../../molecule/common/test_deps : Validating arguments against arg spec 'main' - The main entry point for the test_deps role.] ***
2025-12-05 00:52:48.257883 | controller | Friday 05 December 2025  00:52:48 +0000 (0:00:00.014)       0:00:00.014 *******
2025-12-05 00:52:48.271121 | controller | ok: [compute-1]
2025-12-05 00:52:48.271209 | controller |
2025-12-05 00:52:48.271310 | controller | TASK [../../../../molecule/common/test_deps : Gather facts if they don't exist] ***
2025-12-05 00:52:48.271411 | controller | Friday 05 December 2025  00:52:48 +0000 (0:00:00.014)       0:00:00.029 *******
2025-12-05 00:52:48.746530 | controller | ok: [compute-1]
2025-12-05 00:52:48.746621 | controller |
2025-12-05 00:52:48.746739 | controller | TASK [../../../../molecule/common/test_deps : Gather variables for each operating system] ***
2025-12-05 00:52:48.746851 | controller | Friday 05 December 2025  00:52:48 +0000 (0:00:00.475)       0:00:00.504 *******
2025-12-05 00:52:48.779359 | controller | ok: [compute-1] => (item=/home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/molecule/common/test_deps/vars/centos-9.yml)
2025-12-05 00:52:48.779451 | controller |
2025-12-05 00:52:48.779551 | controller | TASK [../../../../molecule/common/test_deps : Detect mirrors file] *************
2025-12-05 00:52:48.779650 | controller | Friday 05 December 2025  00:52:48 +0000 (0:00:00.032)       0:00:00.537 *******
2025-12-05 00:52:49.044233 | controller | ok: [compute-1]
2025-12-05 00:52:49.044297 | controller |
2025-12-05 00:52:49.044402 | controller | TASK [../../../../molecule/common/test_deps : Disable ubi host subscription-manager integration] ***
2025-12-05 00:52:49.044501 | controller | Friday 05 December 2025  00:52:49 +0000 (0:00:00.264)       0:00:00.802 *******
2025-12-05 00:52:49.334680 | controller | ok: [compute-1]
2025-12-05 00:52:49.334751 | controller |
2025-12-05 00:52:49.334889 | controller | TASK [../../../../molecule/common/test_deps : Remove ubi 9 repos] **************
2025-12-05 00:52:49.334986 | controller | Friday 05 December 2025  00:52:49 +0000 (0:00:00.290)       0:00:01.092 *******
2025-12-05 00:52:49.535570 | controller | ok: [compute-1]
2025-12-05 00:52:49.535625 | controller |
2025-12-05 00:52:49.535766 | controller | TASK [../../../../molecule/common/test_deps : Fetch latest repo version] *******
2025-12-05 00:52:49.535881 | controller | Friday 05 December 2025  00:52:49 +0000 (0:00:00.200)       0:00:01.293 *******
2025-12-05 00:52:50.047426 | controller | ok: [compute-1]
2025-12-05 00:52:50.047477 | controller |
2025-12-05 00:52:50.047729 | controller | TASK [../../../../molecule/common/test_deps : Create default repo file] ********
2025-12-05 00:52:50.481792 | controller | Friday 05 December 2025  00:52:50 +0000 (0:00:00.511)       0:00:01.805 *******
2025-12-05 00:52:50.481833 | controller | changed: [compute-1]
2025-12-05 00:52:50.481859 | controller |
2025-12-05 00:52:50.481867 | controller | TASK [../../../../molecule/common/test_deps : Install repo-setup pre-requirements] ***
2025-12-05 00:52:50.482010 | controller | Friday 05 December 2025  00:52:50 +0000 (0:00:00.434)       0:00:02.239 *******
2025-12-05 00:52:59.744043 | controller | ok: [compute-1]
2025-12-05 00:53:00.776302 | controller |
2025-12-05 00:53:00.776333 | controller | TASK [../../../../molecule/common/test_deps : Get repo-setup repository] *******
2025-12-05 00:53:00.776348 | controller | Friday 05 December 2025  00:52:59 +0000 (0:00:09.261)       0:00:11.501 *******
2025-12-05 00:53:00.776359 | controller | changed: [compute-1]
2025-12-05 00:53:03.978857 | controller |
2025-12-05 00:53:03.978885 | controller | TASK [../../../../molecule/common/test_deps : Install repo-setup] **************
2025-12-05 00:53:03.978896 | controller | Friday 05 December 2025  00:53:00 +0000 (0:00:01.032)       0:00:12.533 *******
2025-12-05 00:53:03.978906 | controller | changed: [compute-1]
2025-12-05 00:53:03.978930 | controller |
2025-12-05 00:53:03.978939 | controller | TASK [../../../../molecule/common/test_deps : Create repos] ********************
2025-12-05 00:53:03.979049 | controller | Friday 05 December 2025  00:53:03 +0000 (0:00:03.202)       0:00:15.736 *******
2025-12-05 00:53:04.752167 | controller | changed: [compute-1]
2025-12-05 00:53:04.966242 | controller |
2025-12-05 00:53:04.966276 | controller | TASK [../../../../molecule/common/test_deps : Look for redhat-release rpm] *****
2025-12-05 00:53:04.966284 | controller | Friday 05 December 2025  00:53:04 +0000 (0:00:00.773)       0:00:16.509 *******
2025-12-05 00:53:04.966295 | controller | fatal: [compute-1]: FAILED! => changed=true
2025-12-05 00:53:04.966320 | controller |   cmd: |-
2025-12-05 00:53:04.966327 | controller |     rpm -qe redhat-release
2025-12-05 00:53:04.966333 | controller |   delta: '0:00:00.011239'
2025-12-05 00:53:04.966338 | controller |   end: '2025-12-05 00:53:04.938850'
2025-12-05 00:53:04.966344 | controller |   msg: non-zero return code
2025-12-05 00:53:04.966349 | controller |   rc: 1
2025-12-05 00:53:04.966357 | controller |   start: '2025-12-05 00:53:04.927611'
2025-12-05 00:53:04.966702 | controller |   stderr: ''
2025-12-05 00:53:04.970210 | controller |   stderr_lines: <omitted>
2025-12-05 00:53:04.970231 | controller |   stdout: package redhat-release is not installed
2025-12-05 00:53:04.970239 | controller |   stdout_lines: <omitted>
2025-12-05 00:53:04.970248 | controller | ...ignoring
2025-12-05 00:53:04.998256 | controller |
2025-12-05 00:53:04.998276 | controller | TASK [../../../../molecule/common/test_deps : Workaround of redhat-release binary on ubi9] ***
2025-12-05 00:53:04.998284 | controller | Friday 05 December 2025  00:53:04 +0000 (0:00:00.218)       0:00:16.728 *******
2025-12-05 00:53:04.998292 | controller | skipping: [compute-1]
2025-12-05 00:54:12.720951 | controller |
2025-12-05 00:54:12.720987 | controller | TASK [../../../../molecule/common/test_deps : Install edpm packages] ***********
2025-12-05 00:54:12.720996 | controller | Friday 05 December 2025  00:53:04 +0000 (0:00:00.028)       0:00:16.756 *******
2025-12-05 00:54:12.721006 | controller | changed: [compute-1]
2025-12-05 00:54:14.105525 | controller |
2025-12-05 00:54:14.105554 | controller | TASK [../../../../molecule/common/test_deps : Install selinux python libs] *****
2025-12-05 00:54:14.105562 | controller | Friday 05 December 2025  00:54:12 +0000 (0:01:07.722)       0:01:24.478 *******
2025-12-05 00:54:14.105579 | controller | ok: [compute-1]
2025-12-05 00:54:15.474826 | controller |
2025-12-05 00:54:15.474857 | controller | TASK [../../../../molecule/common/test_deps : Install python yaml libs] ********
2025-12-05 00:54:15.474865 | controller | Friday 05 December 2025  00:54:14 +0000 (0:00:01.384)       0:01:25.863 *******
2025-12-05 00:54:15.474875 | controller | ok: [compute-1]
2025-12-05 00:54:16.828945 | controller |
2025-12-05 00:54:16.828976 | controller | TASK [../../../../molecule/common/test_deps : Install extra packages] **********
2025-12-05 00:54:16.828985 | controller | Friday 05 December 2025  00:54:15 +0000 (0:00:01.369)       0:01:27.232 *******
2025-12-05 00:54:16.828995 | controller | ok: [compute-1]
2025-12-05 00:54:17.011479 | controller |
2025-12-05 00:54:17.011498 | controller | TASK [../../../../molecule/common/test_deps : Check for /etc/ansible/facts.d/bootc.fact] ***
2025-12-05 00:54:17.011506 | controller | Friday 05 December 2025  00:54:16 +0000 (0:00:01.354)       0:01:28.586 *******
2025-12-05 00:54:17.011515 | controller | ok: [compute-1]
2025-12-05 00:54:17.204926 | controller |
2025-12-05 00:54:17.204949 | controller | TASK [../../../../molecule/common/test_deps : Create /etc/ansible/facts.d] *****
2025-12-05 00:54:17.204957 | controller | Friday 05 December 2025  00:54:17 +0000 (0:00:00.182)       0:01:28.769 *******
2025-12-05 00:54:17.204966 | controller | changed: [compute-1]
2025-12-05 00:54:17.576892 | controller |
2025-12-05 00:54:17.576952 | controller | TASK [../../../../molecule/common/test_deps : Create /etc/ansible/facts.d/bootc.fact] ***
2025-12-05 00:54:17.576968 | controller | Friday 05 December 2025  00:54:17 +0000 (0:00:00.193)       0:01:28.962 *******
2025-12-05 00:54:17.576985 | controller | changed: [compute-1]
2025-12-05 00:54:17.577035 | controller |
2025-12-05 00:54:17.577048 | controller | PLAY [Prepare] *****************************************************************
2025-12-05 00:54:17.577058 | controller |
2025-12-05 00:54:17.577076 | controller | TASK [osp.edpm.env_data : Validating arguments against arg spec 'main' - The main entry point for the osp.edpm.env_data role.] ***
2025-12-05 00:54:17.592634 | controller | Friday 05 December 2025  00:54:17 +0000 (0:00:00.371)       0:01:29.334 *******
2025-12-05 00:54:17.592659 | controller | ok: [compute-1]
2025-12-05 00:54:18.264979 | controller |
2025-12-05 00:54:18.265016 | controller | TASK [osp.edpm.env_data : Gather all installed packages] ***********************
2025-12-05 00:54:18.265024 | controller | Friday 05 December 2025  00:54:17 +0000 (0:00:00.016)       0:01:29.350 *******
2025-12-05 00:54:18.265035 | controller | ok: [compute-1]
2025-12-05 00:54:19.611379 | controller |
2025-12-05 00:54:19.611409 | controller | TASK [osp.edpm.env_data : Gather repository list] ******************************
2025-12-05 00:54:19.611417 | controller | Friday 05 December 2025  00:54:18 +0000 (0:00:00.671)       0:01:30.022 *******
2025-12-05 00:54:19.611427 | controller | ok: [compute-1]
2025-12-05 00:54:19.649789 | controller |
2025-12-05 00:54:19.649824 | controller | TASK [osp.edpm.env_data : Output installed packages] ***************************
2025-12-05 00:54:19.649833 | controller | Friday 05 December 2025  00:54:19 +0000 (0:00:01.346)       0:01:31.368 *******
2025-12-05 00:54:19.649844 | controller | ok: [compute-1] =>
2025-12-05 00:54:19.649876 | controller |   msg:
2025-12-05 00:54:19.649883 | controller |   - tzdata
2025-12-05 00:54:19.649888 | controller |   - fonts-filesystem
2025-12-05 00:54:19.649893 | controller |   - adobe-source-code-pro-fonts
2025-12-05 00:54:19.649899 | controller |   - dejavu-sans-fonts
2025-12-05 00:54:19.649904 | controller |   - langpacks-core-font-en
2025-12-05 00:54:19.649908 | controller |   - abattis-cantarell-fonts
2025-12-05 00:54:19.649914 | controller |   - geolite2-country
2025-12-05 00:54:19.649921 | controller |   - geolite2-city
2025-12-05 00:54:19.649941 | controller |   - gawk-all-langpacks
2025-12-05 00:54:19.650769 | controller |   - quota-nls
2025-12-05 00:54:19.653781 | controller |   - python3-setuptools-wheel
2025-12-05 00:54:19.653812 | controller |   - publicsuffix-list-dafsa
2025-12-05 00:54:19.653819 | controller |   - pcre2-syntax
2025-12-05 00:54:19.653825 | controller |   - ncurses-base
2025-12-05 00:54:19.653830 | controller |   - libssh-config
2025-12-05 00:54:19.653835 | controller |   - libreport-filesystem
2025-12-05 00:54:19.653840 | controller |   - dnf-data
2025-12-05 00:54:19.653846 | controller |   - kbd-misc
2025-12-05 00:54:19.653850 | controller |   - kbd-legacy
2025-12-05 00:54:19.653860 | controller |   - hwdata
2025-12-05 00:54:19.653893 | controller |   - dhcp-common
2025-12-05 00:54:19.653900 | controller |   - coreutils-common
2025-12-05 00:54:19.653905 | controller |   - centos-gpg-keys
2025-12-05 00:54:19.653916 | controller |   - centos-stream-repos
2025-12-05 00:54:19.653921 | controller |   - centos-stream-release
2025-12-05 00:54:19.653926 | controller |   - setup
2025-12-05 00:54:19.653931 | controller |   - filesystem
2025-12-05 00:54:19.653936 | controller |   - basesystem
2025-12-05 00:54:19.653941 | controller |   - ncurses-libs
2025-12-05 00:54:19.653946 | controller |   - bash
2025-12-05 00:54:19.653951 | controller |   - libgcc
2025-12-05 00:54:19.653956 | controller |   - glibc-gconv-extra
2025-12-05 00:54:19.653961 | controller |   - glibc-langpack-en
2025-12-05 00:54:19.653966 | controller |   - glibc-common
2025-12-05 00:54:19.653971 | controller |   - glibc
2025-12-05 00:54:19.653976 | controller |   - zlib
2025-12-05 00:54:19.653981 | controller |   - popt
2025-12-05 00:54:19.653986 | controller |   - xz-libs
2025-12-05 00:54:19.653991 | controller |   - libcap
2025-12-05 00:54:19.653996 | controller |   - libzstd
2025-12-05 00:54:19.654001 | controller |   - libstdc++
2025-12-05 00:54:19.654006 | controller |   - libuuid
2025-12-05 00:54:19.654011 | controller |   - libxcrypt
2025-12-05 00:54:19.654016 | controller |   - bzip2-libs
2025-12-05 00:54:19.654020 | controller |   - libcom_err
2025-12-05 00:54:19.654026 | controller |   - sqlite-libs
2025-12-05 00:54:19.654030 | controller |   - libxml2
2025-12-05 00:54:19.654035 | controller |   - libcap-ng
2025-12-05 00:54:19.654040 | controller |   - audit-libs
2025-12-05 00:54:19.654045 | controller |   - libmnl
2025-12-05 00:54:19.654050 | controller |   - libtalloc
2025-12-05 00:54:19.654055 | controller |   - elfutils-libelf
2025-12-05 00:54:19.654062 | controller |   - readline
2025-12-05 00:54:19.654088 | controller |   - crypto-policies
2025-12-05 00:54:19.654096 | controller |   - alternatives
2025-12-05 00:54:19.654202 | controller |   - keyutils-libs
2025-12-05 00:54:19.654305 | controller |   - libffi
2025-12-05 00:54:19.654417 | controller |   - libunistring
2025-12-05 00:54:19.654513 | controller |   - lua-libs
2025-12-05 00:54:19.654618 | controller |   - expat
2025-12-05 00:54:19.654713 | controller |   - libgpg-error
2025-12-05 00:54:19.654830 | controller |   - libnl3
2025-12-05 00:54:19.654936 | controller |   - libsepol
2025-12-05 00:54:19.655039 | controller |   - libtdb
2025-12-05 00:54:19.655143 | controller |   - lz4-libs
2025-12-05 00:54:19.655245 | controller |   - libidn2
2025-12-05 00:54:19.655346 | controller |   - libtevent
2025-12-05 00:54:19.655459 | controller |   - gmp
2025-12-05 00:54:19.655564 | controller |   - jansson
2025-12-05 00:54:19.655665 | controller |   - json-c
2025-12-05 00:54:19.655786 | controller |   - libattr
2025-12-05 00:54:19.655891 | controller |   - libacl
2025-12-05 00:54:19.655991 | controller |   - libsmartcols
2025-12-05 00:54:19.656090 | controller |   - libtasn1
2025-12-05 00:54:19.656189 | controller |   - p11-kit
2025-12-05 00:54:19.656288 | controller |   - pcre2
2025-12-05 00:54:19.656398 | controller |   - libselinux
2025-12-05 00:54:19.656499 | controller |   - sed
2025-12-05 00:54:19.656597 | controller |   - findutils
2025-12-05 00:54:19.656695 | controller |   - libsemanage
2025-12-05 00:54:19.656817 | controller |   - shadow-utils
2025-12-05 00:54:19.656923 | controller |   - libgcrypt
2025-12-05 00:54:19.657021 | controller |   - file-libs
2025-12-05 00:54:19.657119 | controller |   - file
2025-12-05 00:54:19.657228 | controller |   - gdbm-libs
2025-12-05 00:54:19.657325 | controller |   - libedit
2025-12-05 00:54:19.657436 | controller |   - libref_array
2025-12-05 00:54:19.657534 | controller |   - libverto
2025-12-05 00:54:19.657632 | controller |   - psmisc
2025-12-05 00:54:19.657749 | controller |   - libselinux-utils
2025-12-05 00:54:19.657861 | controller |   - p11-kit-trust
2025-12-05 00:54:19.657961 | controller |   - libassuan
2025-12-05 00:54:19.658062 | controller |   - keyutils
2025-12-05 00:54:19.658163 | controller |   - libbpf
2025-12-05 00:54:19.658266 | controller |   - iproute
2025-12-05 00:54:19.658377 | controller |   - e2fsprogs-libs
2025-12-05 00:54:19.658488 | controller |   - libicu
2025-12-05 00:54:19.658588 | controller |   - libproxy
2025-12-05 00:54:19.658688 | controller |   - fuse-libs
2025-12-05 00:54:19.658806 | controller |   - libbasicobjects
2025-12-05 00:54:19.658910 | controller |   - libcollection
2025-12-05 00:54:19.659011 | controller |   - libdhash
2025-12-05 00:54:19.659110 | controller |   - libgomp
2025-12-05 00:54:19.659209 | controller |   - libpath_utils
2025-12-05 00:54:19.659308 | controller |   - libini_config
2025-12-05 00:54:19.659416 | controller |   - libseccomp
2025-12-05 00:54:19.659515 | controller |   - libsigsegv
2025-12-05 00:54:19.659620 | controller |   - libsss_idmap
2025-12-05 00:54:19.659729 | controller |   - libyaml
2025-12-05 00:54:19.659836 | controller |   - lzo
2025-12-05 00:54:19.659941 | controller |   - numactl-libs
2025-12-05 00:54:19.660040 | controller |   - pcre
2025-12-05 00:54:19.660138 | controller |   - grep
2025-12-05 00:54:19.660239 | controller |   - openssl-fips-provider
2025-12-05 00:54:19.660339 | controller |   - openssl-libs
2025-12-05 00:54:19.660448 | controller |   - coreutils
2025-12-05 00:54:19.660548 | controller |   - ca-certificates
2025-12-05 00:54:19.660646 | controller |   - systemd-libs
2025-12-05 00:54:19.660763 | controller |   - libblkid
2025-12-05 00:54:19.660870 | controller |   - dbus-libs
2025-12-05 00:54:19.660969 | controller |   - libmount
2025-12-05 00:54:19.661068 | controller |   - kmod
2025-12-05 00:54:19.661167 | controller |   - util-linux-core
2025-12-05 00:54:19.661265 | controller |   - libfdisk
2025-12-05 00:54:19.661370 | controller |   - gzip
2025-12-05 00:54:19.661471 | controller |   - openssl
2025-12-05 00:54:19.661576 | controller |   - kmod-libs
2025-12-05 00:54:19.661676 | controller |   - libevent
2025-12-05 00:54:19.661792 | controller |   - cracklib
2025-12-05 00:54:19.661899 | controller |   - procps-ng
2025-12-05 00:54:19.661998 | controller |   - which
2025-12-05 00:54:19.662097 | controller |   - cracklib-dicts
2025-12-05 00:54:19.662197 | controller |   - avahi-libs
2025-12-05 00:54:19.662297 | controller |   - dbus-tools
2025-12-05 00:54:19.662407 | controller |   - centos-logos
2025-12-05 00:54:19.662511 | controller |   - libarchive
2025-12-05 00:54:19.662611 | controller |   - libsss_certmap
2025-12-05 00:54:19.662710 | controller |   - sscg
2025-12-05 00:54:19.662824 | controller |   - xz
2025-12-05 00:54:19.662931 | controller |   - squashfs-tools
2025-12-05 00:54:19.663031 | controller |   - libutempter
2025-12-05 00:54:19.663129 | controller |   - acl
2025-12-05 00:54:19.663228 | controller |   - gettext-libs
2025-12-05 00:54:19.663326 | controller |   - gettext
2025-12-05 00:54:19.663436 | controller |   - attr
2025-12-05 00:54:19.663534 | controller |   - mpfr
2025-12-05 00:54:19.663639 | controller |   - gawk
2025-12-05 00:54:19.663753 | controller |   - krb5-libs
2025-12-05 00:54:19.663862 | controller |   - libtirpc
2025-12-05 00:54:19.663961 | controller |   - quota
2025-12-05 00:54:19.664061 | controller |   - cyrus-sasl-lib
2025-12-05 00:54:19.664160 | controller |   - libssh
2025-12-05 00:54:19.664261 | controller |   - libpsl
2025-12-05 00:54:19.664368 | controller |   - libibverbs
2025-12-05 00:54:19.664471 | controller |   - libpcap
2025-12-05 00:54:19.664570 | controller |   - libnl3-cli
2025-12-05 00:54:19.664669 | controller |   - libteam
2025-12-05 00:54:19.664784 | controller |   - libksba
2025-12-05 00:54:19.664886 | controller |   - libcomps
2025-12-05 00:54:19.664986 | controller |   - ethtool
2025-12-05 00:54:19.665086 | controller |   - libss
2025-12-05 00:54:19.665190 | controller |   - e2fsprogs
2025-12-05 00:54:19.665292 | controller |   - libxcrypt-compat
2025-12-05 00:54:19.665402 | controller |   - python3-pip-wheel
2025-12-05 00:54:19.665505 | controller |   - python-unversioned-command
2025-12-05 00:54:19.665604 | controller |   - python3
2025-12-05 00:54:19.665711 | controller |   - python3-libs
2025-12-05 00:54:19.665835 | controller |   - python3-setuptools
2025-12-05 00:54:19.665940 | controller |   - python3-six
2025-12-05 00:54:19.666040 | controller |   - python3-libselinux
2025-12-05 00:54:19.666139 | controller |   - python3-pyyaml
2025-12-05 00:54:19.666239 | controller |   - python3-distro
2025-12-05 00:54:19.666339 | controller |   - python3-idna
2025-12-05 00:54:19.666448 | controller |   - python3-systemd
2025-12-05 00:54:19.666548 | controller |   - python3-audit
2025-12-05 00:54:19.666648 | controller |   - python3-libsemanage
2025-12-05 00:54:19.666761 | controller |   - python3-dateutil
2025-12-05 00:54:19.666868 | controller |   - python3-configobj
2025-12-05 00:54:19.666967 | controller |   - python3-setools
2025-12-05 00:54:19.667073 | controller |   - python3-libcomps
2025-12-05 00:54:19.667174 | controller |   - cockpit-bridge
2025-12-05 00:54:19.667274 | controller |   - python3-chardet
2025-12-05 00:54:19.667394 | controller |   - python3-libxml2
2025-12-05 00:54:19.667495 | controller |   - python3-ptyprocess
2025-12-05 00:54:19.667594 | controller |   - python3-pexpect
2025-12-05 00:54:19.667692 | controller |   - python3-pysocks
2025-12-05 00:54:19.667809 | controller |   - python3-urllib3
2025-12-05 00:54:19.667914 | controller |   - python3-requests
2025-12-05 00:54:19.668013 | controller |   - python3-attrs
2025-12-05 00:54:19.668112 | controller |   - python3-file-magic
2025-12-05 00:54:19.668217 | controller |   - sos
2025-12-05 00:54:19.668320 | controller |   - python3-jsonpointer
2025-12-05 00:54:19.668438 | controller |   - python3-jsonpatch
2025-12-05 00:54:19.668539 | controller |   - python3-markupsafe
2025-12-05 00:54:19.668640 | controller |   - python3-netifaces
2025-12-05 00:54:19.668752 | controller |   - python3-oauthlib
2025-12-05 00:54:19.668862 | controller |   - python3-prettytable
2025-12-05 00:54:19.668962 | controller |   - python3-pyrsistent
2025-12-05 00:54:19.669063 | controller |   - python3-jsonschema
2025-12-05 00:54:19.669164 | controller |   - python3-pyserial
2025-12-05 00:54:19.669264 | controller |   - python3-pytz
2025-12-05 00:54:19.669373 | controller |   - python3-babel
2025-12-05 00:54:19.669476 | controller |   - python3-jinja2
2025-12-05 00:54:19.669577 | controller |   - gdisk
2025-12-05 00:54:19.669677 | controller |   - groff-base
2025-12-05 00:54:19.669795 | controller |   - snappy
2025-12-05 00:54:19.669901 | controller |   - pigz
2025-12-05 00:54:19.670005 | controller |   - c-ares
2025-12-05 00:54:19.670106 | controller |   - cpio
2025-12-05 00:54:19.670205 | controller |   - diffutils
2025-12-05 00:54:19.670303 | controller |   - hostname
2025-12-05 00:54:19.670413 | controller |   - inih
2025-12-05 00:54:19.670513 | controller |   - kernel-tools-libs
2025-12-05 00:54:19.670612 | controller |   - less
2025-12-05 00:54:19.670711 | controller |   - libbrotli
2025-12-05 00:54:19.670828 | controller |   - libcbor
2025-12-05 00:54:19.670931 | controller |   - libdaemon
2025-12-05 00:54:19.671029 | controller |   - teamd
2025-12-05 00:54:19.671127 | controller |   - libdb
2025-12-05 00:54:19.671225 | controller |   - libeconf
2025-12-05 00:54:19.671326 | controller |   - libpwquality
2025-12-05 00:54:19.671437 | controller |   - pam
2025-12-05 00:54:19.671537 | controller |   - util-linux
2025-12-05 00:54:19.671635 | controller |   - grub2-common
2025-12-05 00:54:19.671753 | controller |   - openssh
2025-12-05 00:54:19.671870 | controller |   - grub2-pc-modules
2025-12-05 00:54:19.671972 | controller |   - kbd
2025-12-05 00:54:19.672072 | controller |   - libev
2025-12-05 00:54:19.672177 | controller |   - libverto-libev
2025-12-05 00:54:19.672278 | controller |   - libndp
2025-12-05 00:54:19.672389 | controller |   - libnfnetlink
2025-12-05 00:54:19.672490 | controller |   - libnetfilter_conntrack
2025-12-05 00:54:19.672589 | controller |   - iptables-libs
2025-12-05 00:54:19.672688 | controller |   - libnghttp2
2025-12-05 00:54:19.672803 | controller |   - libpipeline
2025-12-05 00:54:19.672909 | controller |   - libsss_nss_idmap
2025-12-05 00:54:19.673008 | controller |   - sssd-client
2025-12-05 00:54:19.673108 | controller |   - libsss_sudo
2025-12-05 00:54:19.673208 | controller |   - libtool-ltdl
2025-12-05 00:54:19.673306 | controller |   - openldap
2025-12-05 00:54:19.673424 | controller |   - libcurl
2025-12-05 00:54:19.673526 | controller |   - tpm2-tss
2025-12-05 00:54:19.673624 | controller |   - libnfsidmap
2025-12-05 00:54:19.673731 | controller |   - sssd-nfs-idmap
2025-12-05 00:54:19.673847 | controller |   - ima-evm-utils
2025-12-05 00:54:19.673954 | controller |   - curl
2025-12-05 00:54:19.674055 | controller |   - rpm
2025-12-05 00:54:19.674155 | controller |   - rpm-libs
2025-12-05 00:54:19.674255 | controller |   - policycoreutils
2025-12-05 00:54:19.674367 | controller |   - selinux-policy
2025-12-05 00:54:19.674469 | controller |   - selinux-policy-targeted
2025-12-05 00:54:19.674567 | controller |   - libsolv
2025-12-05 00:54:19.674666 | controller |   - cockpit-ws-selinux
2025-12-05 00:54:19.674790 | controller |   - rpm-plugin-systemd-inhibit
2025-12-05 00:54:19.674894 | controller |   - sudo
2025-12-05 00:54:19.674992 | controller |   - lmdb-libs
2025-12-05 00:54:19.675090 | controller |   - nettle
2025-12-05 00:54:19.675188 | controller |   - gnutls
2025-12-05 00:54:19.675287 | controller |   - glib2
2025-12-05 00:54:19.675403 | controller |   - python3-dbus
2025-12-05 00:54:19.675505 | controller |   - NetworkManager-libnm
2025-12-05 00:54:19.675606 | controller |   - libmodulemd
2025-12-05 00:54:19.677929 | controller |   - polkit-libs
2025-12-05 00:54:19.678066 | controller |   - gobject-introspection
2025-12-05 00:54:19.678182 | controller |   - python3-gobject-base-noarch
2025-12-05 00:54:19.678297 | controller |   - python3-gobject-base
2025-12-05 00:54:19.678416 | controller |   - python3-dasbus
2025-12-05 00:54:19.678513 | controller |   - gsettings-desktop-schemas
2025-12-05 00:54:19.678615 | controller |   - json-glib
2025-12-05 00:54:19.678715 | controller |   - libuser
2025-12-05 00:54:19.678835 | controller |   - webkit2gtk3-jsc
2025-12-05 00:54:19.678941 | controller |   - libproxy-webkitgtk4
2025-12-05 00:54:19.679039 | controller |   - glib-networking
2025-12-05 00:54:19.679138 | controller |   - npth
2025-12-05 00:54:19.679236 | controller |   - gnupg2
2025-12-05 00:54:19.679330 | controller |   - gpgme
2025-12-05 00:54:19.679449 | controller |   - librepo
2025-12-05 00:54:19.679543 | controller |   - libdnf
2025-12-05 00:54:19.679649 | controller |   - python3-libdnf
2025-12-05 00:54:19.679780 | controller |   - python3-hawkey
2025-12-05 00:54:19.679890 | controller |   - python3-gpg
2025-12-05 00:54:19.679992 | controller |   - rpm-sign-libs
2025-12-05 00:54:19.680094 | controller |   - oniguruma
2025-12-05 00:54:19.680194 | controller |   - jq
2025-12-05 00:54:19.680296 | controller |   - pciutils-libs
2025-12-05 00:54:19.680407 | controller |   - sg3_utils-libs
2025-12-05 00:54:19.680508 | controller |   - slang
2025-12-05 00:54:19.680608 | controller |   - newt
2025-12-05 00:54:19.680708 | controller |   - userspace-rcu
2025-12-05 00:54:19.680829 | controller |   - checkpolicy
2025-12-05 00:54:19.680936 | controller |   - python3-policycoreutils
2025-12-05 00:54:19.681040 | controller |   - policycoreutils-python-utils
2025-12-05 00:54:19.681140 | controller |   - libestr
2025-12-05 00:54:19.681239 | controller |   - libfastjson
2025-12-05 00:54:19.681342 | controller |   - libmaxminddb
2025-12-05 00:54:19.681454 | controller |   - ipcalc
2025-12-05 00:54:19.681557 | controller |   - liburing
2025-12-05 00:54:19.681665 | controller |   - langpacks-core-en_GB
2025-12-05 00:54:19.681783 | controller |   - systemd-rpm-macros
2025-12-05 00:54:19.681893 | controller |   - dbus
2025-12-05 00:54:19.681994 | controller |   - systemd-pam
2025-12-05 00:54:19.682093 | controller |   - systemd
2025-12-05 00:54:19.682191 | controller |   - dbus-common
2025-12-05 00:54:19.682290 | controller |   - dbus-broker
2025-12-05 00:54:19.682398 | controller |   - iputils
2025-12-05 00:54:19.682498 | controller |   - dhcp-client
2025-12-05 00:54:19.682598 | controller |   - cronie-anacron
2025-12-05 00:54:19.682696 | controller |   - cronie
2025-12-05 00:54:19.682817 | controller |   - crontabs
2025-12-05 00:54:19.682922 | controller |   - initscripts-service
2025-12-05 00:54:19.683020 | controller |   - polkit
2025-12-05 00:54:19.683119 | controller |   - polkit-pkla-compat
2025-12-05 00:54:19.683217 | controller |   - samba-common
2025-12-05 00:54:19.683315 | controller |   - libldb
2025-12-05 00:54:19.683425 | controller |   - libwbclient
2025-12-05 00:54:19.683541 | controller |   - samba-client-libs
2025-12-05 00:54:19.683653 | controller |   - samba-common-libs
2025-12-05 00:54:19.683776 | controller |   - sssd-common
2025-12-05 00:54:19.683884 | controller |   - audit
2025-12-05 00:54:19.683985 | controller |   - authselect-libs
2025-12-05 00:54:19.684084 | controller |   - device-mapper-libs
2025-12-05 00:54:19.684183 | controller |   - device-mapper
2025-12-05 00:54:19.684290 | controller |   - grub2-tools-minimal
2025-12-05 00:54:19.684404 | controller |   - cryptsetup-libs
2025-12-05 00:54:19.684503 | controller |   - systemd-udev
2025-12-05 00:54:19.684607 | controller |   - NetworkManager
2025-12-05 00:54:19.684708 | controller |   - NetworkManager-team
2025-12-05 00:54:19.684835 | controller |   - libfido2
2025-12-05 00:54:19.684940 | controller |   - os-prober
2025-12-05 00:54:19.685039 | controller |   - kpartx
2025-12-05 00:54:19.685137 | controller |   - xfsprogs
2025-12-05 00:54:19.685258 | controller |   - elfutils-default-yama-scope
2025-12-05 00:54:19.685362 | controller |   - elfutils-libs
2025-12-05 00:54:19.685466 | controller |   - elfutils-debuginfod-client
2025-12-05 00:54:19.685567 | controller |   - binutils-gold
2025-12-05 00:54:19.685667 | controller |   - binutils
2025-12-05 00:54:19.685802 | controller |   - rpm-build-libs
2025-12-05 00:54:19.685909 | controller |   - python3-rpm
2025-12-05 00:54:19.686009 | controller |   - python3-dnf
2025-12-05 00:54:19.686107 | controller |   - dnf
2025-12-05 00:54:19.686207 | controller |   - setroubleshoot-plugins
2025-12-05 00:54:19.686306 | controller |   - setroubleshoot-server
2025-12-05 00:54:19.686416 | controller |   - python3-dnf-plugins-core
2025-12-05 00:54:19.686515 | controller |   - dnf-plugins-core
2025-12-05 00:54:19.686614 | controller |   - gssproxy
2025-12-05 00:54:19.686712 | controller |   - libkcapi
2025-12-05 00:54:19.686846 | controller |   - libkcapi-hmaccalc
2025-12-05 00:54:19.686951 | controller |   - dracut
2025-12-05 00:54:19.687051 | controller |   - kernel-modules-core
2025-12-05 00:54:19.687150 | controller |   - kernel-core
2025-12-05 00:54:19.687250 | controller |   - grub2-tools
2025-12-05 00:54:19.687349 | controller |   - grubby
2025-12-05 00:54:19.687459 | controller |   - kernel-modules
2025-12-05 00:54:19.687557 | controller |   - dracut-network
2025-12-05 00:54:19.687655 | controller |   - dracut-squash
2025-12-05 00:54:19.687770 | controller |   - kexec-tools
2025-12-05 00:54:19.687876 | controller |   - logrotate
2025-12-05 00:54:19.687975 | controller |   - rsyslog-logrotate
2025-12-05 00:54:19.688073 | controller |   - rsyslog
2025-12-05 00:54:19.688171 | controller |   - rpcbind
2025-12-05 00:54:19.688275 | controller |   - oddjob
2025-12-05 00:54:19.688384 | controller |   - oddjob-mkhomedir
2025-12-05 00:54:19.688484 | controller |   - authselect
2025-12-05 00:54:19.688587 | controller |   - authselect-compat
2025-12-05 00:54:19.688687 | controller |   - nfs-utils
2025-12-05 00:54:19.688815 | controller |   - cockpit-system
2025-12-05 00:54:19.688967 | controller |   - kernel
2025-12-05 00:54:19.689070 | controller |   - crypto-policies-scripts
2025-12-05 00:54:19.689169 | controller |   - grub2-pc
2025-12-05 00:54:19.689268 | controller |   - dracut-config-generic
2025-12-05 00:54:19.689381 | controller |   - yum-utils
2025-12-05 00:54:19.689482 | controller |   - yum
2025-12-05 00:54:19.689581 | controller |   - cloud-init
2025-12-05 00:54:19.689679 | controller |   - openssh-clients
2025-12-05 00:54:19.689796 | controller |   - NetworkManager-tui
2025-12-05 00:54:19.689903 | controller |   - parted
2025-12-05 00:54:19.690001 | controller |   - sssd-kcm
2025-12-05 00:54:19.690099 | controller |   - chrony
2025-12-05 00:54:19.690199 | controller |   - microcode_ctl
2025-12-05 00:54:19.690301 | controller |   - openssh-server
2025-12-05 00:54:19.690412 | controller |   - qemu-guest-agent
2025-12-05 00:54:19.690512 | controller |   - langpacks-en_GB
2025-12-05 00:54:19.690610 | controller |   - sg3_utils
2025-12-05 00:54:19.690709 | controller |   - kernel-tools
2025-12-05 00:54:19.690824 | controller |   - cockpit-ws
2025-12-05 00:54:19.690926 | controller |   - passwd
2025-12-05 00:54:19.691024 | controller |   - initscripts-rename-device
2025-12-05 00:54:19.691124 | controller |   - irqbalance
2025-12-05 00:54:19.691224 | controller |   - rpm-plugin-selinux
2025-12-05 00:54:19.691322 | controller |   - rpm-plugin-audit
2025-12-05 00:54:19.691436 | controller |   - man-db
2025-12-05 00:54:19.691534 | controller |   - iproute-tc
2025-12-05 00:54:19.691634 | controller |   - cloud-utils-growpart
2025-12-05 00:54:19.691751 | controller |   - tcpdump
2025-12-05 00:54:19.691864 | controller |   - prefixdevname
2025-12-05 00:54:19.691964 | controller |   - rsync
2025-12-05 00:54:19.692062 | controller |   - tar
2025-12-05 00:54:19.692160 | controller |   - vim-minimal
2025-12-05 00:54:19.692258 | controller |   - lshw
2025-12-05 00:54:19.692372 | controller |   - libsysfs
2025-12-05 00:54:19.692478 | controller |   - lsscsi
2025-12-05 00:54:19.692577 | controller |   - ncurses
2025-12-05 00:54:19.692676 | controller |   - rootfiles
2025-12-05 00:54:19.692799 | controller |   - gpg-pubkey
2025-12-05 00:54:19.692904 | controller |   - git-core
2025-12-05 00:54:19.693002 | controller |   - git-core-doc
2025-12-05 00:54:19.693102 | controller |   - perl-Digest
2025-12-05 00:54:19.693202 | controller |   - perl-Digest-MD5
2025-12-05 00:54:19.693299 | controller |   - perl-B
2025-12-05 00:54:19.693408 | controller |   - perl-FileHandle
2025-12-05 00:54:19.693507 | controller |   - perl-Data-Dumper
2025-12-05 00:54:19.693612 | controller |   - perl-libnet
2025-12-05 00:54:19.693712 | controller |   - perl-base
2025-12-05 00:54:19.693840 | controller |   - perl-URI
2025-12-05 00:54:19.693954 | controller |   - perl-AutoLoader
2025-12-05 00:54:19.694055 | controller |   - perl-Mozilla-CA
2025-12-05 00:54:19.694154 | controller |   - perl-if
2025-12-05 00:54:19.694259 | controller |   - perl-IO-Socket-IP
2025-12-05 00:54:19.694368 | controller |   - perl-Time-Local
2025-12-05 00:54:19.694474 | controller |   - perl-File-Path
2025-12-05 00:54:19.694572 | controller |   - perl-Pod-Escapes
2025-12-05 00:54:19.694671 | controller |   - perl-Text-Tabs+Wrap
2025-12-05 00:54:19.694788 | controller |   - perl-IO-Socket-SSL
2025-12-05 00:54:19.694895 | controller |   - perl-Net-SSLeay
2025-12-05 00:54:19.694995 | controller |   - perl-Class-Struct
2025-12-05 00:54:19.695094 | controller |   - perl-POSIX
2025-12-05 00:54:19.695192 | controller |   - perl-Term-ANSIColor
2025-12-05 00:54:19.695291 | controller |   - perl-IPC-Open3
2025-12-05 00:54:19.695403 | controller |   - perl-subs
2025-12-05 00:54:19.695502 | controller |   - perl-File-Temp
2025-12-05 00:54:19.695607 | controller |   - perl-Term-Cap
2025-12-05 00:54:19.695707 | controller |   - perl-Pod-Simple
2025-12-05 00:54:19.695823 | controller |   - perl-HTTP-Tiny
2025-12-05 00:54:19.695927 | controller |   - perl-Socket
2025-12-05 00:54:19.696027 | controller |   - perl-SelectSaver
2025-12-05 00:54:19.696124 | controller |   - perl-Symbol
2025-12-05 00:54:19.696222 | controller |   - perl-File-stat
2025-12-05 00:54:19.696318 | controller |   - perl-podlators
2025-12-05 00:54:19.696428 | controller |   - perl-Pod-Perldoc
2025-12-05 00:54:19.696527 | controller |   - perl-Fcntl
2025-12-05 00:54:19.696624 | controller |   - perl-Text-ParseWords
2025-12-05 00:54:19.696731 | controller |   - perl-mro
2025-12-05 00:54:19.696841 | controller |   - perl-IO
2025-12-05 00:54:19.696945 | controller |   - perl-overloading
2025-12-05 00:54:19.697044 | controller |   - perl-Pod-Usage
2025-12-05 00:54:19.697142 | controller |   - perl-Errno
2025-12-05 00:54:19.697245 | controller |   - perl-File-Basename
2025-12-05 00:54:19.697344 | controller |   - perl-Getopt-Std
2025-12-05 00:54:19.697621 | controller |   - perl-MIME-Base64
2025-12-05 00:54:19.697741 | controller |   - perl-Scalar-List-Utils
2025-12-05 00:54:19.697857 | controller |   - perl-constant
2025-12-05 00:54:19.697965 | controller |   - perl-Storable
2025-12-05 00:54:19.698064 | controller |   - perl-overload
2025-12-05 00:54:19.698157 | controller |   - perl-parent
2025-12-05 00:54:19.698258 | controller |   - perl-vars
2025-12-05 00:54:19.698368 | controller |   - perl-Getopt-Long
2025-12-05 00:54:19.698466 | controller |   - perl-Carp
2025-12-05 00:54:19.698564 | controller |   - perl-Exporter
2025-12-05 00:54:19.698661 | controller |   - perl-NDBM_File
2025-12-05 00:54:19.698778 | controller |   - perl-PathTools
2025-12-05 00:54:19.698883 | controller |   - perl-Encode
2025-12-05 00:54:19.699004 | controller |   - perl-libs
2025-12-05 00:54:19.699093 | controller |   - perl-interpreter
2025-12-05 00:54:19.699190 | controller |   - perl-DynaLoader
2025-12-05 00:54:19.699288 | controller |   - perl-TermReadKey
2025-12-05 00:54:19.699398 | controller |   - perl-Error
2025-12-05 00:54:19.699496 | controller |   - perl-File-Find
2025-12-05 00:54:19.699593 | controller |   - perl-lib
2025-12-05 00:54:19.699692 | controller |   - emacs-filesystem
2025-12-05 00:54:19.699806 | controller |   - perl-Git
2025-12-05 00:54:19.699913 | controller |   - git
2025-12-05 00:54:19.700011 | controller |   - traceroute
2025-12-05 00:54:19.700109 | controller |   - ruby-libs
2025-12-05 00:54:19.700208 | controller |   - rubygem-bigdecimal
2025-12-05 00:54:19.700307 | controller |   - ruby-default-gems
2025-12-05 00:54:19.700418 | controller |   - rubygem-bundler
2025-12-05 00:54:19.700522 | controller |   - rubygem-io-console
2025-12-05 00:54:19.700624 | controller |   - rubygem-json
2025-12-05 00:54:19.700733 | controller |   - rubygem-psych
2025-12-05 00:54:19.700850 | controller |   - rubygem-rdoc
2025-12-05 00:54:19.700954 | controller |   - rubygems
2025-12-05 00:54:19.701051 | controller |   - ruby
2025-12-05 00:54:19.701149 | controller |   - libmpc
2025-12-05 00:54:19.701247 | controller |   - gdb-minimal
2025-12-05 00:54:19.701344 | controller |   - dwz
2025-12-05 00:54:19.701456 | controller |   - unzip
2025-12-05 00:54:19.701556 | controller |   - elfutils
2025-12-05 00:54:19.701655 | controller |   - bzip2
2025-12-05 00:54:19.701777 | controller |   - debugedit
2025-12-05 00:54:19.701889 | controller |   - zip
2025-12-05 00:54:19.701989 | controller |   - cpp
2025-12-05 00:54:19.702088 | controller |   - rust-srpm-macros
2025-12-05 00:54:19.702186 | controller |   - qt5-srpm-macros
2025-12-05 00:54:19.702285 | controller |   - python3-pip
2025-12-05 00:54:19.702394 | controller |   - perl-srpm-macros
2025-12-05 00:54:19.702500 | controller |   - openblas-srpm-macros
2025-12-05 00:54:19.702600 | controller |   - ocaml-srpm-macros
2025-12-05 00:54:19.702699 | controller |   - ncurses-c++-libs
2025-12-05 00:54:19.702814 | controller |   - lua-srpm-macros
2025-12-05 00:54:19.702917 | controller |   - llvm-filesystem
2025-12-05 00:54:19.703015 | controller |   - llvm-libs
2025-12-05 00:54:19.703113 | controller |   - libxslt
2025-12-05 00:54:19.703212 | controller |   - libstemmer
2025-12-05 00:54:19.703310 | controller |   - libstdc++-devel
2025-12-05 00:54:19.703421 | controller |   - libsoup
2025-12-05 00:54:19.703520 | controller |   - libjpeg-turbo
2025-12-05 00:54:19.703621 | controller |   - kernel-srpm-macros
2025-12-05 00:54:19.703728 | controller |   - kernel-headers
2025-12-05 00:54:19.703834 | controller |   - hunspell-filesystem
2025-12-05 00:54:19.703941 | controller |   - hunspell-en-US
2025-12-05 00:54:19.704040 | controller |   - hunspell
2025-12-05 00:54:19.704140 | controller |   - enchant
2025-12-05 00:54:19.704237 | controller |   - python3-enchant
2025-12-05 00:54:19.704336 | controller |   - glibc-headers
2025-12-05 00:54:19.704447 | controller |   - ghc-srpm-macros
2025-12-05 00:54:19.704545 | controller |   - efi-srpm-macros
2025-12-05 00:54:19.704643 | controller |   - desktop-file-utils
2025-12-05 00:54:19.704756 | controller |   - createrepo_c-libs
2025-12-05 00:54:19.704862 | controller |   - cmake-filesystem
2025-12-05 00:54:19.704962 | controller |   - zstd
2025-12-05 00:54:19.705059 | controller |   - tcl
2025-12-05 00:54:19.705157 | controller |   - shared-mime-info
2025-12-05 00:54:19.705256 | controller |   - python3-pyparsing
2025-12-05 00:54:19.705362 | controller |   - python3-packaging
2025-12-05 00:54:19.705464 | controller |   - pkgconf-m4
2025-12-05 00:54:19.705568 | controller |   - make
2025-12-05 00:54:19.705666 | controller |   - libpng
2025-12-05 00:54:19.705780 | controller |   - gdk-pixbuf2
2025-12-05 00:54:19.705886 | controller |   - libappstream-glib
2025-12-05 00:54:19.705984 | controller |   - libpkgconf
2025-12-05 00:54:19.706081 | controller |   - pkgconf
2025-12-05 00:54:19.706178 | controller |   - pkgconf-pkg-config
2025-12-05 00:54:19.706274 | controller |   - libgpg-error-devel
2025-12-05 00:54:19.706382 | controller |   - glibc-devel
2025-12-05 00:54:19.706482 | controller |   - libxcrypt-devel
2025-12-05 00:54:19.706580 | controller |   - gcc
2025-12-05 00:54:19.706676 | controller |   - annobin
2025-12-05 00:54:19.706797 | controller |   - gcc-plugin-annobin
2025-12-05 00:54:19.706900 | controller |   - ncurses-devel
2025-12-05 00:54:19.706997 | controller |   - xz-devel
2025-12-05 00:54:19.707094 | controller |   - zlib-devel
2025-12-05 00:54:19.707192 | controller |   - libxml2-devel
2025-12-05 00:54:19.707288 | controller |   - libnftnl
2025-12-05 00:54:19.707406 | controller |   - iptables-nft
2025-12-05 00:54:19.707509 | controller |   - info
2025-12-05 00:54:19.707612 | controller |   - ed
2025-12-05 00:54:19.707713 | controller |   - patch
2025-12-05 00:54:19.707842 | controller |   - fonts-srpm-macros
2025-12-05 00:54:19.707951 | controller |   - go-srpm-macros
2025-12-05 00:54:19.708052 | controller |   - python-srpm-macros
2025-12-05 00:54:19.708151 | controller |   - redhat-rpm-config
2025-12-05 00:54:19.708249 | controller |   - rpm-build
2025-12-05 00:54:19.708347 | controller |   - pyproject-srpm-macros
2025-12-05 00:54:19.708462 | controller |   - python-rpm-macros
2025-12-05 00:54:19.708560 | controller |   - python3-rpm-macros
2025-12-05 00:54:19.708658 | controller |   - python3-rpm-generators
2025-12-05 00:54:19.708779 | controller |   - cyrus-sasl
2025-12-05 00:54:19.708890 | controller |   - cyrus-sasl-devel
2025-12-05 00:54:19.708990 | controller |   - openldap-devel
2025-12-05 00:54:19.709088 | controller |   - python3-devel
2025-12-05 00:54:19.709186 | controller |   - ruby-devel
2025-12-05 00:54:19.709285 | controller |   - iptables-nft-services
2025-12-05 00:54:19.709393 | controller |   - libxslt-devel
2025-12-05 00:54:19.709491 | controller |   - readline-devel
2025-12-05 00:54:19.709589 | controller |   - gcc-c++
2025-12-05 00:54:19.709686 | controller |   - libffi-devel
2025-12-05 00:54:19.709800 | controller |   - openssl-devel
2025-12-05 00:54:19.709905 | controller |   - rpmlint
2025-12-05 00:54:19.710008 | controller |   - expect
2025-12-05 00:54:19.710108 | controller |   - createrepo_c
2025-12-05 00:54:19.710206 | controller |   - hunspell-en-GB
2025-12-05 00:54:19.710304 | controller |   - wget
2025-12-05 00:54:19.710418 | controller |   - systemd-devel
2025-12-05 00:54:19.710517 | controller |   - time
2025-12-05 00:54:19.710615 | controller |   - rpm-sign
2025-12-05 00:54:19.710713 | controller |   - passt
2025-12-05 00:54:19.710836 | controller |   - passt-selinux
2025-12-05 00:54:19.710948 | controller |   - fuse3-libs
2025-12-05 00:54:19.711053 | controller |   - container-selinux
2025-12-05 00:54:19.711158 | controller |   - protobuf-c
2025-12-05 00:54:19.711262 | controller |   - yajl
2025-12-05 00:54:19.711372 | controller |   - libslirp
2025-12-05 00:54:19.711486 | controller |   - slirp4netns
2025-12-05 00:54:19.711591 | controller |   - libnet
2025-12-05 00:54:19.711695 | controller |   - criu
2025-12-05 00:54:19.711824 | controller |   - criu-libs
2025-12-05 00:54:19.711935 | controller |   - crun
2025-12-05 00:54:19.712041 | controller |   - conmon
2025-12-05 00:54:19.712148 | controller |   - aardvark-dns
2025-12-05 00:54:19.712254 | controller |   - netavark
2025-12-05 00:54:19.712377 | controller |   - shadow-utils-subid
2025-12-05 00:54:19.712478 | controller |   - nftables
2025-12-05 00:54:19.712576 | controller |   - fuse-common
2025-12-05 00:54:19.712672 | controller |   - fuse3
2025-12-05 00:54:19.712799 | controller |   - fuse-overlayfs
2025-12-05 00:54:19.712900 | controller |   - containers-common
2025-12-05 00:54:19.712998 | controller |   - podman
2025-12-05 00:54:19.713094 | controller |   - cyrus-sasl-gssapi
2025-12-05 00:54:19.713192 | controller |   - libvirt-libs
2025-12-05 00:54:19.713289 | controller |   - python3-libvirt
2025-12-05 00:54:19.713397 | controller |   - python3-netaddr
2025-12-05 00:54:19.713495 | controller |   - python3-lxml
2025-12-05 00:54:19.713591 | controller |   - python3-jmespath
2025-12-05 00:54:19.713689 | controller |   - python3-pbr
2025-12-05 00:54:19.713819 | controller |   - python3-typing-extensions
2025-12-05 00:54:19.713926 | controller |   - python3-os-service-types
2025-12-05 00:54:19.714025 | controller |   - python3-stevedore
2025-12-05 00:54:19.714130 | controller |   - python3-iso8601
2025-12-05 00:54:19.714229 | controller |   - python3-decorator
2025-12-05 00:54:19.714327 | controller |   - python3-keystoneauth1
2025-12-05 00:54:19.714436 | controller |   - python3-platformdirs
2025-12-05 00:54:19.714535 | controller |   - python3-psutil
2025-12-05 00:54:19.714631 | controller |   - python3-mako
2025-12-05 00:54:19.714751 | controller |   - python3-dogpile-cache
2025-12-05 00:54:19.714863 | controller |   - python3-ply
2025-12-05 00:54:19.714962 | controller |   - python3-pycparser
2025-12-05 00:54:19.715060 | controller |   - python3-cffi
2025-12-05 00:54:19.715159 | controller |   - python3-cryptography
2025-12-05 00:54:19.715257 | controller |   - python3-requestsexceptions
2025-12-05 00:54:19.715363 | controller |   - python3-openstacksdk
2025-12-05 00:54:19.715592 | controller |
2025-12-05 00:54:19.715705 | controller | TASK [osp.edpm.env_data : Output installed repositories] ***********************
2025-12-05 00:54:19.715838 | controller | Friday 05 December 2025  00:54:19 +0000 (0:00:00.054)       0:01:31.423 *******
2025-12-05 00:54:19.715950 | controller | ok: [compute-1] =>
2025-12-05 00:54:19.716051 | controller |   msg: |-
2025-12-05 00:54:19.716145 | controller |     #### REPOSITORIES
2025-12-05 00:54:19.716245 | controller |     repo id                       repo name
2025-12-05 00:54:19.716345 | controller |     appstream                     CentOS Stream 9 - AppStream
2025-12-05 00:54:19.716470 | controller |     baseos                        CentOS Stream 9 - BaseOS
2025-12-05 00:54:19.716565 | controller |     crb                           CentOS Stream 9 - CRB
2025-12-05 00:54:19.716669 | controller |     extras-common                 CentOS Stream 9 - Extras packages
2025-12-05 00:54:19.716779 | controller |
2025-12-05 00:54:19.716887 | controller | TASK [Enable package repos] ****************************************************
2025-12-05 00:54:19.716990 | controller | Friday 05 December 2025  00:54:19 +0000 (0:00:00.041)       0:01:31.465 *******
2025-12-05 00:54:27.604919 | controller | changed: [compute-1]
2025-12-05 00:56:21.477876 | controller |
2025-12-05 00:56:21.477909 | controller | TASK [Install openstack-selinux] ***********************************************
2025-12-05 00:56:21.477918 | controller | Friday 05 December 2025  00:54:27 +0000 (0:00:07.896)       0:01:39.362 *******
2025-12-05 00:56:21.477928 | controller | changed: [compute-1]
2025-12-05 00:56:21.681159 | controller |
2025-12-05 00:56:21.681181 | controller | TASK [Create config-data telemetry directory] **********************************
2025-12-05 00:56:21.681194 | controller | Friday 05 December 2025  00:56:21 +0000 (0:01:53.873)       0:03:33.235 *******
2025-12-05 00:56:21.681203 | controller | changed: [compute-1]
2025-12-05 00:56:21.882797 | controller |
2025-12-05 00:56:21.882830 | controller | TASK [Create /run/libvirt directory] *******************************************
2025-12-05 00:56:21.882838 | controller | Friday 05 December 2025  00:56:21 +0000 (0:00:00.203)       0:03:33.439 *******
2025-12-05 00:56:21.882848 | controller | changed: [compute-1]
2025-12-05 00:56:22.099427 | controller |
2025-12-05 00:56:22.099458 | controller | TASK [Create libvirt user] *****************************************************
2025-12-05 00:56:22.099466 | controller | Friday 05 December 2025  00:56:21 +0000 (0:00:00.201)       0:03:33.640 *******
2025-12-05 00:56:22.099476 | controller | changed: [compute-1]
2025-12-05 00:56:22.291804 | controller |
2025-12-05 00:56:22.291836 | controller | TASK [Create firewall directory] ***********************************************
2025-12-05 00:56:22.291844 | controller | Friday 05 December 2025  00:56:22 +0000 (0:00:00.216)       0:03:33.857 *******
2025-12-05 00:56:22.291855 | controller | changed: [compute-1]
2025-12-05 00:56:22.632539 | controller |
2025-12-05 00:56:22.632573 | controller | TASK [open port 22 (edpm_nftables will active this later)] *********************
2025-12-05 00:56:22.632580 | controller | Friday 05 December 2025  00:56:22 +0000 (0:00:00.192)       0:03:34.049 *******
2025-12-05 00:56:22.632591 | controller | changed: [compute-1]
2025-12-05 00:56:22.981385 | controller |
2025-12-05 00:56:22.981427 | controller | TASK [Create ceilometer.conf] **************************************************
2025-12-05 00:56:22.981438 | controller | Friday 05 December 2025  00:56:22 +0000 (0:00:00.340)       0:03:34.390 *******
2025-12-05 00:56:22.981450 | controller | changed: [compute-1]
2025-12-05 00:56:23.319649 | controller |
2025-12-05 00:56:23.319671 | controller | TASK [Create polling.yaml] *****************************************************
2025-12-05 00:56:23.319679 | controller | Friday 05 December 2025  00:56:22 +0000 (0:00:00.348)       0:03:34.739 *******
2025-12-05 00:56:23.319688 | controller | changed: [compute-1]
2025-12-05 00:56:24.419668 | controller |
2025-12-05 00:56:24.419696 | controller | TASK [Install crypto dependency] ***********************************************
2025-12-05 00:56:24.419704 | controller | Friday 05 December 2025  00:56:23 +0000 (0:00:00.338)       0:03:35.077 *******
2025-12-05 00:56:24.419739 | controller | ok: [compute-1]
2025-12-05 00:56:24.621268 | controller |
2025-12-05 00:56:24.621289 | controller | TASK [Create certs directory] **************************************************
2025-12-05 00:56:24.621297 | controller | Friday 05 December 2025  00:56:24 +0000 (0:00:01.099)       0:03:36.177 *******
2025-12-05 00:56:24.621306 | controller | changed: [compute-1]
2025-12-05 00:56:25.781278 | controller |
2025-12-05 00:56:25.781309 | controller | TASK [Generate an OpenSSL private key with the default values (4096 bits, RSA)] ***
2025-12-05 00:56:25.781317 | controller | Friday 05 December 2025  00:56:24 +0000 (0:00:00.201)       0:03:36.379 *******
2025-12-05 00:56:25.781327 | controller | changed: [compute-1]
2025-12-05 00:56:26.602548 | controller |
2025-12-05 00:56:26.602575 | controller | TASK [Create simple self-signed certificate] ***********************************
2025-12-05 00:56:26.602583 | controller | Friday 05 December 2025  00:56:25 +0000 (0:00:01.159)       0:03:37.538 *******
2025-12-05 00:56:26.602593 | controller | changed: [compute-1]
2025-12-05 00:56:26.663346 | controller |
2025-12-05 00:56:26.663379 | controller | PLAY RECAP *********************************************************************
2025-12-05 00:56:26.663388 | controller | compute-1                  : ok=38   changed=20   unreachable=0    failed=0    skipped=1    rescued=0    ignored=1
2025-12-05 00:56:26.663394 | controller |
2025-12-05 00:56:26.663410 | controller | Friday 05 December 2025  00:56:26 +0000 (0:00:00.818)       0:03:38.357 *******
2025-12-05 00:56:26.663416 | controller | ===============================================================================
2025-12-05 00:56:26.663421 | controller | Install openstack-selinux --------------------------------------------- 113.87s
2025-12-05 00:56:26.663426 | controller | ../../../../molecule/common/test_deps : Install edpm packages ---------- 67.72s
2025-12-05 00:56:26.663431 | controller | ../../../../molecule/common/test_deps : Install repo-setup pre-requirements --- 9.26s
2025-12-05 00:56:26.663437 | controller | Enable package repos ---------------------------------------------------- 7.90s
2025-12-05 00:56:26.663446 | controller | ../../../../molecule/common/test_deps : Install repo-setup -------------- 3.20s
2025-12-05 00:56:26.663452 | controller | ../../../../molecule/common/test_deps : Install selinux python libs ----- 1.38s
2025-12-05 00:56:26.663457 | controller | ../../../../molecule/common/test_deps : Install python yaml libs -------- 1.37s
2025-12-05 00:56:26.663462 | controller | ../../../../molecule/common/test_deps : Install extra packages ---------- 1.35s
2025-12-05 00:56:26.663467 | controller | osp.edpm.env_data : Gather repository list ------------------------------ 1.35s
2025-12-05 00:56:26.663472 | controller | Generate an OpenSSL private key with the default values (4096 bits, RSA) --- 1.16s
2025-12-05 00:56:26.663477 | controller | Install crypto dependency ----------------------------------------------- 1.10s
2025-12-05 00:56:26.663482 | controller | ../../../../molecule/common/test_deps : Get repo-setup repository ------- 1.03s
2025-12-05 00:56:26.663487 | controller | Create simple self-signed certificate ----------------------------------- 0.82s
2025-12-05 00:56:26.663492 | controller | ../../../../molecule/common/test_deps : Create repos -------------------- 0.77s
2025-12-05 00:56:26.663497 | controller | osp.edpm.env_data : Gather all installed packages ----------------------- 0.67s
2025-12-05 00:56:26.663502 | controller | ../../../../molecule/common/test_deps : Fetch latest repo version ------- 0.51s
2025-12-05 00:56:26.663507 | controller | ../../../../molecule/common/test_deps : Gather facts if they don't exist --- 0.48s
2025-12-05 00:56:26.663512 | controller | ../../../../molecule/common/test_deps : Create default repo file -------- 0.43s
2025-12-05 00:56:26.663516 | controller | ../../../../molecule/common/test_deps : Create /etc/ansible/facts.d/bootc.fact --- 0.37s
2025-12-05 00:56:26.663521 | controller | Create ceilometer.conf -------------------------------------------------- 0.35s
2025-12-05 00:56:26.663531 | controller | INFO     Running default > converge
2025-12-05 00:56:27.050980 | controller |
2025-12-05 00:56:27.857890 | controller | PLAY [Converge] ****************************************************************
2025-12-05 00:56:27.857929 | controller |
2025-12-05 00:56:27.857939 | controller | TASK [Gathering Facts] *********************************************************
2025-12-05 00:56:27.857952 | controller | Friday 05 December 2025  00:56:27 +0000 (0:00:00.046)       0:00:00.046 *******
2025-12-05 00:56:27.857964 | controller | ok: [compute-1]
2025-12-05 00:56:27.858190 | controller |
2025-12-05 00:56:27.858218 | controller | TASK [Test edpm_telemetry_power_monitoring role] *******************************
2025-12-05 00:56:27.940444 | controller | Friday 05 December 2025  00:56:27 +0000 (0:00:00.806)       0:00:00.853 *******
2025-12-05 00:56:27.940464 | controller |
2025-12-05 00:56:27.975572 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Validating arguments against arg spec 'main' - The main entry point for the edpm_telemetry role.] ***
2025-12-05 00:56:27.975589 | controller | Friday 05 December 2025  00:56:27 +0000 (0:00:00.083)       0:00:00.937 *******
2025-12-05 00:56:27.975599 | controller | ok: [compute-1]
2025-12-05 00:56:28.035229 | controller |
2025-12-05 00:56:28.035263 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Adopt telemetry services from tripleo] ***
2025-12-05 00:56:28.035277 | controller | Friday 05 December 2025  00:56:27 +0000 (0:00:00.034)       0:00:00.971 *******
2025-12-05 00:56:28.035293 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_telemetry_power_monitoring/tasks/adoption.yml for compute-1
2025-12-05 00:56:28.153100 | controller |
2025-12-05 00:56:28.153134 | controller | TASK [Stop and disable ceilometer agent services] ******************************
2025-12-05 00:56:28.153147 | controller | Friday 05 December 2025  00:56:28 +0000 (0:00:00.059)       0:00:01.031 *******
2025-12-05 00:56:28.153164 | controller |
2025-12-05 00:56:28.153465 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Validating arguments against arg spec 'main' - The main entry point for the edpm_tripleo_cleanup role.] ***
2025-12-05 00:56:28.153686 | controller | Friday 05 December 2025  00:56:28 +0000 (0:00:00.118)       0:00:01.149 *******
2025-12-05 00:56:28.188182 | controller | ok: [compute-1]
2025-12-05 00:56:28.188364 | controller |
2025-12-05 00:56:28.188560 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Reload units to check for new changes] ***
2025-12-05 00:56:28.188741 | controller | Friday 05 December 2025  00:56:28 +0000 (0:00:00.035)       0:00:01.184 *******
2025-12-05 00:56:28.791904 | controller | ok: [compute-1]
2025-12-05 00:56:28.791954 | controller |
2025-12-05 00:56:28.791965 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Gather service facts] ********************
2025-12-05 00:56:28.791974 | controller | Friday 05 December 2025  00:56:28 +0000 (0:00:00.603)       0:00:01.788 *******
2025-12-05 00:56:30.546425 | controller | ok: [compute-1]
2025-12-05 00:56:30.585808 | controller |
2025-12-05 00:56:30.585845 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Set list of tripleo services] ************
2025-12-05 00:56:30.585862 | controller | Friday 05 December 2025  00:56:30 +0000 (0:00:01.754)       0:00:03.542 *******
2025-12-05 00:56:30.585875 | controller | ok: [compute-1]
2025-12-05 00:56:30.630511 | controller |
2025-12-05 00:56:30.630533 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Get all services] ************************
2025-12-05 00:56:30.630541 | controller | Friday 05 December 2025  00:56:30 +0000 (0:00:00.039)       0:00:03.581 *******
2025-12-05 00:56:30.630549 | controller | skipping: [compute-1]
2025-12-05 00:56:30.675457 | controller |
2025-12-05 00:56:30.675474 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Filter for tripleo services and skip the ones in skip list] ***
2025-12-05 00:56:30.675482 | controller | Friday 05 December 2025  00:56:30 +0000 (0:00:00.044)       0:00:03.626 *******
2025-12-05 00:56:30.675490 | controller | skipping: [compute-1]
2025-12-05 00:56:31.022189 | controller |
2025-12-05 00:56:31.022224 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Stop and disable tripleo services] *******
2025-12-05 00:56:31.022232 | controller | Friday 05 December 2025  00:56:30 +0000 (0:00:00.044)       0:00:03.671 *******
2025-12-05 00:56:31.022242 | controller | ok: [compute-1] => (item=tripleo_ceilometer_agent_ipmi.service)
2025-12-05 00:56:31.062917 | controller |
2025-12-05 00:56:31.062959 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Check for errors] ************************
2025-12-05 00:56:31.062969 | controller | Friday 05 December 2025  00:56:31 +0000 (0:00:00.346)       0:00:04.018 *******
2025-12-05 00:56:31.062984 | controller | skipping: [compute-1] => (item={'failed': False, 'msg': 'Could not find the requested service tripleo_ceilometer_agent_ipmi.service: host', 'invocation': {'module_args': {'name': 'tripleo_ceilometer_agent_ipmi.service', 'state': 'stopped', 'enabled': False, 'daemon_reload': False, 'daemon_reexec': False, 'scope': 'system', 'no_block': False, 'force': None, 'masked': None}}, 'changed': False, 'failed_when_result': False, 'item': 'tripleo_ceilometer_agent_ipmi.service', 'ansible_loop_var': 'item'})
2025-12-05 00:56:31.063022 | controller | skipping: [compute-1]
2025-12-05 00:56:31.063033 | controller |
2025-12-05 00:56:31.063253 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Remove unit files] ***********************
2025-12-05 00:56:31.136959 | controller | Friday 05 December 2025  00:56:31 +0000 (0:00:00.040)       0:00:04.059 *******
2025-12-05 00:56:31.136999 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_tripleo_cleanup/tasks/remove_unit_files.yml for compute-1 => (item=/usr/lib/systemd/system)
2025-12-05 00:56:31.457874 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_tripleo_cleanup/tasks/remove_unit_files.yml for compute-1 => (item=/etc/systemd/system)
2025-12-05 00:56:31.457917 | controller |
2025-12-05 00:56:31.457928 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Remove unit files from the location: /usr/lib/systemd/system] ***
2025-12-05 00:56:31.457937 | controller | Friday 05 December 2025  00:56:31 +0000 (0:00:00.073)       0:00:04.132 *******
2025-12-05 00:56:31.457951 | controller | ok: [compute-1] => (item=tripleo_ceilometer_agent_ipmi.service)
2025-12-05 00:56:31.677831 | controller |
2025-12-05 00:56:31.677863 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Remove unit files from the location: /etc/systemd/system] ***
2025-12-05 00:56:31.677873 | controller | Friday 05 December 2025  00:56:31 +0000 (0:00:00.321)       0:00:04.453 *******
2025-12-05 00:56:31.677885 | controller | ok: [compute-1] => (item=tripleo_ceilometer_agent_ipmi.service)
2025-12-05 00:56:31.677913 | controller |
2025-12-05 00:56:31.677921 | controller | TASK [Adopt (stop tracking) certs from tripleo] ********************************
2025-12-05 00:56:31.677936 | controller | Friday 05 December 2025  00:56:31 +0000 (0:00:00.220)       0:00:04.674 *******
2025-12-05 00:56:31.772875 | controller |
2025-12-05 00:56:32.056219 | controller | TASK [osp.edpm.edpm_install_certs : Stop and disable certmonger] ***************
2025-12-05 00:56:32.056249 | controller | Friday 05 December 2025  00:56:31 +0000 (0:00:00.095)       0:00:04.769 *******
2025-12-05 00:56:32.056261 | controller | ok: [compute-1]
2025-12-05 00:56:32.336382 | controller |
2025-12-05 00:56:32.336422 | controller | TASK [osp.edpm.edpm_install_certs : Find certmonger requests] ******************
2025-12-05 00:56:32.336436 | controller | Friday 05 December 2025  00:56:32 +0000 (0:00:00.282)       0:00:05.052 *******
2025-12-05 00:56:32.336446 | controller | [WARNING]: Skipped '/var/lib/certmonger/requests' path due to this access
2025-12-05 00:56:32.363192 | controller | issue: '/var/lib/certmonger/requests' is not a directory
2025-12-05 00:56:32.363213 | controller | ok: [compute-1]
2025-12-05 00:56:32.398813 | controller |
2025-12-05 00:56:32.398834 | controller | TASK [osp.edpm.edpm_install_certs : Backup certificate requests] ***************
2025-12-05 00:56:32.398843 | controller | Friday 05 December 2025  00:56:32 +0000 (0:00:00.307)       0:00:05.359 *******
2025-12-05 00:56:32.398853 | controller | skipping: [compute-1]
2025-12-05 00:56:32.398878 | controller |
2025-12-05 00:56:32.398887 | controller | TASK [osp.edpm.edpm_install_certs : Remove certificate requests] ***************
2025-12-05 00:56:32.398994 | controller | Friday 05 December 2025  00:56:32 +0000 (0:00:00.035)       0:00:05.395 *******
2025-12-05 00:56:32.479104 | controller | skipping: [compute-1]
2025-12-05 00:56:32.891250 | controller |
2025-12-05 00:56:32.891285 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Reload units] ****************************
2025-12-05 00:56:32.891295 | controller | Friday 05 December 2025  00:56:32 +0000 (0:00:00.079)       0:00:05.475 *******
2025-12-05 00:56:32.891306 | controller | ok: [compute-1]
2025-12-05 00:56:33.128712 | controller |
2025-12-05 00:56:33.128762 | controller | TASK [osp.edpm.edpm_tripleo_cleanup : Reset state of failed systemd units] *****
2025-12-05 00:56:33.128772 | controller | Friday 05 December 2025  00:56:32 +0000 (0:00:00.412)       0:00:05.887 *******
2025-12-05 00:56:33.128783 | controller | changed: [compute-1] => (item=tripleo_ceilometer_agent_ipmi.service)
2025-12-05 00:56:33.408320 | controller |
2025-12-05 00:56:33.408353 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Gather user fact] *************
2025-12-05 00:56:33.408363 | controller | Friday 05 December 2025  00:56:33 +0000 (0:00:00.237)       0:00:06.124 *******
2025-12-05 00:56:33.408374 | controller | ok: [compute-1]
2025-12-05 00:56:33.666584 | controller |
2025-12-05 00:56:33.666616 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Create ceilometer config dir] ***
2025-12-05 00:56:33.666627 | controller | Friday 05 December 2025  00:56:33 +0000 (0:00:00.279)       0:00:06.404 *******
2025-12-05 00:56:33.666639 | controller | changed: [compute-1] => (item={'path': '/var/lib/openstack/telemetry-power-monitoring'})
2025-12-05 00:56:33.947480 | controller |
2025-12-05 00:56:33.947511 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Determine if cacert file exists] ***
2025-12-05 00:56:33.947519 | controller | Friday 05 December 2025  00:56:33 +0000 (0:00:00.258)       0:00:06.662 *******
2025-12-05 00:56:33.947530 | controller | ok: [compute-1]
2025-12-05 00:56:34.379593 | controller |
2025-12-05 00:56:34.379633 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Render ceilometer config template] ***
2025-12-05 00:56:34.379642 | controller | Friday 05 December 2025  00:56:33 +0000 (0:00:00.280)       0:00:06.943 *******
2025-12-05 00:56:34.379652 | controller | changed: [compute-1]
2025-12-05 00:56:34.699828 | controller |
2025-12-05 00:56:34.699863 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Copy static config files] *****
2025-12-05 00:56:34.699872 | controller | Friday 05 December 2025  00:56:34 +0000 (0:00:00.432)       0:00:07.375 *******
2025-12-05 00:56:34.699884 | controller | changed: [compute-1]
2025-12-05 00:56:34.736809 | controller |
2025-12-05 00:56:34.736840 | controller | TASK [osp.edpm.edpm_users : Validating arguments against arg spec 'main' - The main entry point for the edpm_users role.] ***
2025-12-05 00:56:34.736850 | controller | Friday 05 December 2025  00:56:34 +0000 (0:00:00.320)       0:00:07.696 *******
2025-12-05 00:56:34.736863 | controller | ok: [compute-1]
2025-12-05 00:56:34.737063 | controller |
2025-12-05 00:56:34.737098 | controller | TASK [osp.edpm.edpm_users : Gather user fact] **********************************
2025-12-05 00:56:35.045804 | controller | Friday 05 December 2025  00:56:34 +0000 (0:00:00.037)       0:00:07.733 *******
2025-12-05 00:56:35.045838 | controller | ok: [compute-1]
2025-12-05 00:56:35.109984 | controller |
2025-12-05 00:56:35.110007 | controller | TASK [osp.edpm.edpm_users : Create host users and groups] **********************
2025-12-05 00:56:35.110015 | controller | Friday 05 December 2025  00:56:35 +0000 (0:00:00.308)       0:00:08.042 *******
2025-12-05 00:56:35.110027 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_users/tasks/create_users_and_groups.yml for compute-1 => (item={'name': 'ceilometer', 'uid': '42405', 'gid': '42405', 'shell': '/sbin/nologin', 'comment': 'ceilometer user', 'groups': 'libvirt'})
2025-12-05 00:56:35.382555 | controller |
2025-12-05 00:56:35.382585 | controller | TASK [osp.edpm.edpm_users : Detect when user exists and cannot be created] *****
2025-12-05 00:56:35.382593 | controller | Friday 05 December 2025  00:56:35 +0000 (0:00:00.064)       0:00:08.106 *******
2025-12-05 00:56:35.382603 | controller | fatal: [compute-1]: FAILED! => changed=false
2025-12-05 00:56:35.409257 | controller |   msg: One or more supplied key could not be found in the database.
2025-12-05 00:56:35.409283 | controller | ...ignoring
2025-12-05 00:56:35.741797 | controller |
2025-12-05 00:56:35.741828 | controller | TASK [osp.edpm.edpm_users : Ensure group is present on the host [ ceilometer ]] ***
2025-12-05 00:56:35.741835 | controller | Friday 05 December 2025  00:56:35 +0000 (0:00:00.299)       0:00:08.405 *******
2025-12-05 00:56:35.741845 | controller | changed: [compute-1]
2025-12-05 00:56:36.182528 | controller |
2025-12-05 00:56:36.182569 | controller | TASK [osp.edpm.edpm_users : Ensure user is present on the host [ ceilometer ]] ***
2025-12-05 00:56:36.182583 | controller | Friday 05 December 2025  00:56:35 +0000 (0:00:00.332)       0:00:08.738 *******
2025-12-05 00:56:36.182606 | controller | changed: [compute-1]
2025-12-05 00:56:36.243706 | controller |
2025-12-05 00:56:36.243768 | controller | TASK [osp.edpm.edpm_users : Create host directories] ***************************
2025-12-05 00:56:36.243782 | controller | Friday 05 December 2025  00:56:36 +0000 (0:00:00.440)       0:00:09.178 *******
2025-12-05 00:56:36.243797 | controller | skipping: [compute-1]
2025-12-05 00:56:36.282801 | controller |
2025-12-05 00:56:36.282827 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Gather ceilometer config files] ***
2025-12-05 00:56:36.282838 | controller | Friday 05 December 2025  00:56:36 +0000 (0:00:00.061)       0:00:09.239 *******
2025-12-05 00:56:36.282851 | controller | ok: [compute-1]
2025-12-05 00:56:36.282880 | controller |
2025-12-05 00:56:36.282891 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Check for custom.conf existence] ***
2025-12-05 00:56:36.283051 | controller | Friday 05 December 2025  00:56:36 +0000 (0:00:00.039)       0:00:09.279 *******
2025-12-05 00:56:36.456549 | controller | ok: [compute-1 -> localhost]
2025-12-05 00:56:36.492908 | controller |
2025-12-05 00:56:36.492945 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Append custom.conf to config files] ***
2025-12-05 00:56:36.492958 | controller | Friday 05 December 2025  00:56:36 +0000 (0:00:00.173)       0:00:09.453 *******
2025-12-05 00:56:36.492974 | controller | skipping: [compute-1]
2025-12-05 00:56:36.493058 | controller |
2025-12-05 00:56:36.493084 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Copy generated ceilometer configs] ***
2025-12-05 00:56:36.493102 | controller | Friday 05 December 2025  00:56:36 +0000 (0:00:00.036)       0:00:09.489 *******
2025-12-05 00:56:36.880538 | controller | changed: [compute-1] => (item={'src': '/var/lib/openstack/configs/telemetry-power-monitoring/ceilometer.conf', 'dest': '/var/lib/openstack/telemetry-power-monitoring/ceilometer.conf'})
2025-12-05 00:56:37.083447 | controller | changed: [compute-1] => (item={'src': '/var/lib/openstack/configs/telemetry-power-monitoring/polling.yaml', 'dest': '/var/lib/openstack/telemetry-power-monitoring/polling.yaml'})
2025-12-05 00:56:37.083477 | controller |
2025-12-05 00:56:37.083485 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Check that tls.crt exists] ****
2025-12-05 00:56:37.083492 | controller | Friday 05 December 2025  00:56:36 +0000 (0:00:00.387)       0:00:09.876 *******
2025-12-05 00:56:37.083502 | controller | ok: [compute-1]
2025-12-05 00:56:37.276180 | controller |
2025-12-05 00:56:37.276210 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Check that tls.key exists] ****
2025-12-05 00:56:37.276218 | controller | Friday 05 December 2025  00:56:37 +0000 (0:00:00.202)       0:00:10.079 *******
2025-12-05 00:56:37.276228 | controller | ok: [compute-1]
2025-12-05 00:56:37.619764 | controller |
2025-12-05 00:56:37.619796 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Copy TLS config for ceilometer_prom_exporter] ***
2025-12-05 00:56:37.619804 | controller | Friday 05 December 2025  00:56:37 +0000 (0:00:00.192)       0:00:10.272 *******
2025-12-05 00:56:37.619814 | controller | changed: [compute-1]
2025-12-05 00:56:37.826828 | controller |
2025-12-05 00:56:37.826865 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Change the owner of the crt] ***
2025-12-05 00:56:37.826877 | controller | Friday 05 December 2025  00:56:37 +0000 (0:00:00.343)       0:00:10.616 *******
2025-12-05 00:56:37.826891 | controller | changed: [compute-1]
2025-12-05 00:56:37.826922 | controller |
2025-12-05 00:56:37.826932 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Change the owner of the key] ***
2025-12-05 00:56:37.826943 | controller | Friday 05 December 2025  00:56:37 +0000 (0:00:00.206)       0:00:10.823 *******
2025-12-05 00:56:38.058806 | controller | changed: [compute-1]
2025-12-05 00:56:38.058849 | controller |
2025-12-05 00:56:38.058866 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Create a directory for container health checks] ***
2025-12-05 00:56:38.058991 | controller | Friday 05 December 2025  00:56:38 +0000 (0:00:00.232)       0:00:11.055 *******
2025-12-05 00:56:38.277825 | controller | changed: [compute-1]
2025-12-05 00:56:39.274454 | controller |
2025-12-05 00:56:39.274485 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Deploy telemetry health check scripts] ***
2025-12-05 00:56:39.274493 | controller | Friday 05 December 2025  00:56:38 +0000 (0:00:00.218)       0:00:11.274 *******
2025-12-05 00:56:39.274504 | controller | changed: [compute-1] => (item={'key': 'ceilometer_agent_ipmi', 'value': 'ceilometer_agent'})
2025-12-05 00:56:39.364285 | controller | changed: [compute-1] => (item={'key': 'kepler', 'value': 'exporter'})
2025-12-05 00:56:39.364316 | controller |
2025-12-05 00:56:39.364325 | controller | TASK [Deploy ceilometer ipmi container] ****************************************
2025-12-05 00:56:39.364332 | controller | Friday 05 December 2025  00:56:39 +0000 (0:00:00.996)       0:00:12.270 *******
2025-12-05 00:56:39.364342 | controller |
2025-12-05 00:56:39.462515 | controller | TASK [osp.edpm.edpm_container_standalone : Validating arguments against arg spec 'main' - The main entry point for the edpm_container_standalone role.] ***
2025-12-05 00:56:39.462542 | controller | Friday 05 December 2025  00:56:39 +0000 (0:00:00.090)       0:00:12.360 *******
2025-12-05 00:56:39.462555 | controller | ok: [compute-1]
2025-12-05 00:56:39.687303 | controller |
2025-12-05 00:56:39.687337 | controller | TASK [osp.edpm.edpm_container_standalone : Ensure /var/lib/edpm-config exists with correct ownership] ***
2025-12-05 00:56:39.687346 | controller | Friday 05 December 2025  00:56:39 +0000 (0:00:00.098)       0:00:12.458 *******
2025-12-05 00:56:39.687357 | controller | changed: [compute-1]
2025-12-05 00:56:39.895579 | controller |
2025-12-05 00:56:39.895613 | controller | TASK [osp.edpm.edpm_container_standalone : Ensure directory exists: /var/lib/kolla/config_files] ***
2025-12-05 00:56:39.895622 | controller | Friday 05 December 2025  00:56:39 +0000 (0:00:00.224)       0:00:12.683 *******
2025-12-05 00:56:39.895634 | controller | changed: [compute-1]
2025-12-05 00:56:40.265487 | controller |
2025-12-05 00:56:40.265520 | controller | TASK [osp.edpm.edpm_container_standalone : Create kolla config files] **********
2025-12-05 00:56:40.265527 | controller | Friday 05 December 2025  00:56:39 +0000 (0:00:00.208)       0:00:12.891 *******
2025-12-05 00:56:40.265539 | controller | changed: [compute-1] => (item={'key': 'ceilometer_agent_ipmi', 'value': {'command': '/usr/bin/ceilometer-polling --polling-namespaces ipmi --logfile /dev/stdout', 'config_files': [{'source': '/var/lib/kolla/config_files/src/ceilometer.conf', 'dest': '/etc/ceilometer/ceilometer.conf', 'owner': 'ceilometer', 'perm': '0600'}, {'source': '/var/lib/kolla/config_files/src/polling.yaml', 'dest': '/etc/ceilometer/polling.yaml', 'owner': 'ceilometer', 'perm': '0600'}, {'source': '/var/lib/kolla/config_files/src/custom.conf', 'dest': '/etc/ceilometer/ceilometer.conf.d/01-ceilometer-custom.conf', 'owner': 'ceilometer', 'perm': '0600', 'optional': True}, {'source': '/var/lib/kolla/config_files/src/ceilometer-host-specific.conf', 'dest': '/etc/ceilometer/ceilometer.conf.d/02-ceilometer-host-specific.conf', 'owner': 'ceilometer', 'perm': '0600', 'optional': True}]}})
2025-12-05 00:56:40.458587 | controller |
2025-12-05 00:56:40.458611 | controller | TASK [osp.edpm.edpm_container_standalone : Create config file /var/lib/edpm-config/container-startup-config/ceilometer_agent_ipmi] ***
2025-12-05 00:56:40.458619 | controller | Friday 05 December 2025  00:56:40 +0000 (0:00:00.369)       0:00:13.261 *******
2025-12-05 00:56:40.458633 | controller | changed: [compute-1]
2025-12-05 00:56:40.865487 | controller |
2025-12-05 00:56:40.865518 | controller | TASK [osp.edpm.edpm_container_standalone : Render container definitions: [ceilometer_agent_ipmi ]] ***
2025-12-05 00:56:40.865527 | controller | Friday 05 December 2025  00:56:40 +0000 (0:00:00.193)       0:00:13.454 *******
2025-12-05 00:56:40.865538 | controller | changed: [compute-1] => (item=None)
2025-12-05 00:56:40.939752 | controller | changed: [compute-1]
2025-12-05 00:56:40.939774 | controller |
2025-12-05 00:56:40.939782 | controller | TASK [Run containers: [ ceilometer_agent_ipmi ]] *******************************
2025-12-05 00:56:40.939788 | controller | Friday 05 December 2025  00:56:40 +0000 (0:00:00.406)       0:00:13.861 *******
2025-12-05 00:56:40.939797 | controller |
2025-12-05 00:56:41.036862 | controller | TASK [osp.edpm.edpm_container_manage : Validating arguments against arg spec 'main' - The main entry point for the edpm_container_manage role.] ***
2025-12-05 00:56:41.036899 | controller | Friday 05 December 2025  00:56:40 +0000 (0:00:00.074)       0:00:13.936 *******
2025-12-05 00:56:41.036913 | controller | ok: [compute-1]
2025-12-05 00:56:41.036933 | controller |
2025-12-05 00:56:41.036941 | controller | TASK [osp.edpm.edpm_container_manage : Find all matching configs configs for in /var/lib/edpm-config/container-startup-config/ceilometer_agent_ipmi] ***
2025-12-05 00:56:41.036949 | controller | Friday 05 December 2025  00:56:41 +0000 (0:00:00.096)       0:00:14.033 *******
2025-12-05 00:56:41.350343 | controller | ok: [compute-1]
2025-12-05 00:56:41.350395 | controller |
2025-12-05 00:56:41.350517 | controller | TASK [osp.edpm.edpm_container_manage : Initialize all_containers_hash for this invocation] ***
2025-12-05 00:56:41.350613 | controller | Friday 05 December 2025  00:56:41 +0000 (0:00:00.313)       0:00:14.347 *******
2025-12-05 00:56:41.493070 | controller | ok: [compute-1]
2025-12-05 00:56:41.493132 | controller |
2025-12-05 00:56:41.493262 | controller | TASK [osp.edpm.edpm_container_manage : Filter configs if container list provided] ***
2025-12-05 00:56:41.493370 | controller | Friday 05 December 2025  00:56:41 +0000 (0:00:00.142)       0:00:14.489 *******
2025-12-05 00:56:41.635153 | controller | ok: [compute-1] => (item=ceilometer_agent_ipmi)
2025-12-05 00:56:41.635228 | controller |
2025-12-05 00:56:41.635336 | controller | TASK [osp.edpm.edpm_container_manage : Use all configs if no filter] ***********
2025-12-05 00:56:41.635430 | controller | Friday 05 December 2025  00:56:41 +0000 (0:00:00.141)       0:00:14.631 *******
2025-12-05 00:56:41.725625 | controller | skipping: [compute-1]
2025-12-05 00:56:41.725704 | controller |
2025-12-05 00:56:41.725858 | controller | TASK [osp.edpm.edpm_container_manage : Update container configs with new config hashes] ***
2025-12-05 00:56:41.725966 | controller | Friday 05 December 2025  00:56:41 +0000 (0:00:00.090)       0:00:14.722 *******
2025-12-05 00:56:42.055479 | controller | changed: [compute-1]
2025-12-05 00:56:42.055573 | controller |
2025-12-05 00:56:42.055700 | controller | TASK [osp.edpm.edpm_container_manage : Delete orphan containers (DEPRECATED)] ***
2025-12-05 00:56:42.055846 | controller | Friday 05 December 2025  00:56:42 +0000 (0:00:00.329)       0:00:15.052 *******
2025-12-05 00:56:42.134579 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_container_manage/tasks/delete_orphan.yml for compute-1
2025-12-05 00:56:42.134674 | controller |
2025-12-05 00:56:42.134820 | controller | TASK [osp.edpm.edpm_container_manage : Gather podman infos] ********************
2025-12-05 00:56:42.134935 | controller | Friday 05 December 2025  00:56:42 +0000 (0:00:00.079)       0:00:15.131 *******
2025-12-05 00:56:42.529806 | controller | ok: [compute-1]
2025-12-05 00:56:42.529896 | controller |
2025-12-05 00:56:42.530115 | controller | TASK [osp.edpm.edpm_container_manage : Exclude Ceph containers from podman container list] ***
2025-12-05 00:56:42.589909 | controller | Friday 05 December 2025  00:56:42 +0000 (0:00:00.395)       0:00:15.526 *******
2025-12-05 00:56:42.589953 | controller | ok: [compute-1]
2025-12-05 00:56:42.589987 | controller |
2025-12-05 00:56:42.589999 | controller | TASK [Delete orphan containers managed by Podman for /var/lib/edpm-config/container-startup-config/ceilometer_agent_ipmi] ***
2025-12-05 00:56:42.590079 | controller | Friday 05 December 2025  00:56:42 +0000 (0:00:00.060)       0:00:15.586 *******
2025-12-05 00:56:42.678957 | controller |
2025-12-05 00:56:42.740866 | controller | TASK [osp.edpm.edpm_container_rm : Validating arguments against arg spec 'main' - The main entry point for the edpm_container_rm role.] ***
2025-12-05 00:56:42.740910 | controller | Friday 05 December 2025  00:56:42 +0000 (0:00:00.088)       0:00:15.675 *******
2025-12-05 00:56:42.740926 | controller | ok: [compute-1]
2025-12-05 00:56:42.740957 | controller |
2025-12-05 00:56:42.740968 | controller | TASK [osp.edpm.edpm_container_rm : Include edpm container rm task file] ********
2025-12-05 00:56:42.741125 | controller | Friday 05 December 2025  00:56:42 +0000 (0:00:00.061)       0:00:15.737 *******
2025-12-05 00:56:42.843791 | controller | skipping: [compute-1]
2025-12-05 00:56:42.927793 | controller |
2025-12-05 00:56:42.927827 | controller | TASK [osp.edpm.edpm_container_manage : Create containers from /var/lib/edpm-config/container-startup-config/ceilometer_agent_ipmi] ***
2025-12-05 00:56:42.927841 | controller | Friday 05 December 2025  00:56:42 +0000 (0:00:00.102)       0:00:15.839 *******
2025-12-05 00:56:42.927859 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_container_manage/tasks/create.yml for compute-1
2025-12-05 00:56:42.928099 | controller |
2025-12-05 00:56:42.928341 | controller | TASK [osp.edpm.edpm_container_manage : Create containers managed by Podman for /var/lib/edpm-config/container-startup-config/ceilometer_agent_ipmi] ***
2025-12-05 00:56:42.928580 | controller | Friday 05 December 2025  00:56:42 +0000 (0:00:00.085)       0:00:15.924 *******
2025-12-05 00:56:50.912883 | controller | changed: [compute-1]
2025-12-05 00:56:50.913122 | controller |
2025-12-05 00:56:50.913136 | controller | TASK [osp.edpm.edpm_container_manage : Check if /etc/sysconfig/podman_drop_in exists] ***
2025-12-05 00:56:51.143733 | controller | Friday 05 December 2025  00:56:50 +0000 (0:00:07.985)       0:00:23.909 *******
2025-12-05 00:56:51.143764 | controller | ok: [compute-1]
2025-12-05 00:56:51.199200 | controller |
2025-12-05 00:56:51.199219 | controller | TASK [osp.edpm.edpm_container_manage : Set podman_drop_in fact] ****************
2025-12-05 00:56:51.199227 | controller | Friday 05 December 2025  00:56:51 +0000 (0:00:00.230)       0:00:24.140 *******
2025-12-05 00:56:51.199237 | controller | skipping: [compute-1]
2025-12-05 00:56:52.978677 | controller |
2025-12-05 00:56:52.978708 | controller | TASK [osp.edpm.edpm_container_manage : Manage container systemd services and cleanup old systemd healthchecks for /var/lib/edpm-config/container-startup-config/ceilometer_agent_ipmi] ***
2025-12-05 00:56:52.978717 | controller | Friday 05 December 2025  00:56:51 +0000 (0:00:00.055)       0:00:24.195 *******
2025-12-05 00:56:52.978746 | controller | changed: [compute-1]
2025-12-05 00:56:53.086195 | controller |
2025-12-05 00:56:53.086217 | controller | TASK [osp.edpm.edpm_container_standalone : Update service state file] **********
2025-12-05 00:56:53.086229 | controller | Friday 05 December 2025  00:56:52 +0000 (0:00:01.779)       0:00:25.974 *******
2025-12-05 00:56:53.086239 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_container_standalone/tasks/state_file_update.yml for compute-1
2025-12-05 00:56:53.356027 | controller |
2025-12-05 00:56:53.356055 | controller | TASK [osp.edpm.edpm_container_standalone : Read current state file] ************
2025-12-05 00:56:53.356063 | controller | Friday 05 December 2025  00:56:53 +0000 (0:00:00.107)       0:00:26.082 *******
2025-12-05 00:56:53.356073 | controller | ok: [compute-1]
2025-12-05 00:56:53.396542 | controller |
2025-12-05 00:56:53.396559 | controller | TASK [osp.edpm.edpm_container_standalone : Parse state file data] **************
2025-12-05 00:56:53.396566 | controller | Friday 05 December 2025  00:56:53 +0000 (0:00:00.269)       0:00:26.352 *******
2025-12-05 00:56:53.396574 | controller | skipping: [compute-1]
2025-12-05 00:56:53.439793 | controller |
2025-12-05 00:56:53.439825 | controller | TASK [osp.edpm.edpm_container_standalone : Initialize empty state data if file doesn't exist] ***
2025-12-05 00:56:53.439835 | controller | Friday 05 December 2025  00:56:53 +0000 (0:00:00.040)       0:00:26.392 *******
2025-12-05 00:56:53.439847 | controller | ok: [compute-1]
2025-12-05 00:56:53.440198 | controller |
2025-12-05 00:56:53.440217 | controller | TASK [osp.edpm.edpm_container_standalone : Update service in state data] *******
2025-12-05 00:56:53.549895 | controller | Friday 05 December 2025  00:56:53 +0000 (0:00:00.043)       0:00:26.436 *******
2025-12-05 00:56:53.549917 | controller | ok: [compute-1]
2025-12-05 00:56:53.959319 | controller |
2025-12-05 00:56:53.959348 | controller | TASK [osp.edpm.edpm_container_standalone : Write updated state file] ***********
2025-12-05 00:56:53.959356 | controller | Friday 05 December 2025  00:56:53 +0000 (0:00:00.109)       0:00:26.546 *******
2025-12-05 00:56:53.959366 | controller | changed: [compute-1]
2025-12-05 00:56:54.038043 | controller |
2025-12-05 00:56:54.038065 | controller | TASK [Deploy Kepler container] *************************************************
2025-12-05 00:56:54.038073 | controller | Friday 05 December 2025  00:56:53 +0000 (0:00:00.409)       0:00:26.955 *******
2025-12-05 00:56:54.038082 | controller |
2025-12-05 00:56:54.132398 | controller | TASK [osp.edpm.edpm_container_standalone : Validating arguments against arg spec 'main' - The main entry point for the edpm_container_standalone role.] ***
2025-12-05 00:56:54.132416 | controller | Friday 05 December 2025  00:56:54 +0000 (0:00:00.078)       0:00:27.034 *******
2025-12-05 00:56:54.132426 | controller | ok: [compute-1]
2025-12-05 00:56:54.376244 | controller |
2025-12-05 00:56:54.376266 | controller | TASK [osp.edpm.edpm_container_standalone : Ensure /var/lib/edpm-config exists with correct ownership] ***
2025-12-05 00:56:54.376274 | controller | Friday 05 December 2025  00:56:54 +0000 (0:00:00.094)       0:00:27.129 *******
2025-12-05 00:56:54.376284 | controller | changed: [compute-1]
2025-12-05 00:56:54.593822 | controller |
2025-12-05 00:56:54.593879 | controller | TASK [osp.edpm.edpm_container_standalone : Ensure directory exists: /var/lib/kolla/config_files] ***
2025-12-05 00:56:54.593890 | controller | Friday 05 December 2025  00:56:54 +0000 (0:00:00.243)       0:00:27.372 *******
2025-12-05 00:56:54.593904 | controller | ok: [compute-1]
2025-12-05 00:56:54.641804 | controller |
2025-12-05 00:56:54.641843 | controller | TASK [osp.edpm.edpm_container_standalone : Create kolla config files] **********
2025-12-05 00:56:54.641854 | controller | Friday 05 December 2025  00:56:54 +0000 (0:00:00.217)       0:00:27.590 *******
2025-12-05 00:56:54.641867 | controller | skipping: [compute-1]
2025-12-05 00:56:54.642038 | controller |
2025-12-05 00:56:54.642060 | controller | TASK [osp.edpm.edpm_container_standalone : Create config file /var/lib/edpm-config/container-startup-config/kepler] ***
2025-12-05 00:56:54.839888 | controller | Friday 05 December 2025  00:56:54 +0000 (0:00:00.048)       0:00:27.638 *******
2025-12-05 00:56:54.839927 | controller | changed: [compute-1]
2025-12-05 00:56:54.839959 | controller |
2025-12-05 00:56:54.839970 | controller | TASK [osp.edpm.edpm_container_standalone : Render container definitions: [kepler ]] ***
2025-12-05 00:56:54.840086 | controller | Friday 05 December 2025  00:56:54 +0000 (0:00:00.197)       0:00:27.836 *******
2025-12-05 00:56:55.227329 | controller | changed: [compute-1] => (item=None)
2025-12-05 00:56:55.320813 | controller | changed: [compute-1]
2025-12-05 00:56:55.320846 | controller |
2025-12-05 00:56:55.320860 | controller | TASK [Run containers: [ kepler ]] **********************************************
2025-12-05 00:56:55.320872 | controller | Friday 05 December 2025  00:56:55 +0000 (0:00:00.387)       0:00:28.223 *******
2025-12-05 00:56:55.320887 | controller |
2025-12-05 00:56:55.321171 | controller | TASK [osp.edpm.edpm_container_manage : Validating arguments against arg spec 'main' - The main entry point for the edpm_container_manage role.] ***
2025-12-05 00:56:55.418881 | controller | Friday 05 December 2025  00:56:55 +0000 (0:00:00.093)       0:00:28.317 *******
2025-12-05 00:56:55.418923 | controller | ok: [compute-1]
2025-12-05 00:56:55.419229 | controller |
2025-12-05 00:56:55.419260 | controller | TASK [osp.edpm.edpm_container_manage : Find all matching configs configs for in /var/lib/edpm-config/container-startup-config/kepler] ***
2025-12-05 00:56:55.642065 | controller | Friday 05 December 2025  00:56:55 +0000 (0:00:00.098)       0:00:28.415 *******
2025-12-05 00:56:55.642087 | controller | ok: [compute-1]
2025-12-05 00:56:55.740138 | controller |
2025-12-05 00:56:55.740157 | controller | TASK [osp.edpm.edpm_container_manage : Initialize all_containers_hash for this invocation] ***
2025-12-05 00:56:55.740165 | controller | Friday 05 December 2025  00:56:55 +0000 (0:00:00.223)       0:00:28.638 *******
2025-12-05 00:56:55.740173 | controller | ok: [compute-1]
2025-12-05 00:56:55.878795 | controller |
2025-12-05 00:56:55.878813 | controller | TASK [osp.edpm.edpm_container_manage : Filter configs if container list provided] ***
2025-12-05 00:56:55.878821 | controller | Friday 05 December 2025  00:56:55 +0000 (0:00:00.097)       0:00:28.736 *******
2025-12-05 00:56:55.878829 | controller | ok: [compute-1] => (item=kepler)
2025-12-05 00:56:55.973877 | controller |
2025-12-05 00:56:55.973915 | controller | TASK [osp.edpm.edpm_container_manage : Use all configs if no filter] ***********
2025-12-05 00:56:55.973926 | controller | Friday 05 December 2025  00:56:55 +0000 (0:00:00.138)       0:00:28.875 *******
2025-12-05 00:56:55.973939 | controller | skipping: [compute-1]
2025-12-05 00:56:56.239199 | controller |
2025-12-05 00:56:56.239241 | controller | TASK [osp.edpm.edpm_container_manage : Update container configs with new config hashes] ***
2025-12-05 00:56:56.239257 | controller | Friday 05 December 2025  00:56:55 +0000 (0:00:00.094)       0:00:28.970 *******
2025-12-05 00:56:56.239270 | controller | ok: [compute-1]
2025-12-05 00:56:56.239292 | controller |
2025-12-05 00:56:56.239504 | controller | TASK [osp.edpm.edpm_container_manage : Delete orphan containers (DEPRECATED)] ***
2025-12-05 00:56:56.322353 | controller | Friday 05 December 2025  00:56:56 +0000 (0:00:00.265)       0:00:29.235 *******
2025-12-05 00:56:56.322381 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_container_manage/tasks/delete_orphan.yml for compute-1
2025-12-05 00:56:56.628416 | controller |
2025-12-05 00:56:56.628450 | controller | TASK [osp.edpm.edpm_container_manage : Gather podman infos] ********************
2025-12-05 00:56:56.628461 | controller | Friday 05 December 2025  00:56:56 +0000 (0:00:00.082)       0:00:29.318 *******
2025-12-05 00:56:56.628491 | controller | ok: [compute-1]
2025-12-05 00:56:56.698812 | controller |
2025-12-05 00:56:56.698871 | controller | TASK [osp.edpm.edpm_container_manage : Exclude Ceph containers from podman container list] ***
2025-12-05 00:56:56.698882 | controller | Friday 05 December 2025  00:56:56 +0000 (0:00:00.305)       0:00:29.624 *******
2025-12-05 00:56:56.698899 | controller | ok: [compute-1]
2025-12-05 00:56:56.699132 | controller |
2025-12-05 00:56:56.809774 | controller | TASK [Delete orphan containers managed by Podman for /var/lib/edpm-config/container-startup-config/kepler] ***
2025-12-05 00:56:56.809814 | controller | Friday 05 December 2025  00:56:56 +0000 (0:00:00.070)       0:00:29.695 *******
2025-12-05 00:56:56.809826 | controller |
2025-12-05 00:56:56.865244 | controller | TASK [osp.edpm.edpm_container_rm : Validating arguments against arg spec 'main' - The main entry point for the edpm_container_rm role.] ***
2025-12-05 00:56:56.865262 | controller | Friday 05 December 2025  00:56:56 +0000 (0:00:00.110)       0:00:29.806 *******
2025-12-05 00:56:56.865272 | controller | ok: [compute-1]
2025-12-05 00:56:56.937501 | controller |
2025-12-05 00:56:56.937536 | controller | TASK [osp.edpm.edpm_container_rm : Include edpm container rm task file] ********
2025-12-05 00:56:56.937551 | controller | Friday 05 December 2025  00:56:56 +0000 (0:00:00.055)       0:00:29.861 *******
2025-12-05 00:56:56.937567 | controller | skipping: [compute-1]
2025-12-05 00:56:56.937860 | controller |
2025-12-05 00:56:56.938147 | controller | TASK [osp.edpm.edpm_container_manage : Create containers from /var/lib/edpm-config/container-startup-config/kepler] ***
2025-12-05 00:56:56.938309 | controller | Friday 05 December 2025  00:56:56 +0000 (0:00:00.072)       0:00:29.934 *******
2025-12-05 00:56:57.016282 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_container_manage/tasks/create.yml for compute-1
2025-12-05 00:56:57.016431 | controller |
2025-12-05 00:56:57.016622 | controller | TASK [osp.edpm.edpm_container_manage : Create containers managed by Podman for /var/lib/edpm-config/container-startup-config/kepler] ***
2025-12-05 00:56:57.016792 | controller | Friday 05 December 2025  00:56:57 +0000 (0:00:00.078)       0:00:30.013 *******
2025-12-05 00:57:03.212770 | controller | changed: [compute-1]
2025-12-05 00:57:03.447550 | controller |
2025-12-05 00:57:03.447591 | controller | TASK [osp.edpm.edpm_container_manage : Check if /etc/sysconfig/podman_drop_in exists] ***
2025-12-05 00:57:03.447614 | controller | Friday 05 December 2025  00:57:03 +0000 (0:00:06.195)       0:00:36.208 *******
2025-12-05 00:57:03.447631 | controller | ok: [compute-1]
2025-12-05 00:57:03.499757 | controller |
2025-12-05 00:57:03.499774 | controller | TASK [osp.edpm.edpm_container_manage : Set podman_drop_in fact] ****************
2025-12-05 00:57:03.499781 | controller | Friday 05 December 2025  00:57:03 +0000 (0:00:00.234)       0:00:36.443 *******
2025-12-05 00:57:03.499790 | controller | skipping: [compute-1]
2025-12-05 00:57:05.064816 | controller |
2025-12-05 00:57:05.064845 | controller | TASK [osp.edpm.edpm_container_manage : Manage container systemd services and cleanup old systemd healthchecks for /var/lib/edpm-config/container-startup-config/kepler] ***
2025-12-05 00:57:05.064854 | controller | Friday 05 December 2025  00:57:03 +0000 (0:00:00.052)       0:00:36.495 *******
2025-12-05 00:57:05.064864 | controller | changed: [compute-1]
2025-12-05 00:57:05.177860 | controller |
2025-12-05 00:57:05.177892 | controller | TASK [osp.edpm.edpm_container_standalone : Update service state file] **********
2025-12-05 00:57:05.177900 | controller | Friday 05 December 2025  00:57:05 +0000 (0:00:01.565)       0:00:38.061 *******
2025-12-05 00:57:05.177911 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_container_standalone/tasks/state_file_update.yml for compute-1
2025-12-05 00:57:05.177936 | controller |
2025-12-05 00:57:05.177942 | controller | TASK [osp.edpm.edpm_container_standalone : Read current state file] ************
2025-12-05 00:57:05.177948 | controller | Friday 05 December 2025  00:57:05 +0000 (0:00:00.113)       0:00:38.174 *******
2025-12-05 00:57:05.367877 | controller | ok: [compute-1]
2025-12-05 00:57:05.425593 | controller |
2025-12-05 00:57:05.425620 | controller | TASK [osp.edpm.edpm_container_standalone : Parse state file data] **************
2025-12-05 00:57:05.425628 | controller | Friday 05 December 2025  00:57:05 +0000 (0:00:00.189)       0:00:38.364 *******
2025-12-05 00:57:05.425638 | controller | ok: [compute-1]
2025-12-05 00:57:05.471532 | controller |
2025-12-05 00:57:05.471556 | controller | TASK [osp.edpm.edpm_container_standalone : Initialize empty state data if file doesn't exist] ***
2025-12-05 00:57:05.471564 | controller | Friday 05 December 2025  00:57:05 +0000 (0:00:00.057)       0:00:38.421 *******
2025-12-05 00:57:05.471574 | controller | skipping: [compute-1]
2025-12-05 00:57:05.581955 | controller |
2025-12-05 00:57:05.581999 | controller | TASK [osp.edpm.edpm_container_standalone : Update service in state data] *******
2025-12-05 00:57:05.582010 | controller | Friday 05 December 2025  00:57:05 +0000 (0:00:00.046)       0:00:38.467 *******
2025-12-05 00:57:05.582025 | controller | ok: [compute-1]
2025-12-05 00:57:06.072781 | controller |
2025-12-05 00:57:06.072812 | controller | TASK [osp.edpm.edpm_container_standalone : Write updated state file] ***********
2025-12-05 00:57:06.072820 | controller | Friday 05 December 2025  00:57:05 +0000 (0:00:00.110)       0:00:38.578 *******
2025-12-05 00:57:06.072830 | controller | changed: [compute-1]
2025-12-05 00:57:07.260424 | controller |
2025-12-05 00:57:07.260454 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Restart ceilometer ipmi] ******
2025-12-05 00:57:07.260462 | controller | Friday 05 December 2025  00:57:06 +0000 (0:00:00.490)       0:00:39.068 *******
2025-12-05 00:57:07.260476 | controller | changed: [compute-1]
2025-12-05 00:57:08.068046 | controller |
2025-12-05 00:57:08.068077 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Enable and start Kepler service] ***
2025-12-05 00:57:08.068086 | controller | Friday 05 December 2025  00:57:07 +0000 (0:00:01.187)       0:00:40.256 *******
2025-12-05 00:57:08.068096 | controller | changed: [compute-1]
2025-12-05 00:57:08.288084 | controller |
2025-12-05 00:57:08.288113 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : List deployed health check scripts] ***
2025-12-05 00:57:08.288121 | controller | Friday 05 December 2025  00:57:08 +0000 (0:00:00.807)       0:00:41.064 *******
2025-12-05 00:57:08.288132 | controller | ok: [compute-1]
2025-12-05 00:57:08.371206 | controller |
2025-12-05 00:57:08.371228 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Correct health check scripts ownership based on container user IDs] ***
2025-12-05 00:57:08.371235 | controller | Friday 05 December 2025  00:57:08 +0000 (0:00:00.220)       0:00:41.284 *******
2025-12-05 00:57:08.371246 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_telemetry_power_monitoring/tasks/chown_healthcheck.yml for compute-1 => (item={'path': '/var/lib/openstack/healthchecks/ceilometer_agent_ipmi', 'mode': '0700', 'isdir': True, 'ischr': False, 'isblk': False, 'isreg': False, 'isfifo': False, 'islnk': False, 'issock': False, 'uid': 1000, 'gid': 1000, 'size': 51, 'inode': 92302916, 'dev': 64513, 'nlink': 2, 'atime': 1764896227.0841591, 'mtime': 1764896198.8978474, 'ctime': 1764896212.8050013, 'gr_name': 'zuul', 'pw_name': 'zuul', 'wusr': True, 'rusr': True, 'xusr': True, 'wgrp': False, 'rgrp': False, 'xgrp': False, 'woth': False, 'roth': False, 'xoth': False, 'isuid': False, 'isgid': False})
2025-12-05 00:57:08.423290 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_telemetry_power_monitoring/tasks/chown_healthcheck.yml for compute-1 => (item={'path': '/var/lib/openstack/healthchecks/kepler', 'mode': '0700', 'isdir': True, 'ischr': False, 'isblk': False, 'isreg': False, 'isfifo': False, 'islnk': False, 'issock': False, 'uid': 1000, 'gid': 1000, 'size': 25, 'inode': 117479425, 'dev': 64513, 'nlink': 2, 'atime': 1764896227.8901682, 'mtime': 1764896199.222851, 'ctime': 1764896224.897135, 'gr_name': 'zuul', 'pw_name': 'zuul', 'wusr': True, 'rusr': True, 'xusr': True, 'wgrp': False, 'rgrp': False, 'xgrp': False, 'woth': False, 'roth': False, 'xoth': False, 'isuid': False, 'isgid': False})
2025-12-05 00:57:08.423308 | controller |
2025-12-05 00:57:08.423315 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Resolve container name] *******
2025-12-05 00:57:08.423321 | controller | Friday 05 December 2025  00:57:08 +0000 (0:00:00.083)       0:00:41.367 *******
2025-12-05 00:57:08.423329 | controller | ok: [compute-1]
2025-12-05 00:57:08.730457 | controller |
2025-12-05 00:57:08.730492 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Wait until container is up and running] ***
2025-12-05 00:57:08.730512 | controller | Friday 05 December 2025  00:57:08 +0000 (0:00:00.050)       0:00:41.418 *******
2025-12-05 00:57:08.730523 | controller | ok: [compute-1]
2025-12-05 00:57:09.225000 | controller |
2025-12-05 00:57:09.225043 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Get user under which container runs] ***
2025-12-05 00:57:09.225053 | controller | Friday 05 December 2025  00:57:08 +0000 (0:00:00.308)       0:00:41.726 *******
2025-12-05 00:57:09.225066 | controller | changed: [compute-1]
2025-12-05 00:57:09.225158 | controller |
2025-12-05 00:57:09.225167 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Get group under which container runs] ***
2025-12-05 00:57:09.225176 | controller | Friday 05 December 2025  00:57:09 +0000 (0:00:00.494)       0:00:42.221 *******
2025-12-05 00:57:09.551891 | controller | changed: [compute-1]
2025-12-05 00:57:09.804224 | controller |
2025-12-05 00:57:09.804253 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Correct ownership if health check script for container] ***
2025-12-05 00:57:09.804261 | controller | Friday 05 December 2025  00:57:09 +0000 (0:00:00.326)       0:00:42.547 *******
2025-12-05 00:57:09.804270 | controller | changed: [compute-1]
2025-12-05 00:57:09.853752 | controller |
2025-12-05 00:57:09.853780 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Resolve container name] *******
2025-12-05 00:57:09.853788 | controller | Friday 05 December 2025  00:57:09 +0000 (0:00:00.252)       0:00:42.800 *******
2025-12-05 00:57:09.853798 | controller | ok: [compute-1]
2025-12-05 00:57:10.136779 | controller |
2025-12-05 00:57:10.136813 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Wait until container is up and running] ***
2025-12-05 00:57:10.136821 | controller | Friday 05 December 2025  00:57:09 +0000 (0:00:00.049)       0:00:42.850 *******
2025-12-05 00:57:10.136831 | controller | ok: [compute-1]
2025-12-05 00:57:10.507943 | controller |
2025-12-05 00:57:10.507976 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Get user under which container runs] ***
2025-12-05 00:57:10.507986 | controller | Friday 05 December 2025  00:57:10 +0000 (0:00:00.282)       0:00:43.132 *******
2025-12-05 00:57:10.507998 | controller | changed: [compute-1]
2025-12-05 00:57:10.508091 | controller |
2025-12-05 00:57:10.508203 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Get group under which container runs] ***
2025-12-05 00:57:10.508226 | controller | Friday 05 December 2025  00:57:10 +0000 (0:00:00.371)       0:00:43.504 *******
2025-12-05 00:57:10.834764 | controller | changed: [compute-1]
2025-12-05 00:57:11.073957 | controller |
2025-12-05 00:57:11.073992 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Correct ownership if health check script for container] ***
2025-12-05 00:57:11.074002 | controller | Friday 05 December 2025  00:57:10 +0000 (0:00:00.326)       0:00:43.830 *******
2025-12-05 00:57:11.074014 | controller | changed: [compute-1]
2025-12-05 00:57:11.074116 | controller |
2025-12-05 00:57:11.074128 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Post-install] *****************
2025-12-05 00:57:11.145711 | controller | Friday 05 December 2025  00:57:11 +0000 (0:00:00.239)       0:00:44.070 *******
2025-12-05 00:57:11.145770 | controller | included: /home/zuul/.cache/ansible-compat/9c8f65/collections/ansible_collections/osp/edpm/roles/edpm_telemetry_power_monitoring/tasks/post-install.yml for compute-1
2025-12-05 00:57:11.145941 | controller |
2025-12-05 00:57:11.145956 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Ensure firewall directory is present] ***
2025-12-05 00:57:11.146063 | controller | Friday 05 December 2025  00:57:11 +0000 (0:00:00.072)       0:00:44.142 *******
2025-12-05 00:57:11.401969 | controller | changed: [compute-1]
2025-12-05 00:57:11.402093 | controller |
2025-12-05 00:57:11.402199 | controller | TASK [osp.edpm.edpm_telemetry_power_monitoring : Copy kepler firewall config] ***
2025-12-05 00:57:11.402300 | controller | Friday 05 December 2025  00:57:11 +0000 (0:00:00.255)       0:00:44.398 *******
2025-12-05 00:57:11.799753 | controller | changed: [compute-1]
2025-12-05 00:57:11.877496 | controller |
2025-12-05 00:57:11.877523 | controller | TASK [Configure firewall for kepler] *******************************************
2025-12-05 00:57:11.877532 | controller | Friday 05 December 2025  00:57:11 +0000 (0:00:00.397)       0:00:44.795 *******
2025-12-05 00:57:11.877547 | controller |
2025-12-05 00:57:12.101946 | controller | TASK [osp.edpm.edpm_nftables : Create snippets directory] **********************
2025-12-05 00:57:12.101971 | controller | Friday 05 December 2025  00:57:11 +0000 (0:00:00.077)       0:00:44.873 *******
2025-12-05 00:57:12.101983 | controller | ok: [compute-1]
2025-12-05 00:57:12.102084 | controller |
2025-12-05 00:57:12.102096 | controller | TASK [osp.edpm.edpm_nftables : Push default ruleset snipet] ********************
2025-12-05 00:57:12.102183 | controller | Friday 05 December 2025  00:57:12 +0000 (0:00:00.224)       0:00:45.098 *******
2025-12-05 00:57:12.526152 | controller | changed: [compute-1]
2025-12-05 00:57:12.526273 | controller |
2025-12-05 00:57:12.526287 | controller | TASK [osp.edpm.edpm_nftables : Write user rules snippet] ***********************
2025-12-05 00:57:12.526376 | controller | Friday 05 December 2025  00:57:12 +0000 (0:00:00.424)       0:00:45.522 *******
2025-12-05 00:57:12.916605 | controller | changed: [compute-1]
2025-12-05 00:57:12.916747 | controller |
2025-12-05 00:57:12.916880 | controller | TASK [osp.edpm.edpm_nftables : Push empty ruleset] *****************************
2025-12-05 00:57:12.916899 | controller | Friday 05 December 2025  00:57:12 +0000 (0:00:00.390)       0:00:45.913 *******
2025-12-05 00:57:13.301822 | controller | changed: [compute-1]
2025-12-05 00:57:13.572649 | controller |
2025-12-05 00:57:13.572685 | controller | TASK [osp.edpm.edpm_nftables : Load empty ruleset] *****************************
2025-12-05 00:57:13.572695 | controller | Friday 05 December 2025  00:57:13 +0000 (0:00:00.384)       0:00:46.297 *******
2025-12-05 00:57:13.572707 | controller | changed: [compute-1]
2025-12-05 00:57:13.800964 | controller |
2025-12-05 00:57:13.801002 | controller | TASK [osp.edpm.edpm_nftables : Get current nftables content] *******************
2025-12-05 00:57:13.801014 | controller | Friday 05 December 2025  00:57:13 +0000 (0:00:00.270)       0:00:46.568 *******
2025-12-05 00:57:13.801028 | controller | changed: [compute-1]
2025-12-05 00:57:13.801159 | controller |
2025-12-05 00:57:13.801174 | controller | TASK [osp.edpm.edpm_nftables : Load firewall snippets] *************************
2025-12-05 00:57:14.165829 | controller | Friday 05 December 2025  00:57:13 +0000 (0:00:00.228)       0:00:46.797 *******
2025-12-05 00:57:14.165859 | controller | ok: [compute-1]
2025-12-05 00:57:14.165941 | controller |
2025-12-05 00:57:14.165951 | controller | TASK [osp.edpm.edpm_nftables : Generate chain jumps] ***************************
2025-12-05 00:57:14.166087 | controller | Friday 05 December 2025  00:57:14 +0000 (0:00:00.365)       0:00:47.162 *******
2025-12-05 00:57:14.594623 | controller | changed: [compute-1]
2025-12-05 00:57:15.028693 | controller |
2025-12-05 00:57:15.028745 | controller | TASK [osp.edpm.edpm_nftables : Generate chain jumps] ***************************
2025-12-05 00:57:15.028757 | controller | Friday 05 December 2025  00:57:14 +0000 (0:00:00.428)       0:00:47.590 *******
2025-12-05 00:57:15.028767 | controller | changed: [compute-1]
2025-12-05 00:57:15.426616 | controller |
2025-12-05 00:57:15.426646 | controller | TASK [osp.edpm.edpm_nftables : Generate nft flushes] ***************************
2025-12-05 00:57:15.426654 | controller | Friday 05 December 2025  00:57:15 +0000 (0:00:00.433)       0:00:48.024 *******
2025-12-05 00:57:15.426664 | controller | changed: [compute-1]
2025-12-05 00:57:15.853868 | controller |
2025-12-05 00:57:15.853908 | controller | TASK [osp.edpm.edpm_nftables : Generate nft edpm chains] ***********************
2025-12-05 00:57:15.853920 | controller | Friday 05 December 2025  00:57:15 +0000 (0:00:00.397)       0:00:48.422 *******
2025-12-05 00:57:15.853933 | controller | changed: [compute-1]
2025-12-05 00:57:16.304590 | controller |
2025-12-05 00:57:16.304623 | controller | TASK [osp.edpm.edpm_nftables : Generate nft ruleset in static file] ************
2025-12-05 00:57:16.304637 | controller | Friday 05 December 2025  00:57:15 +0000 (0:00:00.427)       0:00:48.849 *******
2025-12-05 00:57:16.304648 | controller | changed: [compute-1]
2025-12-05 00:57:16.540617 | controller |
2025-12-05 00:57:16.540648 | controller | TASK [osp.edpm.edpm_nftables : Create a sentinel file when nft rules are changed] ***
2025-12-05 00:57:16.540656 | controller | Friday 05 December 2025  00:57:16 +0000 (0:00:00.450)       0:00:49.300 *******
2025-12-05 00:57:16.540666 | controller | changed: [compute-1]
2025-12-05 00:57:16.822786 | controller |
2025-12-05 00:57:16.822815 | controller | TASK [osp.edpm.edpm_nftables : Validate all of the generated content before loading] ***
2025-12-05 00:57:16.822823 | controller | Friday 05 December 2025  00:57:16 +0000 (0:00:00.235)       0:00:49.536 *******
2025-12-05 00:57:16.822832 | controller | changed: [compute-1]
2025-12-05 00:57:17.225904 | controller |
2025-12-05 00:57:17.225944 | controller | TASK [osp.edpm.edpm_nftables : Ensure we load our different nft rulesets on boot] ***
2025-12-05 00:57:17.225952 | controller | Friday 05 December 2025  00:57:16 +0000 (0:00:00.282)       0:00:49.818 *******
2025-12-05 00:57:17.225963 | controller | changed: [compute-1]
2025-12-05 00:57:17.310161 | controller |
2025-12-05 00:57:17.310188 | controller | TASK [Reload firewall for kepler] **********************************************
2025-12-05 00:57:17.310205 | controller | Friday 05 December 2025  00:57:17 +0000 (0:00:00.401)       0:00:50.220 *******
2025-12-05 00:57:17.310216 | controller |
2025-12-05 00:57:17.555103 | controller | TASK [osp.edpm.edpm_nftables : Inject our custom chains in nftables] ***********
2025-12-05 00:57:17.555149 | controller | Friday 05 December 2025  00:57:17 +0000 (0:00:00.085)       0:00:50.306 *******
2025-12-05 00:57:17.555169 | controller | changed: [compute-1]
2025-12-05 00:57:17.555283 | controller |
2025-12-05 00:57:17.555293 | controller | TASK [osp.edpm.edpm_nftables : Check if rules are changed] *********************
2025-12-05 00:57:17.782880 | controller | Friday 05 December 2025  00:57:17 +0000 (0:00:00.244)       0:00:50.551 *******
2025-12-05 00:57:17.782915 | controller | ok: [compute-1]
2025-12-05 00:57:17.783018 | controller |
2025-12-05 00:57:17.783114 | controller | TASK [osp.edpm.edpm_nftables : Reload ruleset] *********************************
2025-12-05 00:57:17.783204 | controller | Friday 05 December 2025  00:57:17 +0000 (0:00:00.228)       0:00:50.779 *******
2025-12-05 00:57:18.056972 | controller | changed: [compute-1]
2025-12-05 00:57:18.057107 | controller |
2025-12-05 00:57:18.057122 | controller | TASK [osp.edpm.edpm_nftables : Delete nft_ruleset_changed file] ****************
2025-12-05 00:57:18.396096 | controller | Friday 05 December 2025  00:57:18 +0000 (0:00:00.273)       0:00:51.053 *******
2025-12-05 00:57:18.396138 | controller | changed: [compute-1]
2025-12-05 00:57:18.485336 | controller |
2025-12-05 00:57:18.485357 | controller | PLAY RECAP *********************************************************************
2025-12-05 00:57:18.485364 | controller | compute-1                  : ok=121  changed=53   unreachable=0    failed=0    skipped=16   rescued=0    ignored=1
2025-12-05 00:57:18.485370 | controller |
2025-12-05 00:57:18.485375 | controller | Friday 05 December 2025  00:57:18 +0000 (0:00:00.336)       0:00:51.389 *******
2025-12-05 00:57:18.485381 | controller | ===============================================================================
2025-12-05 00:57:18.485390 | controller | osp.edpm.edpm_container_manage : Create containers managed by Podman for /var/lib/edpm-config/container-startup-config/ceilometer_agent_ipmi --- 7.99s
2025-12-05 00:57:18.485396 | controller | osp.edpm.edpm_container_manage : Create containers managed by Podman for /var/lib/edpm-config/container-startup-config/kepler --- 6.20s
2025-12-05 00:57:18.485402 | controller | osp.edpm.edpm_container_manage : Manage container systemd services and cleanup old systemd healthchecks for /var/lib/edpm-config/container-startup-config/ceilometer_agent_ipmi --- 1.78s
2025-12-05 00:57:18.485407 | controller | osp.edpm.edpm_tripleo_cleanup : Gather service facts -------------------- 1.75s
2025-12-05 00:57:18.485412 | controller | osp.edpm.edpm_container_manage : Manage container systemd services and cleanup old systemd healthchecks for /var/lib/edpm-config/container-startup-config/kepler --- 1.57s
2025-12-05 00:57:18.485417 | controller | osp.edpm.edpm_telemetry_power_monitoring : Restart ceilometer ipmi ------ 1.19s
2025-12-05 00:57:18.485422 | controller | osp.edpm.edpm_telemetry_power_monitoring : Deploy telemetry health check scripts --- 1.00s
2025-12-05 00:57:18.485427 | controller | osp.edpm.edpm_telemetry_power_monitoring : Enable and start Kepler service --- 0.81s
2025-12-05 00:57:18.485432 | controller | Gathering Facts --------------------------------------------------------- 0.81s
2025-12-05 00:57:18.485437 | controller | osp.edpm.edpm_tripleo_cleanup : Reload units to check for new changes --- 0.60s
2025-12-05 00:57:18.485442 | controller | osp.edpm.edpm_telemetry_power_monitoring : Get user under which container runs --- 0.49s
2025-12-05 00:57:18.485447 | controller | osp.edpm.edpm_container_standalone : Write updated state file ----------- 0.49s
2025-12-05 00:57:18.485452 | controller | osp.edpm.edpm_nftables : Generate nft ruleset in static file ------------ 0.45s
2025-12-05 00:57:18.485457 | controller | osp.edpm.edpm_users : Ensure user is present on the host [ ceilometer ] --- 0.44s
2025-12-05 00:57:18.485462 | controller | osp.edpm.edpm_nftables : Generate chain jumps --------------------------- 0.43s
2025-12-05 00:57:18.485467 | controller | osp.edpm.edpm_telemetry_power_monitoring : Render ceilometer config template --- 0.43s
2025-12-05 00:57:18.485471 | controller | osp.edpm.edpm_nftables : Generate chain jumps --------------------------- 0.43s
2025-12-05 00:57:18.485476 | controller | osp.edpm.edpm_nftables : Generate nft edpm chains ----------------------- 0.43s
2025-12-05 00:57:18.485481 | controller | osp.edpm.edpm_nftables : Push default ruleset snipet -------------------- 0.42s
2025-12-05 00:57:18.485486 | controller | osp.edpm.edpm_tripleo_cleanup : Reload units ---------------------------- 0.41s
2025-12-05 00:57:18.485494 | controller | INFO     Running default > verify
2025-12-05 00:57:18.485888 | controller | INFO     Running Ansible Verifier
2025-12-05 00:57:18.903575 | controller |
2025-12-05 00:57:19.781908 | controller | PLAY [Verify ceilometer] *******************************************************
2025-12-05 00:57:19.781939 | controller |
2025-12-05 00:57:19.781946 | controller | TASK [Gathering Facts] *********************************************************
2025-12-05 00:57:19.781952 | controller | Friday 05 December 2025  00:57:18 +0000 (0:00:00.036)       0:00:00.036 *******
2025-12-05 00:57:19.781968 | controller | ok: [compute-1]
2025-12-05 00:57:19.862908 | controller |
2025-12-05 00:57:19.862932 | controller | TASK [ensure expected config files exist] **************************************
2025-12-05 00:57:19.862939 | controller | Friday 05 December 2025  00:57:19 +0000 (0:00:00.878)       0:00:00.914 *******
2025-12-05 00:57:19.862949 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/molecule/test-helpers/verify_dir.yaml for compute-1 => (item=/var/lib/openstack/telemetry-power-monitoring/ceilometer.conf)
2025-12-05 00:57:20.195316 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/molecule/test-helpers/verify_dir.yaml for compute-1 => (item=/var/lib/openstack/telemetry-power-monitoring/polling.yaml)
2025-12-05 00:57:20.195346 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/molecule/test-helpers/verify_dir.yaml for compute-1 => (item=/var/lib/openstack/telemetry-power-monitoring/ceilometer-host-specific.conf)
2025-12-05 00:57:20.195363 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/molecule/test-helpers/verify_dir.yaml for compute-1 => (item=/var/lib/openstack/telemetry-power-monitoring/firewall.yaml)
2025-12-05 00:57:20.195369 | controller |
2025-12-05 00:57:20.195375 | controller | TASK [Check if directory exists /var/lib/openstack/telemetry-power-monitoring/ceilometer.conf] ***
2025-12-05 00:57:20.195380 | controller | Friday 05 December 2025  00:57:19 +0000 (0:00:00.080)       0:00:00.995 *******
2025-12-05 00:57:20.195390 | controller | ok: [compute-1]
2025-12-05 00:57:20.265614 | controller |
2025-12-05 00:57:20.265644 | controller | TASK [Assert directory exists /var/lib/openstack/telemetry-power-monitoring/ceilometer.conf] ***
2025-12-05 00:57:20.265652 | controller | Friday 05 December 2025  00:57:20 +0000 (0:00:00.333)       0:00:01.328 *******
2025-12-05 00:57:20.265661 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:20.504606 | controller |   msg: All assertions passed
2025-12-05 00:57:20.504637 | controller |
2025-12-05 00:57:20.504645 | controller | TASK [Check if directory exists /var/lib/openstack/telemetry-power-monitoring/polling.yaml] ***
2025-12-05 00:57:20.504651 | controller | Friday 05 December 2025  00:57:20 +0000 (0:00:00.070)       0:00:01.398 *******
2025-12-05 00:57:20.504661 | controller | ok: [compute-1]
2025-12-05 00:57:20.547063 | controller |
2025-12-05 00:57:20.547089 | controller | TASK [Assert directory exists /var/lib/openstack/telemetry-power-monitoring/polling.yaml] ***
2025-12-05 00:57:20.547097 | controller | Friday 05 December 2025  00:57:20 +0000 (0:00:00.238)       0:00:01.637 *******
2025-12-05 00:57:20.547107 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:20.784052 | controller |   msg: All assertions passed
2025-12-05 00:57:20.784087 | controller |
2025-12-05 00:57:20.784097 | controller | TASK [Check if directory exists /var/lib/openstack/telemetry-power-monitoring/ceilometer-host-specific.conf] ***
2025-12-05 00:57:20.784105 | controller | Friday 05 December 2025  00:57:20 +0000 (0:00:00.042)       0:00:01.680 *******
2025-12-05 00:57:20.784117 | controller | ok: [compute-1]
2025-12-05 00:57:20.829938 | controller |
2025-12-05 00:57:20.829975 | controller | TASK [Assert directory exists /var/lib/openstack/telemetry-power-monitoring/ceilometer-host-specific.conf] ***
2025-12-05 00:57:20.829985 | controller | Friday 05 December 2025  00:57:20 +0000 (0:00:00.236)       0:00:01.916 *******
2025-12-05 00:57:20.830002 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:20.830102 | controller |   msg: All assertions passed
2025-12-05 00:57:20.830112 | controller |
2025-12-05 00:57:20.830122 | controller | TASK [Check if directory exists /var/lib/openstack/telemetry-power-monitoring/firewall.yaml] ***
2025-12-05 00:57:21.082965 | controller | Friday 05 December 2025  00:57:20 +0000 (0:00:00.046)       0:00:01.962 *******
2025-12-05 00:57:21.083012 | controller | ok: [compute-1]
2025-12-05 00:57:21.083113 | controller |
2025-12-05 00:57:21.083124 | controller | TASK [Assert directory exists /var/lib/openstack/telemetry-power-monitoring/firewall.yaml] ***
2025-12-05 00:57:21.083135 | controller | Friday 05 December 2025  00:57:21 +0000 (0:00:00.252)       0:00:02.215 *******
2025-12-05 00:57:21.126011 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:21.208969 | controller |   msg: All assertions passed
2025-12-05 00:57:21.208989 | controller |
2025-12-05 00:57:21.208996 | controller | TASK [ensure podman container exists and are running] **************************
2025-12-05 00:57:21.209002 | controller | Friday 05 December 2025  00:57:21 +0000 (0:00:00.042)       0:00:02.258 *******
2025-12-05 00:57:21.209014 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/molecule/test-helpers/verify_podman.yaml for compute-1 => (item=ceilometer_agent_ipmi)
2025-12-05 00:57:21.577460 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/molecule/test-helpers/verify_podman.yaml for compute-1 => (item=kepler)
2025-12-05 00:57:21.577490 | controller |
2025-12-05 00:57:21.577499 | controller | TASK [Check if podman container exists ceilometer_agent_ipmi] ******************
2025-12-05 00:57:21.577505 | controller | Friday 05 December 2025  00:57:21 +0000 (0:00:00.082)       0:00:02.341 *******
2025-12-05 00:57:21.577515 | controller | changed: [compute-1]
2025-12-05 00:57:21.658870 | controller |
2025-12-05 00:57:21.658896 | controller | TASK [Assert podman container exists ceilometer_agent_ipmi] ********************
2025-12-05 00:57:21.658916 | controller | Friday 05 December 2025  00:57:21 +0000 (0:00:00.368)       0:00:02.710 *******
2025-12-05 00:57:21.658929 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:21.933015 | controller |   msg: All assertions passed
2025-12-05 00:57:21.933056 | controller |
2025-12-05 00:57:21.933067 | controller | TASK [Check if podman container is running ceilometer_agent_ipmi] **************
2025-12-05 00:57:21.933076 | controller | Friday 05 December 2025  00:57:21 +0000 (0:00:00.081)       0:00:02.791 *******
2025-12-05 00:57:21.933090 | controller | changed: [compute-1]
2025-12-05 00:57:21.987979 | controller |
2025-12-05 00:57:21.988013 | controller | TASK [Assert podman container is running ceilometer_agent_ipmi] ****************
2025-12-05 00:57:21.988024 | controller | Friday 05 December 2025  00:57:21 +0000 (0:00:00.273)       0:00:03.065 *******
2025-12-05 00:57:21.988037 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:21.988149 | controller |   msg: All assertions passed
2025-12-05 00:57:21.988159 | controller |
2025-12-05 00:57:21.988170 | controller | TASK [Check if podman container exists kepler] *********************************
2025-12-05 00:57:22.272046 | controller | Friday 05 December 2025  00:57:21 +0000 (0:00:00.055)       0:00:03.121 *******
2025-12-05 00:57:22.272121 | controller | changed: [compute-1]
2025-12-05 00:57:22.272212 | controller |
2025-12-05 00:57:22.272223 | controller | TASK [Assert podman container exists kepler] ***********************************
2025-12-05 00:57:22.327042 | controller | Friday 05 December 2025  00:57:22 +0000 (0:00:00.283)       0:00:03.404 *******
2025-12-05 00:57:22.327115 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:22.327242 | controller |   msg: All assertions passed
2025-12-05 00:57:22.327255 | controller |
2025-12-05 00:57:22.327267 | controller | TASK [Check if podman container is running kepler] *****************************
2025-12-05 00:57:22.632895 | controller | Friday 05 December 2025  00:57:22 +0000 (0:00:00.055)       0:00:03.459 *******
2025-12-05 00:57:22.632953 | controller | changed: [compute-1]
2025-12-05 00:57:22.686972 | controller |
2025-12-05 00:57:22.687013 | controller | TASK [Assert podman container is running kepler] *******************************
2025-12-05 00:57:22.687023 | controller | Friday 05 December 2025  00:57:22 +0000 (0:00:00.305)       0:00:03.765 *******
2025-12-05 00:57:22.687035 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:22.764188 | controller |   msg: All assertions passed
2025-12-05 00:57:22.764210 | controller |
2025-12-05 00:57:22.764218 | controller | TASK [ensure systemd services are defined and functional] **********************
2025-12-05 00:57:22.764224 | controller | Friday 05 December 2025  00:57:22 +0000 (0:00:00.054)       0:00:03.819 *******
2025-12-05 00:57:22.764240 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/molecule/test-helpers/verify_systemd_unit.yaml for compute-1 => (item={'name': 'edpm_ceilometer_agent_ipmi.service'})
2025-12-05 00:57:23.005315 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/molecule/test-helpers/verify_systemd_unit.yaml for compute-1 => (item={'name': 'edpm_kepler.service'})
2025-12-05 00:57:23.005343 | controller |
2025-12-05 00:57:23.005354 | controller | TASK [Check if systemd file exists edpm_ceilometer_agent_ipmi.service] *********
2025-12-05 00:57:23.005363 | controller | Friday 05 December 2025  00:57:22 +0000 (0:00:00.077)       0:00:03.897 *******
2025-12-05 00:57:23.005374 | controller | ok: [compute-1]
2025-12-05 00:57:23.075079 | controller |
2025-12-05 00:57:23.075146 | controller | TASK [Assert systemd unit exists edpm_ceilometer_agent_ipmi.service] ***********
2025-12-05 00:57:23.075160 | controller | Friday 05 December 2025  00:57:23 +0000 (0:00:00.240)       0:00:04.138 *******
2025-12-05 00:57:23.075178 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:23.075313 | controller |   msg: All assertions passed
2025-12-05 00:57:23.075326 | controller |
2025-12-05 00:57:23.075336 | controller | TASK [Check if systemd unit is enabled edpm_ceilometer_agent_ipmi.service] *****
2025-12-05 00:57:23.075348 | controller | Friday 05 December 2025  00:57:23 +0000 (0:00:00.070)       0:00:04.208 *******
2025-12-05 00:57:23.296004 | controller | ok: [compute-1]
2025-12-05 00:57:23.341693 | controller |
2025-12-05 00:57:23.341738 | controller | TASK [Assert systemd unit is enabled edpm_ceilometer_agent_ipmi.service] *******
2025-12-05 00:57:23.341750 | controller | Friday 05 December 2025  00:57:23 +0000 (0:00:00.220)       0:00:04.428 *******
2025-12-05 00:57:23.341765 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:23.559751 | controller |   msg: All assertions passed
2025-12-05 00:57:23.559771 | controller |
2025-12-05 00:57:23.559779 | controller | TASK [Check if systemd unit is running edpm_ceilometer_agent_ipmi.service] *****
2025-12-05 00:57:23.559785 | controller | Friday 05 December 2025  00:57:23 +0000 (0:00:00.045)       0:00:04.474 *******
2025-12-05 00:57:23.559793 | controller | ok: [compute-1]
2025-12-05 00:57:23.607982 | controller |
2025-12-05 00:57:23.608032 | controller | TASK [Assert systemd unit is running edpm_ceilometer_agent_ipmi.service] *******
2025-12-05 00:57:23.608044 | controller | Friday 05 December 2025  00:57:23 +0000 (0:00:00.217)       0:00:04.692 *******
2025-12-05 00:57:23.608060 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:23.608171 | controller |   msg: All assertions passed
2025-12-05 00:57:23.608283 | controller |
2025-12-05 00:57:23.608296 | controller | TASK [Check if systemd file exists edpm_kepler.service] ************************
2025-12-05 00:57:23.608461 | controller | Friday 05 December 2025  00:57:23 +0000 (0:00:00.048)       0:00:04.741 *******
2025-12-05 00:57:23.881000 | controller | ok: [compute-1]
2025-12-05 00:57:23.881044 | controller |
2025-12-05 00:57:23.881054 | controller | TASK [Assert systemd unit exists edpm_kepler.service] **************************
2025-12-05 00:57:23.881067 | controller | Friday 05 December 2025  00:57:23 +0000 (0:00:00.272)       0:00:05.013 *******
2025-12-05 00:57:23.928909 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:24.148779 | controller |   msg: All assertions passed
2025-12-05 00:57:24.148802 | controller |
2025-12-05 00:57:24.148810 | controller | TASK [Check if systemd unit is enabled edpm_kepler.service] ********************
2025-12-05 00:57:24.148816 | controller | Friday 05 December 2025  00:57:23 +0000 (0:00:00.047)       0:00:05.061 *******
2025-12-05 00:57:24.148824 | controller | ok: [compute-1]
2025-12-05 00:57:24.195995 | controller |
2025-12-05 00:57:24.196041 | controller | TASK [Assert systemd unit is enabled edpm_kepler.service] **********************
2025-12-05 00:57:24.196052 | controller | Friday 05 December 2025  00:57:24 +0000 (0:00:00.219)       0:00:05.281 *******
2025-12-05 00:57:24.196067 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:24.196176 | controller |   msg: All assertions passed
2025-12-05 00:57:24.196187 | controller |
2025-12-05 00:57:24.196194 | controller | TASK [Check if systemd unit is running edpm_kepler.service] ********************
2025-12-05 00:57:24.196205 | controller | Friday 05 December 2025  00:57:24 +0000 (0:00:00.047)       0:00:05.328 *******
2025-12-05 00:57:24.415750 | controller | ok: [compute-1]
2025-12-05 00:57:24.463301 | controller |
2025-12-05 00:57:24.463327 | controller | TASK [Assert systemd unit is running edpm_kepler.service] **********************
2025-12-05 00:57:24.463338 | controller | Friday 05 December 2025  00:57:24 +0000 (0:00:00.220)       0:00:05.548 *******
2025-12-05 00:57:24.463350 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:25.705693 | controller |   msg: All assertions passed
2025-12-05 00:57:25.705749 | controller |
2025-12-05 00:57:25.705761 | controller | TASK [ensure kolla_set_configs copied the expected files and started the correct binary] ***
2025-12-05 00:57:25.705768 | controller | Friday 05 December 2025  00:57:24 +0000 (0:00:00.047)       0:00:05.595 *******
2025-12-05 00:57:25.705778 | controller | changed: [compute-1] => (item=Copying /var/lib/kolla/config_files/src/ceilometer.conf to /etc/ceilometer/ceilometer.conf)
2025-12-05 00:57:25.777958 | controller | changed: [compute-1] => (item=Copying /var/lib/kolla/config_files/src/polling.yaml to /etc/ceilometer/polling.yaml)
2025-12-05 00:57:25.777998 | controller | changed: [compute-1] => (item=/usr/bin/ceilometer-polling --polling-namespaces ipmi --logfile /dev/stdout)
2025-12-05 00:57:25.778009 | controller | changed: [compute-1] => (item=Copying /var/lib/kolla/config_files/src/ceilometer-host-specific.conf to /etc/ceilometer/ceilometer.conf.d/02-ceilometer-host-specific.conf)
2025-12-05 00:57:25.778017 | controller |
2025-12-05 00:57:25.778025 | controller | TASK [ensure firewall is configured] *******************************************
2025-12-05 00:57:25.778041 | controller | Friday 05 December 2025  00:57:25 +0000 (0:00:01.242)       0:00:06.838 *******
2025-12-05 00:57:25.778055 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/edpm-ansible/roles/edpm_telemetry_power_monitoring/molecule/default/test-helpers/kepler.yaml for compute-1
2025-12-05 00:57:25.778172 | controller |
2025-12-05 00:57:25.778186 | controller | TASK [kepler rule source file exists] ******************************************
2025-12-05 00:57:26.032872 | controller | Friday 05 December 2025  00:57:25 +0000 (0:00:00.072)       0:00:06.911 *******
2025-12-05 00:57:26.032900 | controller | ok: [compute-1]
2025-12-05 00:57:26.032999 | controller |
2025-12-05 00:57:26.033170 | controller | TASK [Assert kepler rule source file exists] ***********************************
2025-12-05 00:57:26.033211 | controller | Friday 05 December 2025  00:57:26 +0000 (0:00:00.254)       0:00:07.166 *******
2025-12-05 00:57:26.079753 | controller | ok: [compute-1] => changed=false
2025-12-05 00:57:26.317012 | controller |   msg: All assertions passed
2025-12-05 00:57:26.317050 | controller |
2025-12-05 00:57:26.317061 | controller | TASK [Run nft list command and grep for Kepler rule in EDPM_INPUT chain] *******
2025-12-05 00:57:26.317070 | controller | Friday 05 December 2025  00:57:26 +0000 (0:00:00.046)       0:00:07.212 *******
2025-12-05 00:57:26.317084 | controller | changed: [compute-1]
2025-12-05 00:57:26.317192 | controller |
2025-12-05 00:57:26.317205 | controller | TASK [Assert that output from greping for VNC contains the correct rule] *******
2025-12-05 00:57:26.485978 | controller | Friday 05 December 2025  00:57:26 +0000 (0:00:00.237)       0:00:07.450 *******
2025-12-05 00:57:26.486019 | controller | ok: [compute-1] => (item=               tcp dport 8888 ct state new counter packets 0 bytes 0 accept comment "000 Allow Kepler traffic") => changed=false
2025-12-05 00:57:26.486218 | controller |   ansible_loop_var: item
2025-12-05 00:57:26.486232 | controller |   item: "\t\ttcp dport 8888 ct state new counter packets 0 bytes 0 accept comment \"000 Allow Kepler traffic\""
2025-12-05 00:57:26.486241 | controller |   msg: All assertions passed
2025-12-05 00:57:26.486249 | controller |
2025-12-05 00:57:26.486257 | controller | PLAY RECAP *********************************************************************
2025-12-05 00:57:26.486264 | controller | compute-1                  : ok=43   changed=6    unreachable=0    failed=0    skipped=0    rescued=0    ignored=0
2025-12-05 00:57:26.486272 | controller |
2025-12-05 00:57:26.486279 | controller | Friday 05 December 2025  00:57:26 +0000 (0:00:00.167)       0:00:07.617 *******
2025-12-05 00:57:26.486287 | controller | ===============================================================================
2025-12-05 00:57:26.486294 | controller | ensure kolla_set_configs copied the expected files and started the correct binary --- 1.24s
2025-12-05 00:57:26.486304 | controller | Gathering Facts --------------------------------------------------------- 0.88s
2025-12-05 00:57:26.486414 | controller | Check if podman container exists ceilometer_agent_ipmi ------------------ 0.37s
2025-12-05 00:57:26.486424 | controller | Check if directory exists /var/lib/openstack/telemetry-power-monitoring/ceilometer.conf --- 0.33s
2025-12-05 00:57:26.486434 | controller | Check if podman container is running kepler ----------------------------- 0.31s
2025-12-05 00:57:26.486547 | controller | Check if podman container exists kepler --------------------------------- 0.28s
2025-12-05 00:57:26.486560 | controller | Check if podman container is running ceilometer_agent_ipmi -------------- 0.27s
2025-12-05 00:57:26.486677 | controller | Check if systemd file exists edpm_kepler.service ------------------------ 0.27s
2025-12-05 00:57:26.486689 | controller | kepler rule source file exists ------------------------------------------ 0.25s
2025-12-05 00:57:26.486831 | controller | Check if directory exists /var/lib/openstack/telemetry-power-monitoring/firewall.yaml --- 0.25s
2025-12-05 00:57:26.487655 | controller | Check if systemd file exists edpm_ceilometer_agent_ipmi.service --------- 0.24s
2025-12-05 00:57:26.487689 | controller | Check if directory exists /var/lib/openstack/telemetry-power-monitoring/polling.yaml --- 0.24s
2025-12-05 00:57:26.535965 | controller | Run nft list command and grep for Kepler rule in EDPM_INPUT chain ------- 0.24s
2025-12-05 00:57:26.535984 | controller | Check if directory exists /var/lib/openstack/telemetry-power-monitoring/ceilometer-host-specific.conf --- 0.24s
2025-12-05 00:57:26.535992 | controller | Check if systemd unit is enabled edpm_ceilometer_agent_ipmi.service ----- 0.22s
2025-12-05 00:57:26.535998 | controller | Check if systemd unit is running edpm_kepler.service -------------------- 0.22s
2025-12-05 00:57:26.536003 | controller | Check if systemd unit is enabled edpm_kepler.service -------------------- 0.22s
2025-12-05 00:57:26.536013 | controller | Check if systemd unit is running edpm_ceilometer_agent_ipmi.service ----- 0.22s
2025-12-05 00:57:26.536018 | controller | Assert that output from greping for VNC contains the correct rule ------- 0.17s
2025-12-05 00:57:26.536023 | controller | ensure podman container exists and are running -------------------------- 0.08s
2025-12-05 00:57:26.536031 | controller | INFO     Verifier completed successfully.
2025-12-05 00:57:26.545058 | controller | INFO     Running default > destroy
2025-12-05 00:57:26.545444 | controller | WARNING  Skipping, instances are delegated.
2025-12-05 00:57:26.545923 | controller | INFO     Pruning extra files from scenario ephemeral directory
2025-12-05 00:57:26.800908 | controller | INFO     Writing /tmp/report.html report.
2025-12-05 00:57:32.261374 | controller | changed
2025-12-05 00:57:32.285529 | 
2025-12-05 00:57:32.285583 | PLAY RECAP
2025-12-05 00:57:32.285620 | controller | ok: 4 changed: 2 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0
2025-12-05 00:57:32.285640 | 
2025-12-05 00:57:32.339954 | RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-test.yml@main]
2025-12-05 00:57:32.340713 | POST-RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/collect-logs.yml@main]
2025-12-05 00:57:32.816006 | 
2025-12-05 00:57:32.816102 | PLAY [Run ci/playbooks/collect-logs.yml]
2025-12-05 00:57:32.834629 | 
2025-12-05 00:57:32.834708 | TASK [Filter out host if needed]
2025-12-05 00:57:32.842446 | controller | skipping: end_host conditional evaluated to False, continuing execution for controller
2025-12-05 00:57:32.846721 | 
2025-12-05 00:57:32.846783 | TASK [Ensure file is present]
2025-12-05 00:57:33.138521 | controller | ok
2025-12-05 00:57:33.145217 | 
2025-12-05 00:57:33.145287 | TASK [Manage molecule report file]
2025-12-05 00:57:38.172008 | controller | changed
2025-12-05 00:57:38.177287 | 
2025-12-05 00:57:38.177345 | TASK [Check if we get ci-framework-data basedir]
2025-12-05 00:57:38.388631 | controller | ok
2025-12-05 00:57:38.393591 | 
2025-12-05 00:57:38.393655 | TASK [Create ci-framework-data log directory for zuul]
2025-12-05 00:57:38.696054 | controller | changed
2025-12-05 00:57:38.700747 | 
2025-12-05 00:57:38.700808 | TASK [Copy ci-framework interesting files]
2025-12-05 00:57:43.725753 | controller | changed
2025-12-05 00:57:43.730901 | 
2025-12-05 00:57:43.730998 | TASK [Get SELinux listing]
2025-12-05 00:57:48.755224 | controller | changed
2025-12-05 00:57:48.760602 | 
2025-12-05 00:57:48.760693 | TASK [Generate log index]
2025-12-05 00:57:49.417624 | controller | changed
2025-12-05 00:57:49.422397 | 
2025-12-05 00:57:49.422457 | TASK [Get some env related data]
2025-12-05 00:57:54.446206 | controller | changed
2025-12-05 00:57:54.451090 | 
2025-12-05 00:57:54.451146 | TASK [Generate list of logs to collect in home directory]
2025-12-05 00:57:54.733283 | controller | ok: All paths examined
2025-12-05 00:57:54.737715 | 
2025-12-05 00:57:54.737773 | LOOP [Copy logs from home directory]
2025-12-05 00:57:55.057628 | controller | changed:
2025-12-05 00:57:55.057738 | controller | {
2025-12-05 00:57:55.057764 | controller |   "atime": 1764895926.681597,
2025-12-05 00:57:55.057782 | controller |   "ctime": 1764895942.0728352,
2025-12-05 00:57:55.057797 | controller |   "dev": 64513,
2025-12-05 00:57:55.057811 | controller |   "gid": 1000,
2025-12-05 00:57:55.057825 | controller |   "gr_name": "zuul",
2025-12-05 00:57:55.057838 | controller |   "inode": 4329562,
2025-12-05 00:57:55.057851 | controller |   "isblk": false,
2025-12-05 00:57:55.057864 | controller |   "ischr": false,
2025-12-05 00:57:55.057877 | controller |   "isdir": false,
2025-12-05 00:57:55.057890 | controller |   "isfifo": false,
2025-12-05 00:57:55.057902 | controller |   "isgid": false,
2025-12-05 00:57:55.057965 | controller |   "islnk": false,
2025-12-05 00:57:55.057985 | controller |   "isreg": true,
2025-12-05 00:57:55.058000 | controller |   "issock": false,
2025-12-05 00:57:55.058014 | controller |   "isuid": false,
2025-12-05 00:57:55.058027 | controller |   "mode": "0644",
2025-12-05 00:57:55.058039 | controller |   "mtime": 1764895942.0728352,
2025-12-05 00:57:55.058051 | controller |   "nlink": 1,
2025-12-05 00:57:55.058064 | controller |   "path": "/home/zuul/ansible.log",
2025-12-05 00:57:55.058077 | controller |   "pw_name": "zuul",
2025-12-05 00:57:55.058089 | controller |   "rgrp": true,
2025-12-05 00:57:55.058102 | controller |   "roth": true,
2025-12-05 00:57:55.058114 | controller |   "rusr": true,
2025-12-05 00:57:55.058127 | controller |   "size": 6749,
2025-12-05 00:57:55.058139 | controller |   "uid": 1000,
2025-12-05 00:57:55.058151 | controller |   "wgrp": false,
2025-12-05 00:57:55.058163 | controller |   "woth": false,
2025-12-05 00:57:55.058176 | controller |   "wusr": true,
2025-12-05 00:57:55.058188 | controller |   "xgrp": false,
2025-12-05 00:57:55.058203 | controller |   "xoth": false,
2025-12-05 00:57:55.058215 | controller |   "xusr": false
2025-12-05 00:57:55.058228 | controller | }
2025-12-05 00:57:55.070587 | 
2025-12-05 00:57:55.070643 | TASK [Copy crio stats log file]
2025-12-05 00:57:55.083775 | controller | skipping: Conditional result was False
2025-12-05 00:57:55.088864 | 
2025-12-05 00:57:55.088948 | TASK [Get SELinux related data]
2025-12-05 00:58:00.110823 | controller | ERROR
2025-12-05 00:58:00.111083 | controller | {
2025-12-05 00:58:00.111115 | controller |   "delta": "0:00:00.009182",
2025-12-05 00:58:00.111135 | controller |   "end": "2025-12-05 00:57:55.293331",
2025-12-05 00:58:00.111151 | controller |   "msg": "non-zero return code",
2025-12-05 00:58:00.111166 | controller |   "rc": 1,
2025-12-05 00:58:00.111180 | controller |   "start": "2025-12-05 00:57:55.284149"
2025-12-05 00:58:00.111194 | controller | }
2025-12-05 00:58:00.111215 | controller | ERROR: Ignoring Errors
2025-12-05 00:58:00.116007 | 
2025-12-05 00:58:00.116076 | TASK [Create system configuration directory]
2025-12-05 00:58:00.306208 | controller | changed
2025-12-05 00:58:00.310511 | 
2025-12-05 00:58:00.310571 | TASK [Get some of the system configurations]
2025-12-05 00:58:05.334187 | controller | changed
2025-12-05 00:58:05.339316 | 
2025-12-05 00:58:05.339400 | TASK [Copy generated documentation if available]
2025-12-05 00:58:05.352796 | controller | skipping: Conditional result was False
2025-12-05 00:58:05.358041 | 
2025-12-05 00:58:05.358108 | TASK [Copy generated AsciiDoc documentation if available]
2025-12-05 00:58:05.371263 | controller | skipping: Conditional result was False
2025-12-05 00:58:05.376769 | 
2025-12-05 00:58:05.376830 | TASK [Compress logs bigger than 2MB]
2025-12-05 00:58:10.398136 | controller | changed
2025-12-05 00:58:10.403496 | 
2025-12-05 00:58:10.403561 | TASK [Copy files from workspace on node]
2025-12-05 00:58:10.421507 | controller | ok
2025-12-05 00:58:10.442508 | 
2025-12-05 00:58:10.442575 | TASK [fetch-output : Set log path for multiple nodes]
2025-12-05 00:58:10.455722 | controller | skipping: Conditional result was False
2025-12-05 00:58:10.461425 | 
2025-12-05 00:58:10.461497 | TASK [fetch-output : Set log path for single node]
2025-12-05 00:58:10.488872 | controller | ok
2025-12-05 00:58:10.494085 | 
2025-12-05 00:58:10.494143 | LOOP [fetch-output : Ensure local output dirs]
2025-12-05 00:58:10.680240 | controller -> localhost | ok: "/var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/logs"
2025-12-05 00:58:10.680505 | controller -> localhost | changed: All items complete
2025-12-05 00:58:10.680536 | 
2025-12-05 00:58:10.851118 | controller -> localhost | changed: "/var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/artifacts"
2025-12-05 00:58:11.023090 | controller -> localhost | changed: "/var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/docs"
2025-12-05 00:58:11.032430 | 
2025-12-05 00:58:11.032526 | LOOP [fetch-output : Collect logs, artifacts and docs]
2025-12-05 00:58:11.549951 | controller | changed:
2025-12-05 00:58:11.550143 | controller | .d..t...... ./
2025-12-05 00:58:11.550175 | controller | >f+++++++++ README.html
2025-12-05 00:58:11.550197 | controller | >f+++++++++ ansible-execution.log
2025-12-05 00:58:11.550218 | controller | >f+++++++++ ansible.log
2025-12-05 00:58:11.550237 | controller | >f+++++++++ dmesg.log
2025-12-05 00:58:11.550255 | controller | >f+++++++++ installed-pkgs.log
2025-12-05 00:58:11.550273 | controller | >f+++++++++ python.log
2025-12-05 00:58:11.550289 | controller | >f+++++++++ registries.conf
2025-12-05 00:58:11.550305 | controller | >f+++++++++ report.html
2025-12-05 00:58:11.550323 | controller | >f+++++++++ selinux-denials.log
2025-12-05 00:58:11.550342 | controller | >f+++++++++ selinux-listing.log
2025-12-05 00:58:11.550358 | controller | cd+++++++++ ci-framework-data/
2025-12-05 00:58:11.550375 | controller | cd+++++++++ ci-framework-data/artifacts/
2025-12-05 00:58:11.550391 | controller | >f+++++++++ ci-framework-data/artifacts/zuul_inventory.yml
2025-12-05 00:58:11.550406 | controller | cd+++++++++ ci-framework-data/artifacts/parameters/
2025-12-05 00:58:11.550420 | controller | >f+++++++++ ci-framework-data/artifacts/parameters/zuul-params.yml
2025-12-05 00:58:11.550440 | controller | cd+++++++++ ci-framework-data/logs/
2025-12-05 00:58:11.550457 | controller | >f+++++++++ ci-framework-data/logs/molecule-execution.log
2025-12-05 00:58:11.550473 | controller | cd+++++++++ registries.conf.d/
2025-12-05 00:58:11.550488 | controller | >f+++++++++ registries.conf.d/000-shortnames.conf
2025-12-05 00:58:11.550502 | controller | cd+++++++++ system-config/
2025-12-05 00:58:11.550517 | controller | cd+++++++++ system-config/libvirt/
2025-12-05 00:58:11.550531 | controller | >f+++++++++ system-config/libvirt/libvirt-admin.conf
2025-12-05 00:58:11.550545 | controller | >f+++++++++ system-config/libvirt/libvirt.conf
2025-12-05 00:58:11.910509 | controller | changed: .d..t...... ./
2025-12-05 00:58:12.271076 | controller | changed: .d..t...... ./
2025-12-05 00:58:12.282392 | 
2025-12-05 00:58:12.282462 | TASK [Return artifact to Zuul]
2025-12-05 00:58:12.310409 | controller | ok
2025-12-05 00:58:12.327922 | 
2025-12-05 00:58:12.327973 | PLAY [Run ci/playbooks/collect-logs.yml on CRC host]
2025-12-05 00:58:12.328057 | 
2025-12-05 00:58:12.328081 | PLAY RECAP
2025-12-05 00:58:12.328112 | controller | ok: 18 changed: 13 unreachable: 0 failed: 0 skipped: 4 rescued: 0 ignored: 1
2025-12-05 00:58:12.328130 | 
2025-12-05 00:58:12.396183 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/collect-logs.yml@main]
2025-12-05 00:58:12.396963 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-ssh.yaml@master]
2025-12-05 00:58:12.865052 | 
2025-12-05 00:58:12.865145 | PLAY [all]
2025-12-05 00:58:12.882141 | 
2025-12-05 00:58:12.882210 | TASK [include_role : fetch-output]
2025-12-05 00:58:12.910212 | controller | ok
2025-12-05 00:58:12.926824 | 
2025-12-05 00:58:12.926935 | TASK [fetch-output : Set log path for multiple nodes]
2025-12-05 00:58:12.970412 | controller | skipping: Conditional result was False
2025-12-05 00:58:12.975580 | 
2025-12-05 00:58:12.975655 | TASK [fetch-output : Set log path for single node]
2025-12-05 00:58:13.003282 | controller | ok
2025-12-05 00:58:13.008004 | 
2025-12-05 00:58:13.008075 | LOOP [fetch-output : Ensure local output dirs]
2025-12-05 00:58:13.301201 | controller -> localhost | ok: "/var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/logs"
2025-12-05 00:58:13.465906 | controller -> localhost | ok: "/var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/artifacts"
2025-12-05 00:58:13.638088 | controller -> localhost | ok: "/var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/docs"
2025-12-05 00:58:13.645282 | 
2025-12-05 00:58:13.645348 | LOOP [fetch-output : Collect logs, artifacts and docs]
2025-12-05 00:58:14.136598 | controller | ok
2025-12-05 00:58:14.136792 | controller | ok: All items complete
2025-12-05 00:58:14.136822 | 
2025-12-05 00:58:14.508256 | controller | ok
2025-12-05 00:58:14.872143 | controller | ok
2025-12-05 00:58:14.892014 | 
2025-12-05 00:58:14.892084 | TASK [include_role : fetch-output-openshift]
2025-12-05 00:58:14.905644 | controller | skipping: Conditional result was False
2025-12-05 00:58:14.911136 | 
2025-12-05 00:58:14.911205 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir]
2025-12-05 00:58:15.222951 | controller -> localhost | ok: Item: artifacts Runtime: 0:00:00.006091
2025-12-05 00:58:15.396649 | controller -> localhost | ok: Item: docs Runtime: 0:00:00.005666
2025-12-05 00:58:15.422018 | 
2025-12-05 00:58:15.422083 | PLAY [all]
2025-12-05 00:58:15.434392 | 
2025-12-05 00:58:15.434455 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes]
2025-12-05 00:58:15.806512 | controller | changed
2025-12-05 00:58:15.826348 | 
2025-12-05 00:58:15.826398 | PLAY RECAP
2025-12-05 00:58:15.826439 | controller | ok: 5 changed: 2 unreachable: 0 failed: 0 skipped: 2 rescued: 0 ignored: 0
2025-12-05 00:58:15.826461 | 
2025-12-05 00:58:15.887440 | POST-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-ssh.yaml@master]
2025-12-05 00:58:15.888148 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-logs.yaml@master]
2025-12-05 00:58:16.385768 | 
2025-12-05 00:58:16.385870 | PLAY [localhost]
2025-12-05 00:58:16.403026 | 
2025-12-05 00:58:16.403102 | TASK [generate-zuul-manifest : Generate Zuul manifest]
2025-12-05 00:58:16.672985 | localhost | changed
2025-12-05 00:58:16.677181 | 
2025-12-05 00:58:16.677259 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul]
2025-12-05 00:58:16.698884 | localhost | ok
2025-12-05 00:58:16.705885 | 
2025-12-05 00:58:16.705974 | TASK [add-fileserver : Create SSH private key tempfile]
2025-12-05 00:58:16.975758 | localhost | changed
2025-12-05 00:58:16.980785 | 
2025-12-05 00:58:16.980850 | TASK [add-fileserver : Create SSH private key from secret]
2025-12-05 00:58:17.483467 | localhost | changed
2025-12-05 00:58:17.487931 | 
2025-12-05 00:58:17.487993 | TASK [add-fileserver : Add fileserver ssh key]
2025-12-05 00:58:17.798561 | localhost | Identity added: /var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/tmp/ansible.zr2kg00z (/var/lib/zuul/builds/d3d23dab5269493ea0aa69ff2b07e958/work/tmp/ansible.zr2kg00z)
2025-12-05 00:58:17.798717 | localhost | ok: Runtime: 0:00:00.005208
2025-12-05 00:58:17.802631 | 
2025-12-05 00:58:17.802705 | TASK [add-fileserver : Remove SSH private key from disk]
2025-12-05 00:58:18.001445 | localhost | ok: Runtime: 0:00:00.003989
2025-12-05 00:58:18.005793 | 
2025-12-05 00:58:18.005876 | TASK [add-fileserver : Add fileserver to inventory]
2025-12-05 00:58:18.053257 | localhost | changed
2025-12-05 00:58:18.057843 | 
2025-12-05 00:58:18.057905 | TASK [add-fileserver : Add fileserver server to known hosts]
2025-12-05 00:58:18.347755 | localhost | changed
2025-12-05 00:58:18.366397 | 
2025-12-05 00:58:18.366486 | PLAY [localhost]
2025-12-05 00:58:18.376686 | 
2025-12-05 00:58:18.376746 | TASK [Generate bulk log download script]
2025-12-05 00:58:18.394248 | localhost | ok
2025-12-05 00:58:18.404439 | 
2025-12-05 00:58:18.404503 | TASK [local-log-download : Check API endpoint is defined]
2025-12-05 00:58:18.431255 | localhost | ok: All assertions passed
2025-12-05 00:58:18.435217 | 
2025-12-05 00:58:18.435277 | TASK [local-log-download : Create download script]
2025-12-05 00:58:18.752043 | localhost -> localhost | changed
2025-12-05 00:58:18.760253 | 
2025-12-05 00:58:18.760324 | TASK [Register quick-download link]
2025-12-05 00:58:18.777036 | localhost | ok
2025-12-05 00:58:18.810564 | 
2025-12-05 00:58:18.810621 | PLAY [logserver.rdoproject.org]
2025-12-05 00:58:18.819585 | 
2025-12-05 00:58:18.819640 | TASK [Set zuul-log-path fact]
2025-12-05 00:58:18.834805 | logserver.rdoproject.org | ok
2025-12-05 00:58:18.842874 | 
2025-12-05 00:58:18.842960 | TASK [set-zuul-log-path-fact : Set log path for a build]
2025-12-05 00:58:18.857821 | logserver.rdoproject.org | ok
2025-12-05 00:58:18.862787 | 
2025-12-05 00:58:18.862847 | TASK [upload-logs : Create log directories]
2025-12-05 00:58:20.542693 | logserver.rdoproject.org | changed
2025-12-05 00:58:20.545493 | 
2025-12-05 00:58:20.545552 | TASK [upload-logs : Ensure logs are readable before uploading]
2025-12-05 00:58:20.751264 | logserver.rdoproject.org -> localhost | ok: Runtime: 0:00:00.003752
2025-12-05 00:58:20.755465 | 
2025-12-05 00:58:20.755526 | TASK [upload-logs : Upload logs to log server]
2025-12-05 00:58:22.079744 | logserver.rdoproject.org | Output suppressed because no_log was given
2025-12-05 00:58:22.082459 | 
2025-12-05 00:58:22.082521 | LOOP [upload-logs : Compress console log and json output]
2025-12-05 00:58:22.116467 | logserver.rdoproject.org | skipping: Conditional result was False
2025-12-05 00:58:22.125283 | logserver.rdoproject.org | skipping: Conditional result was False
2025-12-05 00:58:22.129215 | 
2025-12-05 00:58:22.129352 | LOOP [upload-logs : Upload compressed console log and json output]
2025-12-05 00:58:22.160400 | logserver.rdoproject.org | skipping: Conditional result was False
2025-12-05 00:58:22.160580 | 
2025-12-05 00:58:22.163644 | logserver.rdoproject.org | skipping: Conditional result was False
2025-12-05 00:58:22.175467 | 
2025-12-05 00:58:22.175546 | LOOP [upload-logs : Upload console log and json output]