2025-10-02 15:08:48.320455 | Job console starting...
2025-10-02 15:08:48.848819 | Updating repositories
2025-10-02 15:08:49.644383 | Preparing job workspace
2025-10-02 15:09:08.185166 | Running Ansible setup...
2025-10-02 15:09:16.544452 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/pre.yaml@master]
2025-10-02 15:09:18.784463 | 
2025-10-02 15:09:18.784575 | PLAY [localhost]
2025-10-02 15:09:18.821950 | 
2025-10-02 15:09:18.822039 | TASK [Gathering Facts]
2025-10-02 15:09:22.264852 | localhost | ok
2025-10-02 15:09:22.291098 | 
2025-10-02 15:09:22.291205 | TASK [log-inventory : Ensure Zuul Ansible directory exists]
2025-10-02 15:09:23.691514 | localhost -> localhost | changed
2025-10-02 15:09:23.697202 | 
2025-10-02 15:09:23.697292 | TASK [log-inventory : Copy ansible inventory to logs dir]
2025-10-02 15:09:26.699137 | localhost -> localhost | changed
2025-10-02 15:09:26.707490 | 
2025-10-02 15:09:26.707565 | TASK [Setup log path fact]
2025-10-02 15:09:26.760008 | localhost | ok
2025-10-02 15:09:26.812153 | 
2025-10-02 15:09:26.812253 | TASK [set-zuul-log-path-fact : Set log path for a build]
2025-10-02 15:09:26.892878 | localhost | ok
2025-10-02 15:09:26.912766 | 
2025-10-02 15:09:26.912842 | TASK [emit-job-header : Print job information]
2025-10-02 15:09:27.043367 | # Job Information
2025-10-02 15:09:27.043511 | Ansible Version: 2.15.12
2025-10-02 15:09:27.043543 | Job: cifmw-molecule-kustomize_deploy
2025-10-02 15:09:27.043569 | Pipeline: github-check
2025-10-02 15:09:27.043590 | Executor: ibm-bm4-ze.softwarefactory-project.io
2025-10-02 15:09:27.043610 | Triggered by: https://github.com/openstack-k8s-operators/ci-framework/pull/3362
2025-10-02 15:09:27.043630 | Log URL (when completed): https://logserver.rdoproject.org/1d4/rdoproject.org/1d44bb237e0f432c90a9a014aa6654f6/
2025-10-02 15:09:27.043650 | Event ID: 854a5e80-9fa1-11f0-891b-738b4b5da685
2025-10-02 15:09:27.047353 | 
2025-10-02 15:09:27.047429 | LOOP [emit-job-header : Print node information]
2025-10-02 15:09:27.398498 | localhost | ok:
2025-10-02 15:09:27.398640 | localhost | # Node Information
2025-10-02 15:09:27.398671 | localhost | Inventory Hostname: controller
2025-10-02 15:09:27.398699 | localhost | Hostname: np0005466554
2025-10-02 15:09:27.398721 | localhost | Username: zuul
2025-10-02 15:09:27.398743 | localhost | Distro: CentOS 9
2025-10-02 15:09:27.398763 | localhost | Provider: ibm-bm4-nodepool
2025-10-02 15:09:27.398781 | localhost | Region: regionOne
2025-10-02 15:09:27.398799 | localhost | Label: cloud-centos-9-stream-tripleo-ibm
2025-10-02 15:09:27.398818 | localhost | Product Name: OpenStack Compute
2025-10-02 15:09:27.398835 | localhost | Interface IP: 192.168.26.239
2025-10-02 15:09:27.467220 | 
2025-10-02 15:09:27.467438 | PLAY [all]
2025-10-02 15:09:27.487554 | 
2025-10-02 15:09:27.487622 | TASK [Gather network facts]
2025-10-02 15:09:27.985528 | controller | ok
2025-10-02 15:09:28.040400 | 
2025-10-02 15:09:28.040506 | TASK [include_role : start-zuul-console]
2025-10-02 15:09:28.099332 | controller | ok
2025-10-02 15:09:28.135802 | 
2025-10-02 15:09:28.135886 | TASK [start-zuul-console : Start zuul_console daemon.]
2025-10-02 15:09:29.192336 | controller | ok
2025-10-02 15:09:29.303547 | 
2025-10-02 15:09:29.303663 | TASK [include_role : add-build-sshkey]
2025-10-02 15:09:29.411083 | controller | ok
2025-10-02 15:09:29.456296 | 
2025-10-02 15:09:29.456413 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build]
2025-10-02 15:09:30.609100 | controller -> localhost | ok
2025-10-02 15:09:30.616062 | 
2025-10-02 15:09:30.616131 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID]
2025-10-02 15:09:30.743208 | controller | ok
2025-10-02 15:09:30.784156 | controller | included: /var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml
2025-10-02 15:09:30.805351 | 
2025-10-02 15:09:30.805445 | TASK [add-build-sshkey : Create Temp SSH key]
2025-10-02 15:09:33.808255 | controller -> localhost | Generating public/private rsa key pair.
2025-10-02 15:09:33.808447 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/1d44bb237e0f432c90a9a014aa6654f6_id_rsa.
2025-10-02 15:09:33.808484 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/1d44bb237e0f432c90a9a014aa6654f6_id_rsa.pub.
2025-10-02 15:09:33.808510 | controller -> localhost | The key fingerprint is:
2025-10-02 15:09:33.808532 | controller -> localhost | SHA256:c8eAe1P8psgVyj6ULfVYSf6zwbo2jOs0w976nXTX3FE zuul-build-sshkey
2025-10-02 15:09:33.808552 | controller -> localhost | The key's randomart image is:
2025-10-02 15:09:33.808572 | controller -> localhost | +---[RSA 3072]----+
2025-10-02 15:09:33.808591 | controller -> localhost | |              .  |
2025-10-02 15:09:33.808610 | controller -> localhost | |         . . o . |
2025-10-02 15:09:33.808629 | controller -> localhost | |        . . = + E|
2025-10-02 15:09:33.808648 | controller -> localhost | |         o O *...|
2025-10-02 15:09:33.808667 | controller -> localhost | |        S X * +=.|
2025-10-02 15:09:33.808685 | controller -> localhost | |         B.* o..B|
2025-10-02 15:09:33.808703 | controller -> localhost | |          ==+. o*|
2025-10-02 15:09:33.808722 | controller -> localhost | |          oo+++ +|
2025-10-02 15:09:33.808741 | controller -> localhost | |          .==+.o |
2025-10-02 15:09:33.808759 | controller -> localhost | +----[SHA256]-----+
2025-10-02 15:09:33.808804 | controller -> localhost | ok: Runtime: 0:00:00.974974
2025-10-02 15:09:33.820441 | 
2025-10-02 15:09:33.820508 | TASK [add-build-sshkey : Remote setup ssh keys (linux)]
2025-10-02 15:09:33.943356 | controller | ok
2025-10-02 15:09:33.989413 | controller | included: /var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml
2025-10-02 15:09:34.076210 | 
2025-10-02 15:09:34.076305 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey]
2025-10-02 15:09:34.177622 | controller | skipping: Conditional result was False
2025-10-02 15:09:34.183594 | 
2025-10-02 15:09:34.183677 | TASK [add-build-sshkey : Enable access via build key on all nodes]
2025-10-02 15:09:35.230518 | controller | changed
2025-10-02 15:09:35.435818 | 
2025-10-02 15:09:35.435903 | TASK [add-build-sshkey : Make sure user has a .ssh]
2025-10-02 15:09:35.804288 | controller | ok
2025-10-02 15:09:35.816591 | 
2025-10-02 15:09:35.816681 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes]
2025-10-02 15:09:36.947819 | controller | changed
2025-10-02 15:09:36.962047 | 
2025-10-02 15:09:36.962145 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes]
2025-10-02 15:09:37.897594 | controller | changed
2025-10-02 15:09:37.902859 | 
2025-10-02 15:09:37.902953 | TASK [add-build-sshkey : Remote setup ssh keys (windows)]
2025-10-02 15:09:38.019503 | controller | skipping: Conditional result was False
2025-10-02 15:09:38.051904 | 
2025-10-02 15:09:38.052079 | TASK [remove-zuul-sshkey : Remove master key from local agent]
2025-10-02 15:09:39.554483 | controller -> localhost | changed
2025-10-02 15:09:39.577569 | 
2025-10-02 15:09:39.577651 | TASK [add-build-sshkey : Add back temp key]
2025-10-02 15:09:40.553322 | controller -> localhost | Identity added: /var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/1d44bb237e0f432c90a9a014aa6654f6_id_rsa (zuul-build-sshkey)
2025-10-02 15:09:40.553506 | controller -> localhost | ok: Runtime: 0:00:00.010545
2025-10-02 15:09:40.567472 | 
2025-10-02 15:09:40.567543 | TASK [add-build-sshkey : Verify we can still SSH to all nodes]
2025-10-02 15:09:41.024321 | controller | ok
2025-10-02 15:09:41.048292 | 
2025-10-02 15:09:41.048366 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)]
2025-10-02 15:09:41.170596 | controller | skipping: Conditional result was False
2025-10-02 15:09:41.180513 | 
2025-10-02 15:09:41.180577 | TASK [include_role : validate-host]
2025-10-02 15:09:41.274669 | controller | ok
2025-10-02 15:09:41.388035 | 
2025-10-02 15:09:41.388133 | TASK [validate-host : Define zuul_info_dir fact]
2025-10-02 15:09:41.516192 | controller | ok
2025-10-02 15:09:41.521499 | 
2025-10-02 15:09:41.521569 | TASK [validate-host : Ensure Zuul Ansible directory exists]
2025-10-02 15:09:42.929592 | controller -> localhost | ok
2025-10-02 15:09:42.936375 | 
2025-10-02 15:09:42.936447 | TASK [validate-host : Collect information about the host]
2025-10-02 15:09:43.679687 | controller | ok
2025-10-02 15:09:43.704603 | 
2025-10-02 15:09:43.704682 | TASK [validate-host : Sanitize hostname]
2025-10-02 15:09:43.853655 | controller | ok
2025-10-02 15:09:43.863509 | 
2025-10-02 15:09:43.863575 | TASK [validate-host : Write out all ansible variables/facts known for each host]
2025-10-02 15:09:45.649476 | controller -> localhost | changed
2025-10-02 15:09:45.655373 | 
2025-10-02 15:09:45.655468 | TASK [validate-host : Collect information about zuul worker]
2025-10-02 15:09:46.672522 | controller | ok
2025-10-02 15:09:46.677431 | 
2025-10-02 15:09:46.677501 | TASK [validate-host : Write out all zuul information for each host]
2025-10-02 15:09:48.483992 | controller -> localhost | changed
2025-10-02 15:09:48.497475 | 
2025-10-02 15:09:48.497550 | TASK [include_role : prepare-workspace-openshift]
2025-10-02 15:09:48.573474 | controller | skipping: Conditional result was False
2025-10-02 15:09:48.579506 | 
2025-10-02 15:09:48.579574 | TASK [include_role : remove-zuul-sshkey]
2025-10-02 15:09:48.643110 | controller | skipping: Conditional result was False
2025-10-02 15:09:48.648428 | 
2025-10-02 15:09:48.648498 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them]
2025-10-02 15:09:49.007011 | controller | ok: "logs"
2025-10-02 15:09:49.007227 | controller | ok: All items complete
2025-10-02 15:09:49.007258 | 
2025-10-02 15:09:49.214618 | controller | ok: "artifacts"
2025-10-02 15:09:49.417084 | controller | ok: "docs"
2025-10-02 15:09:49.430011 | 
2025-10-02 15:09:49.430109 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist]
2025-10-02 15:09:49.744196 | controller | changed: "logs"
2025-10-02 15:09:49.962550 | controller | changed: "artifacts"
2025-10-02 15:09:50.202638 | controller | changed: "docs"
2025-10-02 15:09:50.323521 | 
2025-10-02 15:09:50.323604 | PLAY RECAP
2025-10-02 15:09:50.323651 | controller | ok: 22 changed: 9 unreachable: 0 failed: 0 skipped: 5 rescued: 0 ignored: 0
2025-10-02 15:09:50.323682 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2025-10-02 15:09:50.323704 | 
2025-10-02 15:09:50.761673 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/base-minimal/pre.yaml@master]
2025-10-02 15:09:50.762418 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/ci-framework-rdo-base/pre.yaml@master]
2025-10-02 15:09:53.993841 | 
2025-10-02 15:09:53.993995 | PLAY [all]
2025-10-02 15:09:54.084492 | 
2025-10-02 15:09:54.084606 | TASK [mirror-info-fork : Set mirror_fqdn if not defined]
2025-10-02 15:09:54.333354 | controller | ok
2025-10-02 15:09:54.338642 | 
2025-10-02 15:09:54.338733 | TASK [mirror-info-fork : Create /etc/ci]
2025-10-02 15:09:55.356433 | controller | changed
2025-10-02 15:09:55.362449 | 
2025-10-02 15:09:55.362521 | TASK [mirror-info-fork : Install ci_mirror script]
2025-10-02 15:09:57.999444 | controller | changed
2025-10-02 15:09:58.040461 | 
2025-10-02 15:09:58.040544 | LOOP [add-authorized-keys : Enable access via build key on all nodes]
2025-10-02 15:09:59.162436 | controller | changed:
2025-10-02 15:09:59.162599 | controller | {
2025-10-02 15:09:59.162633 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAABIwAAAQEA4Z/c9osaGGtU6X8fgELwfj/yayRurfcKA0HMFfdpPxev2dbwljysMuzoVp4OZmW1gvGtyYPSNRvnzgsaabPNKNo2ym5NToCP6UM+KSe93aln4BcM/24mXChYAbXJQ5Bqq/pIzsGs/pKetQN+vwvMxLOwTvpcsCJBXaa981RKML6xj9l/UZ7IIq1HSEKMvPLxZMWdu0Ut8DkCd5F4nOw9Wgml2uYpDCj5LLCrQQ9ChdOMz8hz6SighhNlRpPkvPaet3OXxr/ytFMu7j7vv06CaEnuMMiY2aTWN1Imin9eHAylIqFHta/3gFfQSWt9jXM7owkBLKL7ATzhaAn+fjNupw== arxcruz@redhat.com"
2025-10-02 15:09:59.162664 | controller | }
2025-10-02 15:09:59.378322 | controller | changed:
2025-10-02 15:09:59.378416 | controller | {
2025-10-02 15:09:59.378447 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQDS4Fn6k4deCnIlOtLWqZJyksbepjQt04j8Ed8CGx9EKkj0fKiAxiI4TadXQYPuNHMixZy4Nevjb6aDhL5Z906TfvNHKUrjrG7G26a0k8vdc61NEQ7FmcGMWRLwwc6ReDO7lFpzYKBMk4YqfWgBuGU/K6WLKiVW2cVvwIuGIaYrE1OiiX0iVUUk7KApXlDJMXn7qjSYynfO4mF629NIp8FJal38+Kv+HA+0QkE5Y2xXnzD4Lar5+keymiCHRntPppXHeLIRzbt0gxC7v3L72hpQ3BTBEzwHpeS8KY+SX1y5lRMN45thCHfJqGmARJREDjBvWG8JXOPmVIKQtZmVcD5b mandreou@redhat.com"
2025-10-02 15:09:59.378470 | controller | }
2025-10-02 15:09:59.587767 | controller | changed:
2025-10-02 15:09:59.587855 | controller | {
2025-10-02 15:09:59.587883 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQC9MiLfy30deHA7xPOAlew5qUq3UP2gmRMYJi8PtkjFB20/DKeWwWNnkZPqP9AayruRoo51SIiVg870gbZE2jYl+Ncx/FYDe56JeC3ySZsXoAVkC9bP7gkOGqOmJjirvAgPMI7bogVz8i+66Q4Ar7OKTp3762G4IuWPPEg4ce4Y7lx9qWocZapHYq4cYKMxrOZ7SEbFSATBbe2bPZAPKTw8do/Eny+Hq/LkHFhIeyra6cqTFQYShr+zPln0Cr+ro/pDX3bB+1ubFgTpjpkkkQsLhDfR6cCdCWM2lgnS3BTtYj5Ct9/JRPR5YOphqZz+uB+OEu2IL68hmU9vNTth1KeX rlandy@redhat.com"
2025-10-02 15:09:59.587926 | controller | }
2025-10-02 15:09:59.801082 | controller | changed:
2025-10-02 15:09:59.801155 | controller | {
2025-10-02 15:09:59.801183 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIFCbgz8gdERiJlk2IKOtkjQxEXejrio6ZYMJAVJYpOIp raukadah@gmail.com"
2025-10-02 15:09:59.801205 | controller | }
2025-10-02 15:10:00.031418 | controller | changed:
2025-10-02 15:10:00.031492 | controller | {
2025-10-02 15:10:00.031520 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIBqb3Q/9uDf4LmihQ7xeJ9gA/STIQUFPSfyyV0m8AoQi bshewale@redhat.com"
2025-10-02 15:10:00.031542 | controller | }
2025-10-02 15:10:00.249719 | controller | changed:
2025-10-02 15:10:00.249802 | controller | {
2025-10-02 15:10:00.249830 | controller |   "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQC0I8QqQx0Az2ysJt2JuffucLijhBqnsXKEIx5GyHwxVULROa8VtNFXUDH6ZKZavhiMcmfHB2+TBTda+lDP4FldYj06dGmzCY+IYGa+uDRdxHNGYjvCfLFcmLlzRK6fNbTcui+KlUFUdKe0fb9CRoGKyhlJD5GRkM1Dv+Yb6Bj+RNnmm1fVGYxzmrD2utvffYEb0SZGWxq2R9gefx1q/3wCGjeqvufEV+AskPhVGc5T7t9eyZ4qmslkLh1/nMuaIBFcr9AUACRajsvk6mXrAN1g3HlBf2gQlhi1UEyfbqIQvzzFtsbLDlSum/KmKjy818GzvWjERfQ0VkGzCd9bSLVL dviroel@redhat.com"
2025-10-02 15:10:00.249851 | controller | }
2025-10-02 15:10:00.520705 | controller | changed:
2025-10-02 15:10:00.520784 | controller | {
2025-10-02 15:10:00.520811 | 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-10-02 15:10:00.520834 | controller | }
2025-10-02 15:10:00.682447 | controller | changed:
2025-10-02 15:10:00.682539 | controller | {
2025-10-02 15:10:00.682569 | 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-10-02 15:10:00.682592 | controller | }
2025-10-02 15:10:00.923417 | controller | changed:
2025-10-02 15:10:00.923514 | controller | {
2025-10-02 15:10:00.923542 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIHUnwjB20UKmsSed9X73eGNV5AOEFccQ3NYrRW776pEk cjeanner"
2025-10-02 15:10:00.923565 | controller | }
2025-10-02 15:10:01.167045 | controller | changed:
2025-10-02 15:10:01.167122 | controller | {
2025-10-02 15:10:01.167149 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDercCMGn8rW1C4P67tHgtflPdTeXlpyUJYH+6XDd2lR jgilaber@redhat.com"
2025-10-02 15:10:01.167172 | controller | }
2025-10-02 15:10:01.372172 | controller | changed:
2025-10-02 15:10:01.372304 | controller | {
2025-10-02 15:10:01.372337 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIAMI6kkg9Wg0sG7jIJmyZemEBwUn1yzNpQQd3gnulOmZ adrianfuscoarnejo@gmail.com"
2025-10-02 15:10:01.372360 | controller | }
2025-10-02 15:10:01.614131 | controller | changed:
2025-10-02 15:10:01.614206 | controller | {
2025-10-02 15:10:01.614234 | controller |   "public_key": "ecdsa-sha2-nistp256 AAAAE2VjZHNhLXNoYTItbmlzdHAyNTYAAAAIbmlzdHAyNTYAAABBBPijwpQu/3jhhhBZInXNOLEH57DrknPc3PLbsRvYyJIFzwYjX+WD4a7+nGnMYS42MuZk6TJcVqgnqofVx4isoD4= ramishra@redhat.com"
2025-10-02 15:10:01.614256 | controller | }
2025-10-02 15:10:01.840600 | controller | changed:
2025-10-02 15:10:01.840716 | controller | {
2025-10-02 15:10:01.840743 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIGpU/BepK3qX0NRf5Np+dOBDqzQEefhNrw2DCZaH3uWW rebtoor@monolith"
2025-10-02 15:10:01.840766 | controller | }
2025-10-02 15:10:02.065441 | controller | changed:
2025-10-02 15:10:02.065528 | controller | {
2025-10-02 15:10:02.065555 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDK0iKdi8jQTpQrDdLVH/AAgLVYyTXF7AQ1gjc/5uT3t ykarel@yatinkarel"
2025-10-02 15:10:02.065576 | controller | }
2025-10-02 15:10:02.290306 | controller | changed:
2025-10-02 15:10:02.290451 | controller | {
2025-10-02 15:10:02.290483 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIF/V/cLotA6LZeO32VL45Hd78skuA2lJA425Sm2LlQeZ fmount@horcrux"
2025-10-02 15:10:02.290506 | controller | }
2025-10-02 15:10:02.499291 | controller | changed:
2025-10-02 15:10:02.499366 | controller | {
2025-10-02 15:10:02.499404 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDa7QCjuDMVmRPo1rREbGwzYeBCYVN+Ou/3WKXZEC6Sr"
2025-10-02 15:10:02.499428 | controller | }
2025-10-02 15:10:02.737823 | controller | changed:
2025-10-02 15:10:02.737985 | controller | {
2025-10-02 15:10:02.738019 | 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-10-02 15:10:02.738044 | controller | }
2025-10-02 15:10:02.961614 | controller | changed:
2025-10-02 15:10:02.961712 | controller | {
2025-10-02 15:10:02.961741 | 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-10-02 15:10:02.961773 | controller | }
2025-10-02 15:10:03.188093 | controller | changed:
2025-10-02 15:10:03.188177 | controller | {
2025-10-02 15:10:03.188204 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIOKLl0NYKwoZ/JY5KeZU8VwRAggeOxqQJeoqp3dsAaY9"
2025-10-02 15:10:03.188225 | controller | }
2025-10-02 15:10:03.415858 | controller | changed:
2025-10-02 15:10:03.416006 | controller | {
2025-10-02 15:10:03.416039 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIASASQOH2BcOyLKuuDOdWZlPi2orcjcA8q4400T73DLH evallesp@fedora"
2025-10-02 15:10:03.416062 | controller | }
2025-10-02 15:10:03.663699 | controller | changed:
2025-10-02 15:10:03.663777 | controller | {
2025-10-02 15:10:03.663805 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAILeBWlamUph+jRKV2qrx1PGU7vWuGIt5+z9k96I8WehW amsinha@amsinha-mac"
2025-10-02 15:10:03.663826 | controller | }
2025-10-02 15:10:03.877976 | controller | changed:
2025-10-02 15:10:03.878061 | controller | {
2025-10-02 15:10:03.878088 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIANvVgvJBlK3gb1yz5uef/JqIGq4HLEmY2dYA8e37swb morenod@redhat-laptop"
2025-10-02 15:10:03.878192 | controller | }
2025-10-02 15:10:04.097956 | controller | changed:
2025-10-02 15:10:04.098036 | controller | {
2025-10-02 15:10:04.098063 | 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-10-02 15:10:04.098086 | controller | }
2025-10-02 15:10:04.316106 | controller | changed:
2025-10-02 15:10:04.316183 | controller | {
2025-10-02 15:10:04.316210 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIKwedoZ0TWPJX/z/4TAbO/kKcDZOQVgRH0hAqrL5UCI1 vcastell@redhat.com"
2025-10-02 15:10:04.316233 | controller | }
2025-10-02 15:10:04.547520 | controller | changed:
2025-10-02 15:10:04.547592 | controller | {
2025-10-02 15:10:04.547620 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIEmv8sE8GCk6ZTPIqF0FQrttBdL3mq7rCm/IJy0xDFh7 michburk@redhat.com"
2025-10-02 15:10:04.547641 | controller | }
2025-10-02 15:10:04.793100 | controller | changed:
2025-10-02 15:10:04.793198 | controller | {
2025-10-02 15:10:04.793225 | controller |   "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAICy6GpGEtwevXEEn4mmLR5lmSLe23dGgAvzkB9DMNbkf rsafrono@rsafrono"
2025-10-02 15:10:04.793246 | controller | }
2025-10-02 15:10:04.915897 | 
2025-10-02 15:10:04.916015 | TASK [Set timezone to UTC]
2025-10-02 15:10:06.139489 | controller | changed: executed `/bin/timedatectl set-timezone UTC`
2025-10-02 15:10:06.144703 | 
2025-10-02 15:10:06.144770 | TASK [Create nodepool directory]
2025-10-02 15:10:06.436657 | controller | changed
2025-10-02 15:10:06.454851 | 
2025-10-02 15:10:06.456242 | TASK [Create nodepool sub_nodes file]
2025-10-02 15:10:07.192132 | controller | changed
2025-10-02 15:10:07.205265 | 
2025-10-02 15:10:07.205356 | TASK [Create nodepool sub_nodes_private file]
2025-10-02 15:10:07.960664 | controller | changed
2025-10-02 15:10:07.966423 | 
2025-10-02 15:10:07.966493 | LOOP [Populate nodepool sub_nodes file]
2025-10-02 15:10:08.058150 | 
2025-10-02 15:10:08.058298 | LOOP [Populate nodepool sub_nodes_private file]
2025-10-02 15:10:08.128858 | 
2025-10-02 15:10:08.129086 | TASK [Create nodepool primary file]
2025-10-02 15:10:08.211580 | controller | skipping: Conditional result was False
2025-10-02 15:10:08.218657 | 
2025-10-02 15:10:08.218753 | TASK [Create nodepool node_private for this node]
2025-10-02 15:10:08.932584 | controller | changed
2025-10-02 15:10:08.942812 | 
2025-10-02 15:10:08.942945 | LOOP [Copy ssh keys to nodepool directory]
2025-10-02 15:10:09.801769 | controller | ok: Item: id_rsa Runtime: 0:00:00.005003
2025-10-02 15:10:09.801953 | 
2025-10-02 15:10:09.973860 | controller | ok: Item: id_rsa.pub Runtime: 0:00:00.004288
2025-10-02 15:10:09.981800 | 
2025-10-02 15:10:09.981929 | TASK [Add sudoers role for zuul-sudo-grep.sh]
2025-10-02 15:10:10.777993 | controller | changed
2025-10-02 15:10:10.794008 | 
2025-10-02 15:10:10.794099 | TASK [Validate sudoers config after edits]
2025-10-02 15:10:11.217330 | controller | /etc/sudoers: parsed OK
2025-10-02 15:10:11.217419 | controller | /etc/sudoers.d/90-cloud-init-users: parsed OK
2025-10-02 15:10:11.217430 | controller | /etc/sudoers.d/zuul: parsed OK
2025-10-02 15:10:11.217448 | controller | /etc/sudoers.d/zuul-sudo-grep: parsed OK
2025-10-02 15:10:11.425051 | controller | ok: Runtime: 0:00:00.005500
2025-10-02 15:10:11.430511 | 
2025-10-02 15:10:11.430574 | TASK [Show the environment passed in to job shell scripts]
2025-10-02 15:10:11.788753 | controller | SHELL=/bin/bash
2025-10-02 15:10:11.788797 | controller | ZUUL_PROJECT=openstack-k8s-operators/ci-framework
2025-10-02 15:10:11.788807 | controller | ZUUL_SHORT_PROJECT_NAME=ci-framework
2025-10-02 15:10:11.788813 | controller | ZUUL_CHANGES=openstack-k8s-operators/ci-framework:main:refs/changes/62/3362/41f2edaa0ac45cd85919f70775e84cf472326a6e
2025-10-02 15:10:11.788819 | controller | PWD=/home/zuul
2025-10-02 15:10:11.788824 | controller | ZUUL_PIPELINE=github-check
2025-10-02 15:10:11.788830 | controller | LOGNAME=zuul
2025-10-02 15:10:11.788850 | controller | XDG_SESSION_TYPE=tty
2025-10-02 15:10:11.788859 | controller | _=/usr/bin/env
2025-10-02 15:10:11.788864 | controller | MOTD_SHOWN=pam
2025-10-02 15:10:11.788907 | controller | HOME=/home/zuul
2025-10-02 15:10:11.788915 | controller | LANG=en_US.UTF-8
2025-10-02 15:10:11.788921 | controller | SSH_CONNECTION=192.168.26.12 34934 192.168.26.239 22
2025-10-02 15:10:11.788927 | 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-10-02 15:10:11.788936 | controller | ZUUL_CHANGE_IDS=3362,41f2edaa0ac45cd85919f70775e84cf472326a6e
2025-10-02 15:10:11.788941 | controller | WORKSPACE=/home/zuul/workspace
2025-10-02 15:10:11.788947 | controller | XDG_SESSION_CLASS=user
2025-10-02 15:10:11.788952 | controller | SELINUX_ROLE_REQUESTED=
2025-10-02 15:10:11.788957 | controller | LESSOPEN=||/usr/bin/lesspipe.sh %s
2025-10-02 15:10:11.788963 | controller | USER=zuul
2025-10-02 15:10:11.788968 | controller | ZUUL_VOTING=True
2025-10-02 15:10:11.788973 | controller | BUILD_TIMEOUT=1800000
2025-10-02 15:10:11.788978 | controller | SELINUX_USE_CURRENT_RANGE=
2025-10-02 15:10:11.788983 | controller | SHLVL=1
2025-10-02 15:10:11.788989 | controller | ZUUL_PATCHSET=41f2edaa0ac45cd85919f70775e84cf472326a6e
2025-10-02 15:10:11.788994 | controller | XDG_SESSION_ID=1
2025-10-02 15:10:11.788999 | controller | ZUUL_BRANCH=main
2025-10-02 15:10:11.789004 | controller | XDG_RUNTIME_DIR=/run/user/1000
2025-10-02 15:10:11.789010 | controller | SSH_CLIENT=192.168.26.12 34934 22
2025-10-02 15:10:11.789015 | controller | DEBUGINFOD_URLS=https://debuginfod.centos.org/
2025-10-02 15:10:11.789020 | controller | DEBUGINFOD_IMA_CERT_PATH=/etc/keys/ima:
2025-10-02 15:10:11.789026 | controller | which_declare=declare -f
2025-10-02 15:10:11.789031 | controller | PATH=/home/zuul/.local/bin:/home/zuul/bin:/usr/local/bin:/usr/bin:/usr/local/sbin:/usr/sbin
2025-10-02 15:10:11.789037 | controller | SELINUX_LEVEL_REQUESTED=
2025-10-02 15:10:11.789042 | controller | ZUUL_CHANGE=3362
2025-10-02 15:10:11.789047 | controller | DBUS_SESSION_BUS_ADDRESS=unix:path=/run/user/1000/bus
2025-10-02 15:10:11.789052 | controller | ZUUL_UUID=1d44bb237e0f432c90a9a014aa6654f6
2025-10-02 15:10:11.789059 | controller | BASH_FUNC_which%%=() {  ( alias;
2025-10-02 15:10:11.789065 | controller |  eval ${which_declare} ) | /usr/bin/which --tty-only --read-alias --read-functions --show-tilde --show-dot $@
2025-10-02 15:10:11.789071 | controller | }
2025-10-02 15:10:12.035663 | controller | ok: Runtime: 0:00:00.006094
2025-10-02 15:10:12.041728 | 
2025-10-02 15:10:12.041793 | TASK [Workaround hardcoded /home/zuul/workspace in zuul_legacy_vars]
2025-10-02 15:10:12.086027 | controller | skipping: Conditional result was False
2025-10-02 15:10:12.092590 | 
2025-10-02 15:10:12.092659 | TASK [Symlink /home/zuul-worker/workspace]
2025-10-02 15:10:12.773418 | controller | skipping: Conditional result was False
2025-10-02 15:10:12.779375 | 
2025-10-02 15:10:12.779475 | TASK [Ensure legacy workspace directory]
2025-10-02 15:10:13.040992 | controller | changed
2025-10-02 15:10:13.092445 | 
2025-10-02 15:10:13.092622 | PLAY RECAP
2025-10-02 15:10:13.092677 | controller | ok: 14 changed: 11 unreachable: 0 failed: 0 skipped: 5 rescued: 0 ignored: 0
2025-10-02 15:10:13.092703 | 
2025-10-02 15:10:13.274284 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/ci-framework-rdo-base/pre.yaml@master]
2025-10-02 15:10:13.275050 | PRE-RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/dump_zuul_data.yml@main]
2025-10-02 15:10:14.524624 | 
2025-10-02 15:10:14.524718 | PLAY [Run ci/playbooks/dump_zuul_data.yml]
2025-10-02 15:10:14.592716 | 
2025-10-02 15:10:14.592809 | TASK [Create zuul-output directory]
2025-10-02 15:10:15.261108 | controller | changed
2025-10-02 15:10:15.272016 | 
2025-10-02 15:10:15.272106 | TASK [Slurp Zuul inventory test]
2025-10-02 15:10:16.163016 | controller -> localhost | ok
2025-10-02 15:10:16.169854 | 
2025-10-02 15:10:16.169965 | TASK [Save zuul inventory]
2025-10-02 15:10:17.436660 | controller | changed
2025-10-02 15:10:17.444997 | 
2025-10-02 15:10:17.445069 | TASK [Save zuul vars without the change_message]
2025-10-02 15:10:18.302452 | controller | changed
2025-10-02 15:10:18.380476 | 
2025-10-02 15:10:18.380560 | PLAY RECAP
2025-10-02 15:10:18.380608 | controller | ok: 4 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2025-10-02 15:10:18.380632 | 
2025-10-02 15:10:18.540285 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/dump_zuul_data.yml@main]
2025-10-02 15:10:18.541024 | PRE-RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-prepare.yml@main]
2025-10-02 15:10:19.210415 | 
2025-10-02 15:10:19.210512 | PLAY [Run ci/playbooks/molecule-prepare.yml]
2025-10-02 15:10:19.236835 | 
2025-10-02 15:10:19.236934 | TASK [Execute mirror info role to configure /etc/ci/mirror_info.sh]
2025-10-02 15:10:19.275962 | controller | ok
2025-10-02 15:10:19.303334 | 
2025-10-02 15:10:19.303466 | TASK [mirror-info-fork : Set mirror_fqdn if not defined]
2025-10-02 15:10:19.386625 | controller | skipping: Conditional result was False
2025-10-02 15:10:19.392479 | 
2025-10-02 15:10:19.392572 | TASK [mirror-info-fork : Create /etc/ci]
2025-10-02 15:10:19.799948 | controller | ok
2025-10-02 15:10:19.806272 | 
2025-10-02 15:10:19.806374 | TASK [mirror-info-fork : Install ci_mirror script]
2025-10-02 15:10:20.659445 | controller | ok
2025-10-02 15:10:20.677371 | 
2025-10-02 15:10:20.677469 | TASK [Prepare workspace]
2025-10-02 15:10:20.700095 | controller | ok
2025-10-02 15:10:20.732474 | 
2025-10-02 15:10:20.732563 | TASK [prepare-workspace : Start zuul_console daemon.]
2025-10-02 15:10:21.086980 | controller | ok
2025-10-02 15:10:21.129792 | 
2025-10-02 15:10:21.129880 | TASK [prepare-workspace : Synchronize src repos to workspace directory.]
2025-10-02 15:10:24.994088 | controller | Output suppressed because no_log was given
2025-10-02 15:10:25.021970 | 
2025-10-02 15:10:25.022057 | LOOP [Create zuul-output directory]
2025-10-02 15:10:25.217176 | controller | changed: "/home/zuul/ci-framework-data/logs"
2025-10-02 15:10:25.375874 | controller | ok: "/home/zuul/zuul-output/logs"
2025-10-02 15:10:25.386345 | 
2025-10-02 15:10:25.386468 | TASK [Install required packages]
2025-10-02 15:11:15.376529 | controller | changed
2025-10-02 15:11:15.381963 | 
2025-10-02 15:11:15.382050 | TASK [Install venv]
2025-10-02 15:12:23.477358 | controller | changed
2025-10-02 15:12:23.502920 | 
2025-10-02 15:12:23.503022 | PLAY RECAP
2025-10-02 15:12:23.503068 | controller | ok: 7 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0
2025-10-02 15:12:23.503093 | 
2025-10-02 15:12:23.590527 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-prepare.yml@main]
2025-10-02 15:12:23.591328 | RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-test.yml@main]
2025-10-02 15:12:24.136795 | 
2025-10-02 15:12:24.136989 | PLAY [Run ci/playbooks/molecule-test.yml]
2025-10-02 15:12:24.158583 | 
2025-10-02 15:12:24.158684 | TASK [Gather required facts]
2025-10-02 15:12:24.685018 | controller | ok
2025-10-02 15:12:24.690252 | 
2025-10-02 15:12:24.690327 | TASK [Load environment var if instructed to]
2025-10-02 15:12:24.714436 | controller | skipping: Conditional result was False
2025-10-02 15:12:24.719789 | 
2025-10-02 15:12:24.719860 | TASK [Run molecule]
2025-10-02 15:12:25.723545 | controller | INFO     Found config file /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/.config/molecule/config.yml
2025-10-02 15:12:25.795810 | controller | INFO     Performing prerun with role_name_check=0...
2025-10-02 15:12:43.184580 | controller | WARNING  Another version of '@NAMESPACE@.@NAME@' 3.1.4 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 3.1.4 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.185001 | controller | WARNING  Another version of 'ansible.netcommon' 7.1.0 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 7.1.0 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.185473 | controller | WARNING  Another version of 'ansible.posix' 1.6.2 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 1.6.2 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.185950 | controller | WARNING  Another version of 'ansible.utils' 5.1.2 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 5.1.2 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.186439 | controller | WARNING  Another version of 'cifmw.general' 1.0.0+41f2edaa was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 1.0.0+41f2edaa (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.186914 | controller | WARNING  Another version of 'cisco.ios' 9.0.3 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 9.0.3 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.187360 | controller | WARNING  Another version of 'community.crypto' 2.22.3 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 2.22.3 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.187803 | controller | WARNING  Another version of 'community.general' 10.0.1 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 10.0.1 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.188247 | controller | WARNING  Another version of 'community.libvirt' 1.3.0 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 1.3.0 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.188697 | controller | WARNING  Another version of 'community.okd' 4.0.0 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 4.0.0 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.189163 | controller | WARNING  Another version of 'containers.podman' 1.16.2 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 1.16.2 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.189619 | controller | WARNING  Another version of 'junipernetworks.junos' 9.1.0 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 9.1.0 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.190086 | controller | WARNING  Another version of 'kubernetes.core' 5.0.0 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 5.0.0 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.190541 | controller | WARNING  Another version of 'mellanox.onyx' 1.0.0 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 1.0.0 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.191001 | controller | WARNING  Another version of 'openstack.config_template' 2.1.1 was found installed in /home/zuul/.cache/ansible-compat/addcb0/collections/ansible_collections, only the first one will be used, 2.1.1 (/home/zuul/.ansible/collections/ansible_collections).
2025-10-02 15:12:43.200710 | controller | INFO     Running flexible_loop > prepare
2025-10-02 15:12:43.930409 | controller |
2025-10-02 15:12:43.930492 | controller | PLAY [Prepare] *****************************************************************
2025-10-02 15:12:43.930643 | controller |
2025-10-02 15:12:43.930655 | controller | TASK [Gathering Facts] *********************************************************
2025-10-02 15:12:43.930753 | controller | Thursday 02 October 2025  15:12:43 +0000 (0:00:00.018)       0:00:00.018 ******
2025-10-02 15:12:44.819085 | controller | ok: [instance]
2025-10-02 15:12:44.819165 | controller |
2025-10-02 15:12:44.819270 | controller | TASK [Include ci_setup role] ***************************************************
2025-10-02 15:12:44.819409 | controller | Thursday 02 October 2025  15:12:44 +0000 (0:00:00.889)       0:00:00.908 ******
2025-10-02 15:12:44.880727 | controller |
2025-10-02 15:12:44.880878 | controller | TASK [ci_setup : Gather variables for each operating system] *******************
2025-10-02 15:12:44.881054 | controller | Thursday 02 October 2025  15:12:44 +0000 (0:00:00.061)       0:00:00.969 ******
2025-10-02 15:12:44.936683 | controller | ok: [instance] => (item=/home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_setup/vars/redhat.yml)
2025-10-02 15:12:44.936749 | controller |
2025-10-02 15:12:44.936878 | controller | TASK [ci_setup : List packages to install] *************************************
2025-10-02 15:12:44.936994 | controller | Thursday 02 October 2025  15:12:44 +0000 (0:00:00.056)       0:00:01.026 ******
2025-10-02 15:12:44.965557 | controller | ok: [instance] =>
2025-10-02 15:12:44.965639 | controller |   cifmw_ci_setup_packages:
2025-10-02 15:12:44.965742 | controller |   - bash-completion
2025-10-02 15:12:44.965877 | controller |   - ca-certificates
2025-10-02 15:12:44.965982 | controller |   - git-core
2025-10-02 15:12:44.966087 | controller |   - make
2025-10-02 15:12:44.966176 | controller |   - tar
2025-10-02 15:12:44.966277 | controller |   - tmux
2025-10-02 15:12:44.966384 | controller |   - python3-pip
2025-10-02 15:12:44.966482 | controller |
2025-10-02 15:12:44.966618 | controller | TASK [ci_setup : Install needed packages] **************************************
2025-10-02 15:12:44.966709 | controller | Thursday 02 October 2025  15:12:44 +0000 (0:00:00.028)       0:00:01.054 ******
2025-10-02 15:12:49.105808 | controller | changed: [instance]
2025-10-02 15:12:49.105927 | controller |
2025-10-02 15:12:49.106039 | controller | TASK [ci_setup : Gather version of openshift client] ***************************
2025-10-02 15:12:49.106147 | controller | Thursday 02 October 2025  15:12:49 +0000 (0:00:04.140)       0:00:05.195 ******
2025-10-02 15:12:49.414168 | controller | ok: [instance]
2025-10-02 15:12:49.414228 | controller |
2025-10-02 15:12:49.414341 | controller | TASK [ci_setup : Ensure openshift client install path is present] **************
2025-10-02 15:12:49.414450 | controller | Thursday 02 October 2025  15:12:49 +0000 (0:00:00.308)       0:00:05.503 ******
2025-10-02 15:12:49.723678 | controller | changed: [instance]
2025-10-02 15:12:49.723738 | controller |
2025-10-02 15:12:49.723870 | controller | TASK [ci_setup : Install openshift client] *************************************
2025-10-02 15:12:49.723984 | controller | Thursday 02 October 2025  15:12:49 +0000 (0:00:00.309)       0:00:05.812 ******
2025-10-02 15:12:55.683968 | controller | changed: [instance]
2025-10-02 15:12:55.719929 | controller |
2025-10-02 15:12:55.719967 | controller | TASK [ci_setup : Add the OC path to cifmw_path if needed] **********************
2025-10-02 15:12:55.719977 | controller | Thursday 02 October 2025  15:12:55 +0000 (0:00:05.959)       0:00:11.772 ******
2025-10-02 15:12:55.719988 | controller | skipping: [instance]
2025-10-02 15:12:55.986285 | controller |
2025-10-02 15:12:55.986331 | controller | TASK [ci_setup : Create completion file] ***************************************
2025-10-02 15:12:55.986341 | controller | Thursday 02 October 2025  15:12:55 +0000 (0:00:00.036)       0:00:11.808 ******
2025-10-02 15:12:55.986352 | controller | changed: [instance]
2025-10-02 15:12:56.270729 | controller |
2025-10-02 15:12:56.270767 | controller | TASK [ci_setup : Source completion from within .bashrc] ************************
2025-10-02 15:12:56.270780 | controller | Thursday 02 October 2025  15:12:55 +0000 (0:00:00.266)       0:00:12.075 ******
2025-10-02 15:12:56.270791 | controller | changed: [instance]
2025-10-02 15:12:56.291675 | controller |
2025-10-02 15:12:56.291714 | controller | TASK [ci_setup : Check rhsm status] ********************************************
2025-10-02 15:12:56.291723 | controller | Thursday 02 October 2025  15:12:56 +0000 (0:00:00.284)       0:00:12.359 ******
2025-10-02 15:12:56.291734 | controller | skipping: [instance]
2025-10-02 15:12:56.312436 | controller |
2025-10-02 15:12:56.312466 | controller | TASK [ci_setup : Gather the repos to be enabled] *******************************
2025-10-02 15:12:56.312474 | controller | Thursday 02 October 2025  15:12:56 +0000 (0:00:00.021)       0:00:12.380 ******
2025-10-02 15:12:56.312486 | controller | skipping: [instance]
2025-10-02 15:12:56.332477 | controller |
2025-10-02 15:12:56.332500 | controller | TASK [ci_setup : Enabling the required repositories.] **************************
2025-10-02 15:12:56.332508 | controller | Thursday 02 October 2025  15:12:56 +0000 (0:00:00.020)       0:00:12.401 ******
2025-10-02 15:12:56.332518 | controller | skipping: [instance]
2025-10-02 15:12:56.351923 | controller |
2025-10-02 15:12:56.351962 | controller | TASK [ci_setup : Get current /etc/redhat-release] ******************************
2025-10-02 15:12:56.351971 | controller | Thursday 02 October 2025  15:12:56 +0000 (0:00:00.020)       0:00:12.421 ******
2025-10-02 15:12:56.351982 | controller | skipping: [instance]
2025-10-02 15:12:56.352486 | controller |
2025-10-02 15:12:56.371891 | controller | TASK [ci_setup : Print current /etc/redhat-release] ****************************
2025-10-02 15:12:56.371919 | controller | Thursday 02 October 2025  15:12:56 +0000 (0:00:00.019)       0:00:12.441 ******
2025-10-02 15:12:56.371934 | controller | skipping: [instance]
2025-10-02 15:12:56.395673 | controller |
2025-10-02 15:12:56.395710 | controller | TASK [ci_setup : Ensure the repos are enabled in the system using yum] *********
2025-10-02 15:12:56.395720 | controller | Thursday 02 October 2025  15:12:56 +0000 (0:00:00.019)       0:00:12.461 ******
2025-10-02 15:12:56.395732 | controller | skipping: [instance]
2025-10-02 15:12:56.395861 | controller |
2025-10-02 15:12:56.395875 | controller | TASK [ci_setup : Manage directories] *******************************************
2025-10-02 15:12:56.395886 | controller | Thursday 02 October 2025  15:12:56 +0000 (0:00:00.024)       0:00:12.485 ******
2025-10-02 15:12:57.428090 | controller | changed: [instance] => (item=/home/zuul/ci-framework-data/artifacts/manifests/openstack/cr)
2025-10-02 15:12:57.816923 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/logs)
2025-10-02 15:12:57.816959 | controller | changed: [instance] => (item=/home/zuul/ci-framework-data/tmp)
2025-10-02 15:12:57.816967 | controller | changed: [instance] => (item=/home/zuul/ci-framework-data/volumes)
2025-10-02 15:12:57.816975 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/parameters)
2025-10-02 15:12:57.816981 | controller |
2025-10-02 15:12:57.816987 | controller | TASK [Create nova migration keypair] *******************************************
2025-10-02 15:12:57.816993 | controller | Thursday 02 October 2025  15:12:57 +0000 (0:00:01.031)       0:00:13.516 ******
2025-10-02 15:12:57.817003 | controller | changed: [instance]
2025-10-02 15:12:57.817370 | controller |
2025-10-02 15:12:58.075707 | controller | TASK [Create user keypair] *****************************************************
2025-10-02 15:12:58.075741 | controller | Thursday 02 October 2025  15:12:57 +0000 (0:00:00.389)       0:00:13.906 ******
2025-10-02 15:12:58.075754 | controller | changed: [instance]
2025-10-02 15:12:58.536985 | controller |
2025-10-02 15:12:58.537024 | controller | TASK [Create fake kubeconfig] **************************************************
2025-10-02 15:12:58.537037 | controller | Thursday 02 October 2025  15:12:58 +0000 (0:00:00.258)       0:00:14.164 ******
2025-10-02 15:12:58.537049 | controller | changed: [instance]
2025-10-02 15:12:58.537077 | controller |
2025-10-02 15:12:58.537084 | controller | PLAY RECAP *********************************************************************
2025-10-02 15:12:58.537096 | controller | instance                   : ok=13   changed=9    unreachable=0    failed=0    skipped=7    rescued=0    ignored=0
2025-10-02 15:12:58.537102 | controller |
2025-10-02 15:12:58.537107 | controller | Thursday 02 October 2025  15:12:58 +0000 (0:00:00.460)       0:00:14.625 ******
2025-10-02 15:12:58.537113 | controller | ===============================================================================
2025-10-02 15:12:58.537118 | controller | ci_setup : Install openshift client ------------------------------------- 5.96s
2025-10-02 15:12:58.537130 | controller | ci_setup : Install needed packages -------------------------------------- 4.14s
2025-10-02 15:12:58.537138 | controller | ci_setup : Manage directories ------------------------------------------- 1.03s
2025-10-02 15:12:58.537164 | controller | Gathering Facts --------------------------------------------------------- 0.89s
2025-10-02 15:12:58.538732 | controller | Create fake kubeconfig -------------------------------------------------- 0.46s
2025-10-02 15:12:58.604880 | controller | Create nova migration keypair ------------------------------------------- 0.39s
2025-10-02 15:12:58.604933 | controller | ci_setup : Ensure openshift client install path is present -------------- 0.31s
2025-10-02 15:12:58.604942 | controller | ci_setup : Gather version of openshift client --------------------------- 0.31s
2025-10-02 15:12:58.604948 | controller | ci_setup : Source completion from within .bashrc ------------------------ 0.28s
2025-10-02 15:12:58.604954 | controller | ci_setup : Create completion file --------------------------------------- 0.27s
2025-10-02 15:12:58.604959 | controller | Create user keypair ----------------------------------------------------- 0.26s
2025-10-02 15:12:58.604965 | controller | Include ci_setup role --------------------------------------------------- 0.06s
2025-10-02 15:12:58.604970 | controller | ci_setup : Gather variables for each operating system ------------------- 0.06s
2025-10-02 15:12:58.604976 | controller | ci_setup : Add the OC path to cifmw_path if needed ---------------------- 0.04s
2025-10-02 15:12:58.604982 | controller | ci_setup : List packages to install ------------------------------------- 0.03s
2025-10-02 15:12:58.604987 | controller | ci_setup : Ensure the repos are enabled in the system using yum --------- 0.02s
2025-10-02 15:12:58.604993 | controller | ci_setup : Check rhsm status -------------------------------------------- 0.02s
2025-10-02 15:12:58.604998 | controller | ci_setup : Gather the repos to be enabled ------------------------------- 0.02s
2025-10-02 15:12:58.605004 | controller | ci_setup : Enabling the required repositories. -------------------------- 0.02s
2025-10-02 15:12:58.605010 | controller | ci_setup : Print current /etc/redhat-release ---------------------------- 0.02s
2025-10-02 15:12:58.605022 | controller | INFO     Running flexible_loop > converge
2025-10-02 15:12:59.076202 | controller |
2025-10-02 15:12:59.076433 | controller | PLAY [Converge] ****************************************************************
2025-10-02 15:12:59.076584 | controller |
2025-10-02 15:12:59.076728 | controller | TASK [Gathering Facts] *********************************************************
2025-10-02 15:12:59.076889 | controller | Thursday 02 October 2025  15:12:59 +0000 (0:00:00.018)       0:00:00.018 ******
2025-10-02 15:12:59.958961 | controller | ok: [instance]
2025-10-02 15:13:00.008016 | controller |
2025-10-02 15:13:00.008063 | controller | TASK [Load networking environment definition] **********************************
2025-10-02 15:13:00.008072 | controller | Thursday 02 October 2025  15:12:59 +0000 (0:00:00.882)       0:00:00.900 ******
2025-10-02 15:13:00.008084 | controller | ok: [instance]
2025-10-02 15:13:00.008277 | controller |
2025-10-02 15:13:00.008308 | controller | TASK [kustomize_deploy : Ensure that architecture repo exists] *****************
2025-10-02 15:13:00.372528 | controller | Thursday 02 October 2025  15:13:00 +0000 (0:00:00.049)       0:00:00.950 ******
2025-10-02 15:13:00.372605 | controller | ok: [instance]
2025-10-02 15:13:00.774428 | controller |
2025-10-02 15:13:00.774484 | controller | TASK [kustomize_deploy : Gather the list of scenario folders] ******************
2025-10-02 15:13:00.774494 | controller | Thursday 02 October 2025  15:13:00 +0000 (0:00:00.363)       0:00:01.314 ******
2025-10-02 15:13:00.774508 | controller | ok: [instance]
2025-10-02 15:13:00.806457 | controller |
2025-10-02 15:13:00.806496 | controller | TASK [kustomize_deploy : Check if scenario is in the list] *********************
2025-10-02 15:13:00.806506 | controller | Thursday 02 October 2025  15:13:00 +0000 (0:00:00.401)       0:00:01.715 ******
2025-10-02 15:13:00.806518 | controller | skipping: [instance]
2025-10-02 15:13:01.167327 | controller |
2025-10-02 15:13:01.167386 | controller | TASK [kustomize_deploy : Ensure that destination directory exists] *************
2025-10-02 15:13:01.167396 | controller | Thursday 02 October 2025  15:13:00 +0000 (0:00:00.032)       0:00:01.748 ******
2025-10-02 15:13:01.167410 | controller | changed: [instance]
2025-10-02 15:13:01.244692 | controller |
2025-10-02 15:13:01.244720 | controller | TASK [kustomize_deploy : Set the final cifmw_architecture_user_kustomize based on its patches] ***
2025-10-02 15:13:01.244738 | controller | Thursday 02 October 2025  15:13:01 +0000 (0:00:00.360)       0:00:02.108 ******
2025-10-02 15:13:01.244749 | controller | ok: [instance] => (item=cifmw_architecture_user_kustomize)
2025-10-02 15:13:01.318985 | controller |
2025-10-02 15:13:01.319031 | controller | TASK [kustomize_deploy : Set the final cifmw_architecture_user_kustomize_base64 based on its patches] ***
2025-10-02 15:13:01.319041 | controller | Thursday 02 October 2025  15:13:01 +0000 (0:00:00.078)       0:00:02.187 ******
2025-10-02 15:13:01.319054 | controller | ok: [instance]
2025-10-02 15:13:01.319088 | controller |
2025-10-02 15:13:01.319098 | controller | TASK [Load architecture automation] ********************************************
2025-10-02 15:13:01.319226 | controller | Thursday 02 October 2025  15:13:01 +0000 (0:00:00.074)       0:00:02.261 ******
2025-10-02 15:13:01.368599 | controller | ok: [instance]
2025-10-02 15:13:01.593511 | controller |
2025-10-02 15:13:01.593594 | controller | TASK [Loop the deploy] *********************************************************
2025-10-02 15:13:01.593603 | controller | Thursday 02 October 2025  15:13:01 +0000 (0:00:00.048)       0:00:02.310 ******
2025-10-02 15:13:01.593619 | controller |
2025-10-02 15:13:01.647407 | controller | TASK [kustomize_deploy : Assert mandatory bits are defined] ********************
2025-10-02 15:13:01.647450 | controller | Thursday 02 October 2025  15:13:01 +0000 (0:00:00.224)       0:00:02.535 ******
2025-10-02 15:13:01.647464 | controller | ok: [instance] => changed=false
2025-10-02 15:13:01.683813 | controller |   msg: All assertions passed
2025-10-02 15:13:01.683860 | controller |
2025-10-02 15:13:01.683873 | controller | TASK [kustomize_deploy : Check custom wait conditions] *************************
2025-10-02 15:13:01.683881 | controller | Thursday 02 October 2025  15:13:01 +0000 (0:00:00.054)       0:00:02.589 ******
2025-10-02 15:13:01.683893 | controller | skipping: [instance]
2025-10-02 15:13:01.717331 | controller |
2025-10-02 15:13:01.717364 | controller | TASK [kustomize_deploy : Check builtin wait conditions] ************************
2025-10-02 15:13:01.717372 | controller | Thursday 02 October 2025  15:13:01 +0000 (0:00:00.036)       0:00:02.626 ******
2025-10-02 15:13:01.717383 | controller | ok: [instance] => (item=oc -n openstack wait nncp -l osp/nncm-config-type=standard --for jsonpath='{.status.conditions[0].reason}'=SuccessfullyConfigured --timeout=5m)
2025-10-02 15:13:01.751022 | controller |
2025-10-02 15:13:01.751082 | controller | TASK [kustomize_deploy : Check wait_conditions validation result] **************
2025-10-02 15:13:01.751099 | controller | Thursday 02 October 2025  15:13:01 +0000 (0:00:00.033)       0:00:02.659 ******
2025-10-02 15:13:01.751114 | controller | skipping: [instance]
2025-10-02 15:13:01.751150 | controller |
2025-10-02 15:13:01.751174 | controller | TASK [kustomize_deploy : Set stage_wait_conditions fact] ***********************
2025-10-02 15:13:01.751302 | controller | Thursday 02 October 2025  15:13:01 +0000 (0:00:00.034)       0:00:02.693 ******
2025-10-02 15:13:01.802399 | controller | ok: [instance]
2025-10-02 15:13:02.134662 | controller |
2025-10-02 15:13:02.134701 | controller | TASK [kustomize_deploy : Ensure source files exists] ***************************
2025-10-02 15:13:02.134710 | controller | Thursday 02 October 2025  15:13:01 +0000 (0:00:00.051)       0:00:02.744 ******
2025-10-02 15:13:02.134721 | controller | ok: [instance] => (item={'name': 'network-values', 'src_file': 'values.yaml'})
2025-10-02 15:13:02.203018 | controller |
2025-10-02 15:13:02.203053 | controller | TASK [kustomize_deploy : Assert source files exist] ****************************
2025-10-02 15:13:02.203064 | controller | Thursday 02 October 2025  15:13:02 +0000 (0:00:00.331)       0:00:03.076 ******
2025-10-02 15:13:02.203076 | controller | ok: [instance] => (item=values.yaml)
2025-10-02 15:13:02.253862 | controller |
2025-10-02 15:13:02.253889 | controller | TASK [Executing pre_stage hooks for examples/va/hci/control-plane/networking/nncp] ***
2025-10-02 15:13:02.253898 | controller | Thursday 02 October 2025  15:13:02 +0000 (0:00:00.068)       0:00:03.145 ******
2025-10-02 15:13:02.253910 | controller | skipping: [instance]
2025-10-02 15:13:02.350597 | controller |
2025-10-02 15:13:02.350623 | controller | TASK [Generate values.yaml for examples/va/hci/control-plane/networking/nncp] ***
2025-10-02 15:13:02.350632 | controller | Thursday 02 October 2025  15:13:02 +0000 (0:00:00.051)       0:00:03.196 ******
2025-10-02 15:13:02.350666 | controller |
2025-10-02 15:13:02.433998 | controller | TASK [ci_gen_kustomize_values : Generate snippets files] ***********************
2025-10-02 15:13:02.434040 | controller | Thursday 02 October 2025  15:13:02 +0000 (0:00:00.096)       0:00:03.292 ******
2025-10-02 15:13:02.434053 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_snippets.yml for instance
2025-10-02 15:13:02.491061 | controller |
2025-10-02 15:13:02.491110 | controller | TASK [ci_gen_kustomize_values : Ensure needed parameter is properly set] *******
2025-10-02 15:13:02.491119 | controller | Thursday 02 October 2025  15:13:02 +0000 (0:00:00.083)       0:00:03.376 ******
2025-10-02 15:13:02.491131 | controller | ok: [instance] => changed=false
2025-10-02 15:13:02.732366 | controller |   msg: All assertions passed
2025-10-02 15:13:02.732422 | controller |
2025-10-02 15:13:02.732431 | controller | TASK [ci_gen_kustomize_values : Stat original source file] *********************
2025-10-02 15:13:02.732439 | controller | Thursday 02 October 2025  15:13:02 +0000 (0:00:00.056)       0:00:03.432 ******
2025-10-02 15:13:02.732453 | controller | ok: [instance]
2025-10-02 15:13:02.791445 | controller |
2025-10-02 15:13:02.791482 | controller | TASK [ci_gen_kustomize_values : Assert source file exists] *********************
2025-10-02 15:13:02.791491 | controller | Thursday 02 October 2025  15:13:02 +0000 (0:00:00.241)       0:00:03.674 ******
2025-10-02 15:13:02.791502 | controller | ok: [instance] => changed=false
2025-10-02 15:13:03.190535 | controller |   msg: All assertions passed
2025-10-02 15:13:03.190610 | controller |
2025-10-02 15:13:03.190620 | controller | TASK [ci_gen_kustomize_values : Load original values file] *********************
2025-10-02 15:13:03.190628 | controller | Thursday 02 October 2025  15:13:02 +0000 (0:00:00.059)       0:00:03.733 ******
2025-10-02 15:13:03.190641 | controller | ok: [instance]
2025-10-02 15:13:03.527970 | controller |
2025-10-02 15:13:03.528006 | controller | TASK [ci_gen_kustomize_values : Expose common data for future usage] ***********
2025-10-02 15:13:03.528016 | controller | Thursday 02 October 2025  15:13:03 +0000 (0:00:00.398)       0:00:04.132 ******
2025-10-02 15:13:03.528029 | controller | ok: [instance]
2025-10-02 15:13:03.613106 | controller |
2025-10-02 15:13:03.613154 | controller | TASK [ci_gen_kustomize_values : Ensure we get the needed data depending on the values type] ***
2025-10-02 15:13:03.613164 | controller | Thursday 02 October 2025  15:13:03 +0000 (0:00:00.337)       0:00:04.470 ******
2025-10-02 15:13:03.613179 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/network_values.yml for instance
2025-10-02 15:13:03.613187 | controller |
2025-10-02 15:13:03.613195 | controller | TASK [ci_gen_kustomize_values : Assert we have needed parameters] **************
2025-10-02 15:13:03.613204 | controller | Thursday 02 October 2025  15:13:03 +0000 (0:00:00.084)       0:00:04.554 ******
2025-10-02 15:13:03.667958 | controller | ok: [instance] => changed=false
2025-10-02 15:13:03.668303 | controller |   msg: All assertions passed
2025-10-02 15:13:03.668358 | controller |
2025-10-02 15:13:03.893358 | controller | TASK [ci_gen_kustomize_values : Ensure output directory exists] ****************
2025-10-02 15:13:03.893396 | controller | Thursday 02 October 2025  15:13:03 +0000 (0:00:00.055)       0:00:04.610 ******
2025-10-02 15:13:03.893408 | controller | changed: [instance]
2025-10-02 15:13:04.468458 | controller |
2025-10-02 15:13:04.468495 | controller | TASK [ci_gen_kustomize_values : Generate CI snippet] ***************************
2025-10-02 15:13:04.468503 | controller | Thursday 02 October 2025  15:13:03 +0000 (0:00:00.225)       0:00:04.835 ******
2025-10-02 15:13:04.468514 | controller | changed: [instance]
2025-10-02 15:13:04.544404 | controller |
2025-10-02 15:13:04.544443 | controller | TASK [ci_gen_kustomize_values : Generate the base64 CI ConfigMap patches] ******
2025-10-02 15:13:04.544451 | controller | Thursday 02 October 2025  15:13:04 +0000 (0:00:00.575)       0:00:05.410 ******
2025-10-02 15:13:04.544462 | controller | ok: [instance]
2025-10-02 15:13:04.935038 | controller |
2025-10-02 15:13:04.935077 | controller | TASK [ci_gen_kustomize_values : Push base64 CI patches] ************************
2025-10-02 15:13:04.935086 | controller | Thursday 02 October 2025  15:13:04 +0000 (0:00:00.075)       0:00:05.486 ******
2025-10-02 15:13:04.935099 | controller | changed: [instance]
2025-10-02 15:13:05.348832 | controller |
2025-10-02 15:13:05.348908 | controller | TASK [ci_gen_kustomize_values : Push user provided dataset] ********************
2025-10-02 15:13:05.348928 | controller | Thursday 02 October 2025  15:13:04 +0000 (0:00:00.390)       0:00:05.877 ******
2025-10-02 15:13:05.348942 | controller | changed: [instance]
2025-10-02 15:13:05.767992 | controller |
2025-10-02 15:13:05.768053 | controller | TASK [ci_gen_kustomize_values : Copy the base values.yaml] *********************
2025-10-02 15:13:05.768063 | controller | Thursday 02 October 2025  15:13:05 +0000 (0:00:00.413)       0:00:06.290 ******
2025-10-02 15:13:05.768077 | controller | changed: [instance]
2025-10-02 15:13:05.768105 | controller |
2025-10-02 15:13:05.768114 | controller | TASK [ci_gen_kustomize_values : Generate values file] **************************
2025-10-02 15:13:05.846819 | controller | Thursday 02 October 2025  15:13:05 +0000 (0:00:00.419)       0:00:06.709 ******
2025-10-02 15:13:05.846899 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_values.yml for instance
2025-10-02 15:13:05.846931 | controller |
2025-10-02 15:13:05.847172 | controller | TASK [ci_gen_kustomize_values : Ensure we have needed parameter] ***************
2025-10-02 15:13:05.902697 | controller | Thursday 02 October 2025  15:13:05 +0000 (0:00:00.079)       0:00:06.789 ******
2025-10-02 15:13:05.902757 | controller | ok: [instance] => changed=false
2025-10-02 15:13:06.161559 | controller |   msg: All assertions passed
2025-10-02 15:13:06.161627 | controller |
2025-10-02 15:13:06.161636 | controller | TASK [ci_gen_kustomize_values : List snippets] *********************************
2025-10-02 15:13:06.161643 | controller | Thursday 02 October 2025  15:13:05 +0000 (0:00:00.055)       0:00:06.844 ******
2025-10-02 15:13:06.161656 | controller | ok: [instance]
2025-10-02 15:13:06.225387 | controller |
2025-10-02 15:13:06.225440 | controller | TASK [ci_gen_kustomize_values : Ensure _content is empty] **********************
2025-10-02 15:13:06.225450 | controller | Thursday 02 October 2025  15:13:06 +0000 (0:00:00.258)       0:00:07.103 ******
2025-10-02 15:13:06.225463 | controller | ok: [instance]
2025-10-02 15:13:06.889934 | controller |
2025-10-02 15:13:06.889972 | controller | TASK [ci_gen_kustomize_values : Load various snippet files] ********************
2025-10-02 15:13:06.889981 | controller | Thursday 02 October 2025  15:13:06 +0000 (0:00:00.063)       0:00:07.167 ******
2025-10-02 15:13:06.889993 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/network-values/02_ci_data.yaml)
2025-10-02 15:13:06.890012 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/network-values/03_user_data_b64.yaml)
2025-10-02 15:13:06.890019 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/network-values/04_user_data.yaml)
2025-10-02 15:13:06.890026 | controller |
2025-10-02 15:13:06.890185 | controller | TASK [ci_gen_kustomize_values : Combine snippets] ******************************
2025-10-02 15:13:06.890227 | controller | Thursday 02 October 2025  15:13:06 +0000 (0:00:00.664)       0:00:07.832 ******
2025-10-02 15:13:07.029980 | controller | ok: [instance] => (item=02_ci_data.yaml)
2025-10-02 15:13:07.030366 | controller | ok: [instance] => (item=03_user_data_b64.yaml)
2025-10-02 15:13:07.030379 | controller | ok: [instance] => (item=04_user_data.yaml)
2025-10-02 15:13:07.030389 | controller |
2025-10-02 15:13:07.287922 | controller | TASK [ci_gen_kustomize_values : Ensure directories exist] **********************
2025-10-02 15:13:07.287960 | controller | Thursday 02 October 2025  15:13:07 +0000 (0:00:00.140)       0:00:07.972 ******
2025-10-02 15:13:07.287974 | controller | changed: [instance]
2025-10-02 15:13:07.719037 | controller |
2025-10-02 15:13:07.719072 | controller | TASK [ci_gen_kustomize_values : Output values file] ****************************
2025-10-02 15:13:07.719080 | controller | Thursday 02 October 2025  15:13:07 +0000 (0:00:00.257)       0:00:08.229 ******
2025-10-02 15:13:07.719092 | controller | changed: [instance]
2025-10-02 15:13:08.054567 | controller |
2025-10-02 15:13:08.054630 | controller | TASK [kustomize_deploy : Copy generated values for examples/va/hci/control-plane/networking/nncp] ***
2025-10-02 15:13:08.054640 | controller | Thursday 02 October 2025  15:13:07 +0000 (0:00:00.430)       0:00:08.660 ******
2025-10-02 15:13:08.054653 | controller | changed: [instance] => (item=network-values)
2025-10-02 15:13:08.114730 | controller |
2025-10-02 15:13:08.114755 | controller | TASK [kustomize_deploy : Stop before building kustomization if requested] ******
2025-10-02 15:13:08.114776 | controller | Thursday 02 October 2025  15:13:08 +0000 (0:00:00.335)       0:00:08.996 ******
2025-10-02 15:13:08.114787 | controller | skipping: [instance]
2025-10-02 15:13:08.675253 | controller |
2025-10-02 15:13:08.675294 | controller | TASK [kustomize_deploy : Build kustomized content for examples/va/hci/control-plane/networking/nncp] ***
2025-10-02 15:13:08.675303 | controller | Thursday 02 October 2025  15:13:08 +0000 (0:00:00.060)       0:00:09.056 ******
2025-10-02 15:13:08.675314 | controller | changed: [instance]
2025-10-02 15:13:09.095886 | controller |
2025-10-02 15:13:09.095925 | controller | TASK [kustomize_deploy : Output kustomize build in final file] *****************
2025-10-02 15:13:09.095934 | controller | Thursday 02 October 2025  15:13:08 +0000 (0:00:00.560)       0:00:09.617 ******
2025-10-02 15:13:09.095945 | controller | changed: [instance]
2025-10-02 15:13:09.334411 | controller |
2025-10-02 15:13:09.334456 | controller | TASK [kustomize_deploy : Store kustomized content in artifacts for examples/va/hci/control-plane/networking/nncp] ***
2025-10-02 15:13:09.334465 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.418)       0:00:10.035 ******
2025-10-02 15:13:09.334478 | controller | changed: [instance]
2025-10-02 15:13:09.394493 | controller |
2025-10-02 15:13:09.394537 | controller | TASK [kustomize_deploy : Stop after building kustomization if requested] *******
2025-10-02 15:13:09.394545 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.240)       0:00:10.275 ******
2025-10-02 15:13:09.394556 | controller | skipping: [instance]
2025-10-02 15:13:09.443923 | controller |
2025-10-02 15:13:09.443978 | controller | TASK [kustomize_deploy : Apply generated content for examples/va/hci/control-plane/networking/nncp] ***
2025-10-02 15:13:09.443989 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.061)       0:00:10.336 ******
2025-10-02 15:13:09.444003 | controller | skipping: [instance]
2025-10-02 15:13:09.499578 | controller |
2025-10-02 15:13:09.499730 | controller | TASK [kustomize_deploy : Run Wait Conditions for examples/va/hci/control-plane/networking/nncp] ***
2025-10-02 15:13:09.499746 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.049)       0:00:10.385 ******
2025-10-02 15:13:09.499774 | controller | skipping: [instance] => (item=oc -n openstack wait nncp -l osp/nncm-config-type=standard --for jsonpath='{.status.conditions[0].reason}'=SuccessfullyConfigured --timeout=5m)
2025-10-02 15:13:09.548726 | controller | skipping: [instance]
2025-10-02 15:13:09.548762 | controller |
2025-10-02 15:13:09.548771 | controller | TASK [kustomize_deploy : Stop after applying CRs if requested] *****************
2025-10-02 15:13:09.548780 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.055)       0:00:10.441 ******
2025-10-02 15:13:09.548792 | controller | skipping: [instance]
2025-10-02 15:13:09.602759 | controller |
2025-10-02 15:13:09.602778 | controller | TASK [Executing post_stage hooks for examples/va/hci/control-plane/networking/nncp] ***
2025-10-02 15:13:09.602786 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.049)       0:00:10.491 ******
2025-10-02 15:13:09.602795 | controller | skipping: [instance]
2025-10-02 15:13:09.653755 | controller |
2025-10-02 15:13:09.653778 | controller | TASK [kustomize_deploy : Assert mandatory bits are defined] ********************
2025-10-02 15:13:09.653786 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.053)       0:00:10.544 ******
2025-10-02 15:13:09.653795 | controller | ok: [instance] => changed=false
2025-10-02 15:13:09.692082 | controller |   msg: All assertions passed
2025-10-02 15:13:09.692159 | controller |
2025-10-02 15:13:09.692170 | controller | TASK [kustomize_deploy : Check custom wait conditions] *************************
2025-10-02 15:13:09.692178 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.051)       0:00:10.596 ******
2025-10-02 15:13:09.692211 | controller | skipping: [instance]
2025-10-02 15:13:09.724299 | controller |
2025-10-02 15:13:09.724339 | controller | TASK [kustomize_deploy : Check builtin wait conditions] ************************
2025-10-02 15:13:09.724347 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.038)       0:00:10.634 ******
2025-10-02 15:13:09.724358 | controller | ok: [instance] => (item=oc -n metallb-system wait pod -l app=metallb -l component=speaker --for condition=Ready --timeout=5m)
2025-10-02 15:13:09.751276 | controller |
2025-10-02 15:13:09.751302 | controller | TASK [kustomize_deploy : Check wait_conditions validation result] **************
2025-10-02 15:13:09.751324 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.032)       0:00:10.666 ******
2025-10-02 15:13:09.751336 | controller | skipping: [instance]
2025-10-02 15:13:09.792975 | controller |
2025-10-02 15:13:09.793022 | controller | TASK [kustomize_deploy : Set stage_wait_conditions fact] ***********************
2025-10-02 15:13:09.793033 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.027)       0:00:10.693 ******
2025-10-02 15:13:09.793047 | controller | ok: [instance]
2025-10-02 15:13:09.794953 | controller |
2025-10-02 15:13:09.794969 | controller | TASK [kustomize_deploy : Ensure source files exists] ***************************
2025-10-02 15:13:09.794980 | controller | Thursday 02 October 2025  15:13:09 +0000 (0:00:00.041)       0:00:10.734 ******
2025-10-02 15:13:10.071534 | controller | ok: [instance] => (item={'name': 'network-values', 'src_file': 'nncp/values.yaml'})
2025-10-02 15:13:10.141677 | controller |
2025-10-02 15:13:10.141717 | controller | TASK [kustomize_deploy : Assert source files exist] ****************************
2025-10-02 15:13:10.141726 | controller | Thursday 02 October 2025  15:13:10 +0000 (0:00:00.278)       0:00:11.013 ******
2025-10-02 15:13:10.141737 | controller | ok: [instance] => (item=values.yaml)
2025-10-02 15:13:10.194703 | controller |
2025-10-02 15:13:10.194740 | controller | TASK [Executing pre_stage hooks for examples/va/hci/control-plane/networking] ***
2025-10-02 15:13:10.194749 | controller | Thursday 02 October 2025  15:13:10 +0000 (0:00:00.069)       0:00:11.083 ******
2025-10-02 15:13:10.194760 | controller | skipping: [instance]
2025-10-02 15:13:10.281429 | controller |
2025-10-02 15:13:10.281460 | controller | TASK [Generate values.yaml for examples/va/hci/control-plane/networking] *******
2025-10-02 15:13:10.281468 | controller | Thursday 02 October 2025  15:13:10 +0000 (0:00:00.053)       0:00:11.136 ******
2025-10-02 15:13:10.281478 | controller |
2025-10-02 15:13:10.353615 | controller | TASK [ci_gen_kustomize_values : Generate snippets files] ***********************
2025-10-02 15:13:10.353664 | controller | Thursday 02 October 2025  15:13:10 +0000 (0:00:00.086)       0:00:11.223 ******
2025-10-02 15:13:10.353681 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_snippets.yml for instance
2025-10-02 15:13:10.419971 | controller |
2025-10-02 15:13:10.420017 | controller | TASK [ci_gen_kustomize_values : Ensure needed parameter is properly set] *******
2025-10-02 15:13:10.420027 | controller | Thursday 02 October 2025  15:13:10 +0000 (0:00:00.071)       0:00:11.295 ******
2025-10-02 15:13:10.420041 | controller | ok: [instance] => changed=false
2025-10-02 15:13:10.420160 | controller |   msg: All assertions passed
2025-10-02 15:13:10.420171 | controller |
2025-10-02 15:13:10.420178 | controller | TASK [ci_gen_kustomize_values : Stat original source file] *********************
2025-10-02 15:13:10.420188 | controller | Thursday 02 October 2025  15:13:10 +0000 (0:00:00.066)       0:00:11.361 ******
2025-10-02 15:13:10.664661 | controller | ok: [instance]
2025-10-02 15:13:10.736003 | controller |
2025-10-02 15:13:10.736034 | controller | TASK [ci_gen_kustomize_values : Assert source file exists] *********************
2025-10-02 15:13:10.736044 | controller | Thursday 02 October 2025  15:13:10 +0000 (0:00:00.243)       0:00:11.605 ******
2025-10-02 15:13:10.736056 | controller | ok: [instance] => changed=false
2025-10-02 15:13:10.969030 | controller |   msg: All assertions passed
2025-10-02 15:13:10.969077 | controller |
2025-10-02 15:13:10.969085 | controller | TASK [ci_gen_kustomize_values : Load original values file] *********************
2025-10-02 15:13:10.969092 | controller | Thursday 02 October 2025  15:13:10 +0000 (0:00:00.072)       0:00:11.677 ******
2025-10-02 15:13:10.969104 | controller | ok: [instance]
2025-10-02 15:13:11.240976 | controller |
2025-10-02 15:13:11.241019 | controller | TASK [ci_gen_kustomize_values : Expose common data for future usage] ***********
2025-10-02 15:13:11.241027 | controller | Thursday 02 October 2025  15:13:10 +0000 (0:00:00.233)       0:00:11.911 ******
2025-10-02 15:13:11.241039 | controller | ok: [instance]
2025-10-02 15:13:11.241073 | controller |
2025-10-02 15:13:11.241082 | controller | TASK [ci_gen_kustomize_values : Ensure we get the needed data depending on the values type] ***
2025-10-02 15:13:11.241102 | controller | Thursday 02 October 2025  15:13:11 +0000 (0:00:00.271)       0:00:12.183 ******
2025-10-02 15:13:11.316657 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/network_values.yml for instance
2025-10-02 15:13:11.381861 | controller |
2025-10-02 15:13:11.381904 | controller | TASK [ci_gen_kustomize_values : Assert we have needed parameters] **************
2025-10-02 15:13:11.381912 | controller | Thursday 02 October 2025  15:13:11 +0000 (0:00:00.075)       0:00:12.258 ******
2025-10-02 15:13:11.381924 | controller | ok: [instance] => changed=false
2025-10-02 15:13:11.636343 | controller |   msg: All assertions passed
2025-10-02 15:13:11.636378 | controller |
2025-10-02 15:13:11.636386 | controller | TASK [ci_gen_kustomize_values : Ensure output directory exists] ****************
2025-10-02 15:13:11.636400 | controller | Thursday 02 October 2025  15:13:11 +0000 (0:00:00.065)       0:00:12.323 ******
2025-10-02 15:13:11.636411 | controller | ok: [instance]
2025-10-02 15:13:12.143476 | controller |
2025-10-02 15:13:12.143519 | controller | TASK [ci_gen_kustomize_values : Generate CI snippet] ***************************
2025-10-02 15:13:12.143528 | controller | Thursday 02 October 2025  15:13:11 +0000 (0:00:00.254)       0:00:12.578 ******
2025-10-02 15:13:12.143540 | controller | ok: [instance]
2025-10-02 15:13:12.215402 | controller |
2025-10-02 15:13:12.215436 | controller | TASK [ci_gen_kustomize_values : Generate the base64 CI ConfigMap patches] ******
2025-10-02 15:13:12.215444 | controller | Thursday 02 October 2025  15:13:12 +0000 (0:00:00.507)       0:00:13.085 ******
2025-10-02 15:13:12.215455 | controller | ok: [instance]
2025-10-02 15:13:12.618758 | controller |
2025-10-02 15:13:12.618797 | controller | TASK [ci_gen_kustomize_values : Push base64 CI patches] ************************
2025-10-02 15:13:12.618805 | controller | Thursday 02 October 2025  15:13:12 +0000 (0:00:00.072)       0:00:13.157 ******
2025-10-02 15:13:12.618816 | controller | ok: [instance]
2025-10-02 15:13:13.023085 | controller |
2025-10-02 15:13:13.023121 | controller | TASK [ci_gen_kustomize_values : Push user provided dataset] ********************
2025-10-02 15:13:13.023129 | controller | Thursday 02 October 2025  15:13:12 +0000 (0:00:00.403)       0:00:13.560 ******
2025-10-02 15:13:13.023141 | controller | ok: [instance]
2025-10-02 15:13:13.524826 | controller |
2025-10-02 15:13:13.524906 | controller | TASK [ci_gen_kustomize_values : Copy the base values.yaml] *********************
2025-10-02 15:13:13.524915 | controller | Thursday 02 October 2025  15:13:13 +0000 (0:00:00.404)       0:00:13.965 ******
2025-10-02 15:13:13.524928 | controller | changed: [instance]
2025-10-02 15:13:13.604521 | controller |
2025-10-02 15:13:13.604624 | controller | TASK [ci_gen_kustomize_values : Generate values file] **************************
2025-10-02 15:13:13.604633 | controller | Thursday 02 October 2025  15:13:13 +0000 (0:00:00.501)       0:00:14.466 ******
2025-10-02 15:13:13.604646 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_values.yml for instance
2025-10-02 15:13:13.659459 | controller |
2025-10-02 15:13:13.659509 | controller | TASK [ci_gen_kustomize_values : Ensure we have needed parameter] ***************
2025-10-02 15:13:13.659517 | controller | Thursday 02 October 2025  15:13:13 +0000 (0:00:00.079)       0:00:14.545 ******
2025-10-02 15:13:13.659529 | controller | ok: [instance] => changed=false
2025-10-02 15:13:13.659710 | controller |   msg: All assertions passed
2025-10-02 15:13:13.659899 | controller |
2025-10-02 15:13:13.660052 | controller | TASK [ci_gen_kustomize_values : List snippets] *********************************
2025-10-02 15:13:13.660202 | controller | Thursday 02 October 2025  15:13:13 +0000 (0:00:00.056)       0:00:14.601 ******
2025-10-02 15:13:13.909575 | controller | ok: [instance]
2025-10-02 15:13:13.963765 | controller |
2025-10-02 15:13:13.963807 | controller | TASK [ci_gen_kustomize_values : Ensure _content is empty] **********************
2025-10-02 15:13:13.963815 | controller | Thursday 02 October 2025  15:13:13 +0000 (0:00:00.249)       0:00:14.851 ******
2025-10-02 15:13:13.963827 | controller | ok: [instance]
2025-10-02 15:13:14.605922 | controller |
2025-10-02 15:13:14.605960 | controller | TASK [ci_gen_kustomize_values : Load various snippet files] ********************
2025-10-02 15:13:14.605969 | controller | Thursday 02 October 2025  15:13:13 +0000 (0:00:00.054)       0:00:14.905 ******
2025-10-02 15:13:14.605980 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/network-values/02_ci_data.yaml)
2025-10-02 15:13:14.606547 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/network-values/03_user_data_b64.yaml)
2025-10-02 15:13:14.750402 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/network-values/04_user_data.yaml)
2025-10-02 15:13:14.750442 | controller |
2025-10-02 15:13:14.750450 | controller | TASK [ci_gen_kustomize_values : Combine snippets] ******************************
2025-10-02 15:13:14.750456 | controller | Thursday 02 October 2025  15:13:14 +0000 (0:00:00.642)       0:00:15.548 ******
2025-10-02 15:13:14.750468 | controller | ok: [instance] => (item=02_ci_data.yaml)
2025-10-02 15:13:15.016801 | controller | ok: [instance] => (item=03_user_data_b64.yaml)
2025-10-02 15:13:15.016868 | controller | ok: [instance] => (item=04_user_data.yaml)
2025-10-02 15:13:15.016876 | controller |
2025-10-02 15:13:15.016882 | controller | TASK [ci_gen_kustomize_values : Ensure directories exist] **********************
2025-10-02 15:13:15.016888 | controller | Thursday 02 October 2025  15:13:14 +0000 (0:00:00.143)       0:00:15.692 ******
2025-10-02 15:13:15.016902 | controller | ok: [instance]
2025-10-02 15:13:15.497099 | controller |
2025-10-02 15:13:15.497155 | controller | TASK [ci_gen_kustomize_values : Output values file] ****************************
2025-10-02 15:13:15.497163 | controller | Thursday 02 October 2025  15:13:15 +0000 (0:00:00.266)       0:00:15.958 ******
2025-10-02 15:13:15.497176 | controller | ok: [instance]
2025-10-02 15:13:15.776292 | controller |
2025-10-02 15:13:15.776331 | controller | TASK [kustomize_deploy : Copy generated values for examples/va/hci/control-plane/networking] ***
2025-10-02 15:13:15.776340 | controller | Thursday 02 October 2025  15:13:15 +0000 (0:00:00.480)       0:00:16.438 ******
2025-10-02 15:13:15.776351 | controller | ok: [instance] => (item=network-values)
2025-10-02 15:13:15.827385 | controller |
2025-10-02 15:13:15.827420 | controller | TASK [kustomize_deploy : Stop before building kustomization if requested] ******
2025-10-02 15:13:15.827428 | controller | Thursday 02 October 2025  15:13:15 +0000 (0:00:00.279)       0:00:16.718 ******
2025-10-02 15:13:15.827439 | controller | skipping: [instance]
2025-10-02 15:13:16.275254 | controller |
2025-10-02 15:13:16.275295 | controller | TASK [kustomize_deploy : Build kustomized content for examples/va/hci/control-plane/networking] ***
2025-10-02 15:13:16.275304 | controller | Thursday 02 October 2025  15:13:15 +0000 (0:00:00.051)       0:00:16.769 ******
2025-10-02 15:13:16.275324 | controller | changed: [instance]
2025-10-02 15:13:16.682987 | controller |
2025-10-02 15:13:16.683030 | controller | TASK [kustomize_deploy : Output kustomize build in final file] *****************
2025-10-02 15:13:16.683039 | controller | Thursday 02 October 2025  15:13:16 +0000 (0:00:00.447)       0:00:17.217 ******
2025-10-02 15:13:16.683050 | controller | changed: [instance]
2025-10-02 15:13:16.956643 | controller |
2025-10-02 15:13:16.956690 | controller | TASK [kustomize_deploy : Store kustomized content in artifacts for examples/va/hci/control-plane/networking] ***
2025-10-02 15:13:16.956699 | controller | Thursday 02 October 2025  15:13:16 +0000 (0:00:00.407)       0:00:17.624 ******
2025-10-02 15:13:16.956712 | controller | changed: [instance]
2025-10-02 15:13:17.018711 | controller |
2025-10-02 15:13:17.018762 | controller | TASK [kustomize_deploy : Stop after building kustomization if requested] *******
2025-10-02 15:13:17.018771 | controller | Thursday 02 October 2025  15:13:16 +0000 (0:00:00.273)       0:00:17.898 ******
2025-10-02 15:13:17.018784 | controller | skipping: [instance]
2025-10-02 15:13:17.075792 | controller |
2025-10-02 15:13:17.075825 | controller | TASK [kustomize_deploy : Apply generated content for examples/va/hci/control-plane/networking] ***
2025-10-02 15:13:17.075850 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.062)       0:00:17.960 ******
2025-10-02 15:13:17.075865 | controller | skipping: [instance]
2025-10-02 15:13:17.128983 | controller |
2025-10-02 15:13:17.129014 | controller | TASK [kustomize_deploy : Run Wait Conditions for examples/va/hci/control-plane/networking] ***
2025-10-02 15:13:17.129024 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.057)       0:00:18.017 ******
2025-10-02 15:13:17.129038 | controller | skipping: [instance] => (item=oc -n metallb-system wait pod -l app=metallb -l component=speaker --for condition=Ready --timeout=5m)
2025-10-02 15:13:17.129074 | controller | skipping: [instance]
2025-10-02 15:13:17.129083 | controller |
2025-10-02 15:13:17.129092 | controller | TASK [kustomize_deploy : Stop after applying CRs if requested] *****************
2025-10-02 15:13:17.129189 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.053)       0:00:18.071 ******
2025-10-02 15:13:17.188544 | controller | skipping: [instance]
2025-10-02 15:13:17.250699 | controller |
2025-10-02 15:13:17.250738 | controller | TASK [Executing post_stage hooks for examples/va/hci/control-plane/networking] ***
2025-10-02 15:13:17.250748 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.059)       0:00:18.130 ******
2025-10-02 15:13:17.250761 | controller | skipping: [instance]
2025-10-02 15:13:17.309941 | controller |
2025-10-02 15:13:17.309968 | controller | TASK [kustomize_deploy : Assert mandatory bits are defined] ********************
2025-10-02 15:13:17.309978 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.062)       0:00:18.192 ******
2025-10-02 15:13:17.309989 | controller | ok: [instance] => changed=false
2025-10-02 15:13:17.309996 | controller |   msg: All assertions passed
2025-10-02 15:13:17.310003 | controller |
2025-10-02 15:13:17.310010 | controller | TASK [kustomize_deploy : Check custom wait conditions] *************************
2025-10-02 15:13:17.310019 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.059)       0:00:18.252 ******
2025-10-02 15:13:17.354911 | controller | skipping: [instance]
2025-10-02 15:13:17.395979 | controller |
2025-10-02 15:13:17.396028 | controller | TASK [kustomize_deploy : Check builtin wait conditions] ************************
2025-10-02 15:13:17.396038 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.044)       0:00:18.296 ******
2025-10-02 15:13:17.396052 | controller | ok: [instance] => (item=oc -n openstack wait osctlplane controlplane --for condition=Ready --timeout=60m)
2025-10-02 15:13:17.421555 | controller |
2025-10-02 15:13:17.421592 | controller | TASK [kustomize_deploy : Check wait_conditions validation result] **************
2025-10-02 15:13:17.421601 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.041)       0:00:18.338 ******
2025-10-02 15:13:17.421622 | controller | skipping: [instance]
2025-10-02 15:13:17.464248 | controller |
2025-10-02 15:13:17.464279 | controller | TASK [kustomize_deploy : Set stage_wait_conditions fact] ***********************
2025-10-02 15:13:17.464287 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.025)       0:00:18.364 ******
2025-10-02 15:13:17.464298 | controller | ok: [instance]
2025-10-02 15:13:17.916875 | controller |
2025-10-02 15:13:17.916918 | controller | TASK [kustomize_deploy : Ensure source files exists] ***************************
2025-10-02 15:13:17.916927 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.042)       0:00:18.406 ******
2025-10-02 15:13:17.916939 | controller | ok: [instance] => (item={'name': 'service-values', 'src_file': 'service-values.yaml'})
2025-10-02 15:13:18.020999 | controller | ok: [instance] => (item={'name': 'network-values', 'src_file': 'networking/nncp/values.yaml'})
2025-10-02 15:13:18.021054 | controller |
2025-10-02 15:13:18.021062 | controller | TASK [kustomize_deploy : Assert source files exist] ****************************
2025-10-02 15:13:18.021069 | controller | Thursday 02 October 2025  15:13:17 +0000 (0:00:00.452)       0:00:18.858 ******
2025-10-02 15:13:18.021081 | controller | ok: [instance] => (item=service-values.yaml)
2025-10-02 15:13:18.080042 | controller | ok: [instance] => (item=values.yaml)
2025-10-02 15:13:18.080090 | controller |
2025-10-02 15:13:18.080100 | controller | TASK [Executing pre_stage hooks for examples/va/hci/control-plane] *************
2025-10-02 15:13:18.080109 | controller | Thursday 02 October 2025  15:13:18 +0000 (0:00:00.104)       0:00:18.962 ******
2025-10-02 15:13:18.080123 | controller | skipping: [instance]
2025-10-02 15:13:18.080131 | controller |
2025-10-02 15:13:18.080140 | controller | TASK [Generate values.yaml for examples/va/hci/control-plane] ******************
2025-10-02 15:13:18.220338 | controller | Thursday 02 October 2025  15:13:18 +0000 (0:00:00.059)       0:00:19.022 ******
2025-10-02 15:13:18.220388 | controller |
2025-10-02 15:13:18.292831 | controller | TASK [ci_gen_kustomize_values : Generate snippets files] ***********************
2025-10-02 15:13:18.292888 | controller | Thursday 02 October 2025  15:13:18 +0000 (0:00:00.139)       0:00:19.161 ******
2025-10-02 15:13:18.292901 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_snippets.yml for instance
2025-10-02 15:13:18.349422 | controller |
2025-10-02 15:13:18.349445 | controller | TASK [ci_gen_kustomize_values : Ensure needed parameter is properly set] *******
2025-10-02 15:13:18.349453 | controller | Thursday 02 October 2025  15:13:18 +0000 (0:00:00.073)       0:00:19.235 ******
2025-10-02 15:13:18.349469 | controller | ok: [instance] => changed=false
2025-10-02 15:13:18.575720 | controller |   msg: All assertions passed
2025-10-02 15:13:18.575758 | controller |
2025-10-02 15:13:18.575766 | controller | TASK [ci_gen_kustomize_values : Stat original source file] *********************
2025-10-02 15:13:18.575774 | controller | Thursday 02 October 2025  15:13:18 +0000 (0:00:00.056)       0:00:19.291 ******
2025-10-02 15:13:18.575784 | controller | ok: [instance]
2025-10-02 15:13:18.631974 | controller |
2025-10-02 15:13:18.632022 | controller | TASK [ci_gen_kustomize_values : Assert source file exists] *********************
2025-10-02 15:13:18.632031 | controller | Thursday 02 October 2025  15:13:18 +0000 (0:00:00.226)       0:00:19.517 ******
2025-10-02 15:13:18.632044 | controller | ok: [instance] => changed=false
2025-10-02 15:13:18.856050 | controller |   msg: All assertions passed
2025-10-02 15:13:18.856096 | controller |
2025-10-02 15:13:18.856104 | controller | TASK [ci_gen_kustomize_values : Load original values file] *********************
2025-10-02 15:13:18.856112 | controller | Thursday 02 October 2025  15:13:18 +0000 (0:00:00.056)       0:00:19.574 ******
2025-10-02 15:13:18.856124 | controller | ok: [instance]
2025-10-02 15:13:19.068727 | controller |
2025-10-02 15:13:19.068771 | controller | TASK [ci_gen_kustomize_values : Expose common data for future usage] ***********
2025-10-02 15:13:19.068779 | controller | Thursday 02 October 2025  15:13:18 +0000 (0:00:00.222)       0:00:19.796 ******
2025-10-02 15:13:19.068792 | controller | ok: [instance]
2025-10-02 15:13:19.127790 | controller |
2025-10-02 15:13:19.127821 | controller | TASK [ci_gen_kustomize_values : Ensure we get the needed data depending on the values type] ***
2025-10-02 15:13:19.127831 | controller | Thursday 02 October 2025  15:13:19 +0000 (0:00:00.213)       0:00:20.010 ******
2025-10-02 15:13:19.127868 | controller | skipping: [instance]
2025-10-02 15:13:19.128051 | controller |
2025-10-02 15:13:19.128228 | controller | TASK [ci_gen_kustomize_values : Ensure output directory exists] ****************
2025-10-02 15:13:19.128388 | controller | Thursday 02 October 2025  15:13:19 +0000 (0:00:00.059)       0:00:20.070 ******
2025-10-02 15:13:19.376663 | controller | changed: [instance]
2025-10-02 15:13:19.438183 | controller |
2025-10-02 15:13:19.438218 | controller | TASK [ci_gen_kustomize_values : Generate CI snippet] ***************************
2025-10-02 15:13:19.438226 | controller | Thursday 02 October 2025  15:13:19 +0000 (0:00:00.248)       0:00:20.318 ******
2025-10-02 15:13:19.438237 | controller | skipping: [instance]
2025-10-02 15:13:19.506784 | controller |
2025-10-02 15:13:19.506811 | controller | TASK [ci_gen_kustomize_values : Generate the base64 CI ConfigMap patches] ******
2025-10-02 15:13:19.506819 | controller | Thursday 02 October 2025  15:13:19 +0000 (0:00:00.061)       0:00:20.380 ******
2025-10-02 15:13:19.506829 | controller | ok: [instance]
2025-10-02 15:13:19.908108 | controller |
2025-10-02 15:13:19.908145 | controller | TASK [ci_gen_kustomize_values : Push base64 CI patches] ************************
2025-10-02 15:13:19.908154 | controller | Thursday 02 October 2025  15:13:19 +0000 (0:00:00.068)       0:00:20.449 ******
2025-10-02 15:13:19.908164 | controller | changed: [instance]
2025-10-02 15:13:20.309942 | controller |
2025-10-02 15:13:20.309980 | controller | TASK [ci_gen_kustomize_values : Push user provided dataset] ********************
2025-10-02 15:13:20.309988 | controller | Thursday 02 October 2025  15:13:19 +0000 (0:00:00.401)       0:00:20.850 ******
2025-10-02 15:13:20.309999 | controller | changed: [instance]
2025-10-02 15:13:20.310022 | controller |
2025-10-02 15:13:20.310031 | controller | TASK [ci_gen_kustomize_values : Copy the base values.yaml] *********************
2025-10-02 15:13:20.310219 | controller | Thursday 02 October 2025  15:13:20 +0000 (0:00:00.402)       0:00:21.252 ******
2025-10-02 15:13:20.687714 | controller | changed: [instance]
2025-10-02 15:13:20.755953 | controller |
2025-10-02 15:13:20.755989 | controller | TASK [ci_gen_kustomize_values : Generate values file] **************************
2025-10-02 15:13:20.755998 | controller | Thursday 02 October 2025  15:13:20 +0000 (0:00:00.377)       0:00:21.629 ******
2025-10-02 15:13:20.756009 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_values.yml for instance
2025-10-02 15:13:20.756032 | controller |
2025-10-02 15:13:20.756052 | controller | TASK [ci_gen_kustomize_values : Ensure we have needed parameter] ***************
2025-10-02 15:13:20.756180 | controller | Thursday 02 October 2025  15:13:20 +0000 (0:00:00.068)       0:00:21.698 ******
2025-10-02 15:13:20.840444 | controller | ok: [instance] => changed=false
2025-10-02 15:13:21.066418 | controller |   msg: All assertions passed
2025-10-02 15:13:21.066454 | controller |
2025-10-02 15:13:21.066462 | controller | TASK [ci_gen_kustomize_values : List snippets] *********************************
2025-10-02 15:13:21.066475 | controller | Thursday 02 October 2025  15:13:20 +0000 (0:00:00.084)       0:00:21.782 ******
2025-10-02 15:13:21.066486 | controller | ok: [instance]
2025-10-02 15:13:21.143959 | controller |
2025-10-02 15:13:21.144000 | controller | TASK [ci_gen_kustomize_values : Ensure _content is empty] **********************
2025-10-02 15:13:21.144010 | controller | Thursday 02 October 2025  15:13:21 +0000 (0:00:00.226)       0:00:22.008 ******
2025-10-02 15:13:21.144022 | controller | ok: [instance]
2025-10-02 15:13:21.144043 | controller |
2025-10-02 15:13:21.144051 | controller | TASK [ci_gen_kustomize_values : Load various snippet files] ********************
2025-10-02 15:13:21.144059 | controller | Thursday 02 October 2025  15:13:21 +0000 (0:00:00.077)       0:00:22.086 ******
2025-10-02 15:13:21.551417 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/service-values/03_user_data_b64.yaml)
2025-10-02 15:13:21.653694 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/service-values/04_user_data.yaml)
2025-10-02 15:13:21.653733 | controller |
2025-10-02 15:13:21.653741 | controller | TASK [ci_gen_kustomize_values : Combine snippets] ******************************
2025-10-02 15:13:21.653747 | controller | Thursday 02 October 2025  15:13:21 +0000 (0:00:00.407)       0:00:22.493 ******
2025-10-02 15:13:21.653758 | controller | ok: [instance] => (item=03_user_data_b64.yaml)
2025-10-02 15:13:21.891946 | controller | ok: [instance] => (item=04_user_data.yaml)
2025-10-02 15:13:21.891989 | controller |
2025-10-02 15:13:21.891997 | controller | TASK [ci_gen_kustomize_values : Ensure directories exist] **********************
2025-10-02 15:13:21.892004 | controller | Thursday 02 October 2025  15:13:21 +0000 (0:00:00.102)       0:00:22.595 ******
2025-10-02 15:13:21.892015 | controller | changed: [instance]
2025-10-02 15:13:21.892208 | controller |
2025-10-02 15:13:21.892223 | controller | TASK [ci_gen_kustomize_values : Output values file] ****************************
2025-10-02 15:13:22.308171 | controller | Thursday 02 October 2025  15:13:21 +0000 (0:00:00.238)       0:00:22.833 ******
2025-10-02 15:13:22.308218 | controller | changed: [instance]
2025-10-02 15:13:22.386953 | controller |
2025-10-02 15:13:22.387032 | controller | TASK [ci_gen_kustomize_values : Generate snippets files] ***********************
2025-10-02 15:13:22.387051 | controller | Thursday 02 October 2025  15:13:22 +0000 (0:00:00.416)       0:00:23.250 ******
2025-10-02 15:13:22.387065 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_snippets.yml for instance
2025-10-02 15:13:22.444409 | controller |
2025-10-02 15:13:22.444448 | controller | TASK [ci_gen_kustomize_values : Ensure needed parameter is properly set] *******
2025-10-02 15:13:22.444458 | controller | Thursday 02 October 2025  15:13:22 +0000 (0:00:00.078)       0:00:23.328 ******
2025-10-02 15:13:22.444470 | controller | ok: [instance] => changed=false
2025-10-02 15:13:22.677033 | controller |   msg: All assertions passed
2025-10-02 15:13:22.677078 | controller |
2025-10-02 15:13:22.677086 | controller | TASK [ci_gen_kustomize_values : Stat original source file] *********************
2025-10-02 15:13:22.677093 | controller | Thursday 02 October 2025  15:13:22 +0000 (0:00:00.057)       0:00:23.386 ******
2025-10-02 15:13:22.677104 | controller | ok: [instance]
2025-10-02 15:13:22.735969 | controller |
2025-10-02 15:13:22.736014 | controller | TASK [ci_gen_kustomize_values : Assert source file exists] *********************
2025-10-02 15:13:22.736025 | controller | Thursday 02 October 2025  15:13:22 +0000 (0:00:00.232)       0:00:23.619 ******
2025-10-02 15:13:22.736039 | controller | ok: [instance] => changed=false
2025-10-02 15:13:22.736076 | controller |   msg: All assertions passed
2025-10-02 15:13:22.736087 | controller |
2025-10-02 15:13:22.736117 | controller | TASK [ci_gen_kustomize_values : Load original values file] *********************
2025-10-02 15:13:22.736278 | controller | Thursday 02 October 2025  15:13:22 +0000 (0:00:00.059)       0:00:23.678 ******
2025-10-02 15:13:22.990396 | controller | ok: [instance]
2025-10-02 15:13:23.259974 | controller |
2025-10-02 15:13:23.260018 | controller | TASK [ci_gen_kustomize_values : Expose common data for future usage] ***********
2025-10-02 15:13:23.260040 | controller | Thursday 02 October 2025  15:13:22 +0000 (0:00:00.254)       0:00:23.932 ******
2025-10-02 15:13:23.260051 | controller | ok: [instance]
2025-10-02 15:13:23.260082 | controller |
2025-10-02 15:13:23.260109 | controller | TASK [ci_gen_kustomize_values : Ensure we get the needed data depending on the values type] ***
2025-10-02 15:13:23.260339 | controller | Thursday 02 October 2025  15:13:23 +0000 (0:00:00.268)       0:00:24.201 ******
2025-10-02 15:13:23.330100 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/network_values.yml for instance
2025-10-02 15:13:23.330183 | controller |
2025-10-02 15:13:23.330196 | controller | TASK [ci_gen_kustomize_values : Assert we have needed parameters] **************
2025-10-02 15:13:23.330223 | controller | Thursday 02 October 2025  15:13:23 +0000 (0:00:00.070)       0:00:24.272 ******
2025-10-02 15:13:23.387961 | controller | ok: [instance] => changed=false
2025-10-02 15:13:23.617029 | controller |   msg: All assertions passed
2025-10-02 15:13:23.617080 | controller |
2025-10-02 15:13:23.617089 | controller | TASK [ci_gen_kustomize_values : Ensure output directory exists] ****************
2025-10-02 15:13:23.617095 | controller | Thursday 02 October 2025  15:13:23 +0000 (0:00:00.057)       0:00:24.329 ******
2025-10-02 15:13:23.617108 | controller | ok: [instance]
2025-10-02 15:13:24.146937 | controller |
2025-10-02 15:13:24.146994 | controller | TASK [ci_gen_kustomize_values : Generate CI snippet] ***************************
2025-10-02 15:13:24.147003 | controller | Thursday 02 October 2025  15:13:23 +0000 (0:00:00.229)       0:00:24.558 ******
2025-10-02 15:13:24.147015 | controller | ok: [instance]
2025-10-02 15:13:24.214410 | controller |
2025-10-02 15:13:24.214450 | controller | TASK [ci_gen_kustomize_values : Generate the base64 CI ConfigMap patches] ******
2025-10-02 15:13:24.214458 | controller | Thursday 02 October 2025  15:13:24 +0000 (0:00:00.530)       0:00:25.089 ******
2025-10-02 15:13:24.214485 | controller | ok: [instance]
2025-10-02 15:13:24.616906 | controller |
2025-10-02 15:13:24.616960 | controller | TASK [ci_gen_kustomize_values : Push base64 CI patches] ************************
2025-10-02 15:13:24.616969 | controller | Thursday 02 October 2025  15:13:24 +0000 (0:00:00.067)       0:00:25.156 ******
2025-10-02 15:13:24.616982 | controller | ok: [instance]
2025-10-02 15:13:25.014886 | controller |
2025-10-02 15:13:25.014932 | controller | TASK [ci_gen_kustomize_values : Push user provided dataset] ********************
2025-10-02 15:13:25.014940 | controller | Thursday 02 October 2025  15:13:24 +0000 (0:00:00.402)       0:00:25.558 ******
2025-10-02 15:13:25.014952 | controller | ok: [instance]
2025-10-02 15:13:25.423998 | controller |
2025-10-02 15:13:25.424055 | controller | TASK [ci_gen_kustomize_values : Copy the base values.yaml] *********************
2025-10-02 15:13:25.424064 | controller | Thursday 02 October 2025  15:13:25 +0000 (0:00:00.397)       0:00:25.956 ******
2025-10-02 15:13:25.424076 | controller | ok: [instance]
2025-10-02 15:13:25.489470 | controller |
2025-10-02 15:13:25.489510 | controller | TASK [ci_gen_kustomize_values : Generate values file] **************************
2025-10-02 15:13:25.489519 | controller | Thursday 02 October 2025  15:13:25 +0000 (0:00:00.409)       0:00:26.366 ******
2025-10-02 15:13:25.489532 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_values.yml for instance
2025-10-02 15:13:25.539691 | controller |
2025-10-02 15:13:25.539721 | controller | TASK [ci_gen_kustomize_values : Ensure we have needed parameter] ***************
2025-10-02 15:13:25.539729 | controller | Thursday 02 October 2025  15:13:25 +0000 (0:00:00.065)       0:00:26.431 ******
2025-10-02 15:13:25.539740 | controller | ok: [instance] => changed=false
2025-10-02 15:13:25.769452 | controller |   msg: All assertions passed
2025-10-02 15:13:25.769493 | controller |
2025-10-02 15:13:25.769501 | controller | TASK [ci_gen_kustomize_values : List snippets] *********************************
2025-10-02 15:13:25.769507 | controller | Thursday 02 October 2025  15:13:25 +0000 (0:00:00.050)       0:00:26.482 ******
2025-10-02 15:13:25.769518 | controller | ok: [instance]
2025-10-02 15:13:25.819377 | controller |
2025-10-02 15:13:25.819425 | controller | TASK [ci_gen_kustomize_values : Ensure _content is empty] **********************
2025-10-02 15:13:25.819434 | controller | Thursday 02 October 2025  15:13:25 +0000 (0:00:00.229)       0:00:26.711 ******
2025-10-02 15:13:25.819454 | controller | ok: [instance]
2025-10-02 15:13:26.430364 | controller |
2025-10-02 15:13:26.430398 | controller | TASK [ci_gen_kustomize_values : Load various snippet files] ********************
2025-10-02 15:13:26.430406 | controller | Thursday 02 October 2025  15:13:25 +0000 (0:00:00.049)       0:00:26.761 ******
2025-10-02 15:13:26.430417 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/network-values/02_ci_data.yaml)
2025-10-02 15:13:26.570496 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/network-values/03_user_data_b64.yaml)
2025-10-02 15:13:26.570527 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/network-values/04_user_data.yaml)
2025-10-02 15:13:26.570535 | controller |
2025-10-02 15:13:26.570541 | controller | TASK [ci_gen_kustomize_values : Combine snippets] ******************************
2025-10-02 15:13:26.570547 | controller | Thursday 02 October 2025  15:13:26 +0000 (0:00:00.610)       0:00:27.372 ******
2025-10-02 15:13:26.570557 | controller | ok: [instance] => (item=02_ci_data.yaml)
2025-10-02 15:13:26.820668 | controller | ok: [instance] => (item=03_user_data_b64.yaml)
2025-10-02 15:13:26.820722 | controller | ok: [instance] => (item=04_user_data.yaml)
2025-10-02 15:13:26.820730 | controller |
2025-10-02 15:13:26.820737 | controller | TASK [ci_gen_kustomize_values : Ensure directories exist] **********************
2025-10-02 15:13:26.820743 | controller | Thursday 02 October 2025  15:13:26 +0000 (0:00:00.140)       0:00:27.512 ******
2025-10-02 15:13:26.820757 | controller | ok: [instance]
2025-10-02 15:13:27.272687 | controller |
2025-10-02 15:13:27.272725 | controller | TASK [ci_gen_kustomize_values : Output values file] ****************************
2025-10-02 15:13:27.272733 | controller | Thursday 02 October 2025  15:13:26 +0000 (0:00:00.250)       0:00:27.762 ******
2025-10-02 15:13:27.272744 | controller | ok: [instance]
2025-10-02 15:13:27.767259 | controller |
2025-10-02 15:13:27.767302 | controller | TASK [kustomize_deploy : Copy generated values for examples/va/hci/control-plane] ***
2025-10-02 15:13:27.767310 | controller | Thursday 02 October 2025  15:13:27 +0000 (0:00:00.452)       0:00:28.214 ******
2025-10-02 15:13:27.767322 | controller | changed: [instance] => (item=service-values)
2025-10-02 15:13:27.823379 | controller | ok: [instance] => (item=network-values)
2025-10-02 15:13:27.823423 | controller |
2025-10-02 15:13:27.823432 | controller | TASK [kustomize_deploy : Stop before building kustomization if requested] ******
2025-10-02 15:13:27.823438 | controller | Thursday 02 October 2025  15:13:27 +0000 (0:00:00.494)       0:00:28.709 ******
2025-10-02 15:13:27.823451 | controller | skipping: [instance]
2025-10-02 15:13:28.197983 | controller |
2025-10-02 15:13:28.198025 | controller | TASK [kustomize_deploy : Build kustomized content for examples/va/hci/control-plane] ***
2025-10-02 15:13:28.198034 | controller | Thursday 02 October 2025  15:13:27 +0000 (0:00:00.056)       0:00:28.765 ******
2025-10-02 15:13:28.198047 | controller | changed: [instance]
2025-10-02 15:13:28.597961 | controller |
2025-10-02 15:13:28.598003 | controller | TASK [kustomize_deploy : Output kustomize build in final file] *****************
2025-10-02 15:13:28.598012 | controller | Thursday 02 October 2025  15:13:28 +0000 (0:00:00.374)       0:00:29.140 ******
2025-10-02 15:13:28.598034 | controller | changed: [instance]
2025-10-02 15:13:28.598061 | controller |
2025-10-02 15:13:28.598272 | controller | TASK [kustomize_deploy : Store kustomized content in artifacts for examples/va/hci/control-plane] ***
2025-10-02 15:13:28.851175 | controller | Thursday 02 October 2025  15:13:28 +0000 (0:00:00.400)       0:00:29.540 ******
2025-10-02 15:13:28.851218 | controller | changed: [instance]
2025-10-02 15:13:28.906945 | controller |
2025-10-02 15:13:28.907055 | controller | TASK [kustomize_deploy : Stop after building kustomization if requested] *******
2025-10-02 15:13:28.907066 | controller | Thursday 02 October 2025  15:13:28 +0000 (0:00:00.252)       0:00:29.793 ******
2025-10-02 15:13:28.907081 | controller | skipping: [instance]
2025-10-02 15:13:28.961622 | controller |
2025-10-02 15:13:28.961679 | controller | TASK [kustomize_deploy : Apply generated content for examples/va/hci/control-plane] ***
2025-10-02 15:13:28.961687 | controller | Thursday 02 October 2025  15:13:28 +0000 (0:00:00.055)       0:00:29.848 ******
2025-10-02 15:13:28.961699 | controller | skipping: [instance]
2025-10-02 15:13:29.017447 | controller |
2025-10-02 15:13:29.017487 | controller | TASK [kustomize_deploy : Run Wait Conditions for examples/va/hci/control-plane] ***
2025-10-02 15:13:29.017507 | controller | Thursday 02 October 2025  15:13:28 +0000 (0:00:00.054)       0:00:29.903 ******
2025-10-02 15:13:29.017518 | controller | skipping: [instance] => (item=oc -n openstack wait osctlplane controlplane --for condition=Ready --timeout=60m)
2025-10-02 15:13:29.071791 | controller | skipping: [instance]
2025-10-02 15:13:29.071831 | controller |
2025-10-02 15:13:29.071862 | controller | TASK [kustomize_deploy : Stop after applying CRs if requested] *****************
2025-10-02 15:13:29.071869 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.055)       0:00:29.959 ******
2025-10-02 15:13:29.071880 | controller | skipping: [instance]
2025-10-02 15:13:29.128958 | controller |
2025-10-02 15:13:29.128997 | controller | TASK [Executing post_stage hooks for examples/va/hci/control-plane] ************
2025-10-02 15:13:29.129005 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.054)       0:00:30.013 ******
2025-10-02 15:13:29.129016 | controller | skipping: [instance]
2025-10-02 15:13:29.129099 | controller |
2025-10-02 15:13:29.129136 | controller | TASK [kustomize_deploy : Assert mandatory bits are defined] ********************
2025-10-02 15:13:29.129150 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.057)       0:00:30.071 ******
2025-10-02 15:13:29.180503 | controller | ok: [instance] => changed=false
2025-10-02 15:13:29.220378 | controller |   msg: All assertions passed
2025-10-02 15:13:29.220417 | controller |
2025-10-02 15:13:29.220425 | controller | TASK [kustomize_deploy : Check custom wait conditions] *************************
2025-10-02 15:13:29.220432 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.051)       0:00:30.122 ******
2025-10-02 15:13:29.220442 | controller | skipping: [instance]
2025-10-02 15:13:29.258448 | controller |
2025-10-02 15:13:29.258488 | controller | TASK [kustomize_deploy : Check builtin wait conditions] ************************
2025-10-02 15:13:29.258497 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.039)       0:00:30.162 ******
2025-10-02 15:13:29.258508 | controller | ok: [instance] => (item=oc -n openstack wait osdpns openstack-edpm --for condition=SetupReady --timeout=10m)
2025-10-02 15:13:29.285978 | controller |
2025-10-02 15:13:29.286025 | controller | TASK [kustomize_deploy : Check wait_conditions validation result] **************
2025-10-02 15:13:29.286034 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.038)       0:00:30.200 ******
2025-10-02 15:13:29.286046 | controller | skipping: [instance]
2025-10-02 15:13:29.329596 | controller |
2025-10-02 15:13:29.329638 | controller | TASK [kustomize_deploy : Set stage_wait_conditions fact] ***********************
2025-10-02 15:13:29.329658 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.027)       0:00:30.228 ******
2025-10-02 15:13:29.329670 | controller | ok: [instance]
2025-10-02 15:13:29.579265 | controller |
2025-10-02 15:13:29.579307 | controller | TASK [kustomize_deploy : Ensure source files exists] ***************************
2025-10-02 15:13:29.579316 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.043)       0:00:30.271 ******
2025-10-02 15:13:29.579327 | controller | ok: [instance] => (item={'name': 'edpm-nodeset-values', 'src_file': 'values.yaml'})
2025-10-02 15:13:29.658538 | controller |
2025-10-02 15:13:29.658578 | controller | TASK [kustomize_deploy : Assert source files exist] ****************************
2025-10-02 15:13:29.658586 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.249)       0:00:30.521 ******
2025-10-02 15:13:29.658598 | controller | ok: [instance] => (item=values.yaml)
2025-10-02 15:13:29.725395 | controller |
2025-10-02 15:13:29.725440 | controller | TASK [Executing pre_stage hooks for examples/va/hci/edpm-pre-ceph/nodeset] *****
2025-10-02 15:13:29.725448 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.079)       0:00:30.600 ******
2025-10-02 15:13:29.725460 | controller | skipping: [instance]
2025-10-02 15:13:29.829227 | controller |
2025-10-02 15:13:29.829274 | controller | TASK [Generate values.yaml for examples/va/hci/edpm-pre-ceph/nodeset] **********
2025-10-02 15:13:29.829283 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.066)       0:00:30.667 ******
2025-10-02 15:13:29.829295 | controller |
2025-10-02 15:13:29.910497 | controller | TASK [ci_gen_kustomize_values : Generate snippets files] ***********************
2025-10-02 15:13:29.910564 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.103)       0:00:30.771 ******
2025-10-02 15:13:29.910580 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_snippets.yml for instance
2025-10-02 15:13:29.980611 | controller |
2025-10-02 15:13:29.980666 | controller | TASK [ci_gen_kustomize_values : Ensure needed parameter is properly set] *******
2025-10-02 15:13:29.980676 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.081)       0:00:30.852 ******
2025-10-02 15:13:29.980691 | controller | ok: [instance] => changed=false
2025-10-02 15:13:30.214149 | controller |   msg: All assertions passed
2025-10-02 15:13:30.214184 | controller |
2025-10-02 15:13:30.214192 | controller | TASK [ci_gen_kustomize_values : Stat original source file] *********************
2025-10-02 15:13:30.214198 | controller | Thursday 02 October 2025  15:13:29 +0000 (0:00:00.070)       0:00:30.922 ******
2025-10-02 15:13:30.214209 | controller | ok: [instance]
2025-10-02 15:13:30.270461 | controller |
2025-10-02 15:13:30.270482 | controller | TASK [ci_gen_kustomize_values : Assert source file exists] *********************
2025-10-02 15:13:30.270489 | controller | Thursday 02 October 2025  15:13:30 +0000 (0:00:00.233)       0:00:31.156 ******
2025-10-02 15:13:30.270498 | controller | ok: [instance] => changed=false
2025-10-02 15:13:30.485183 | controller |   msg: All assertions passed
2025-10-02 15:13:30.485223 | controller |
2025-10-02 15:13:30.485232 | controller | TASK [ci_gen_kustomize_values : Load original values file] *********************
2025-10-02 15:13:30.485239 | controller | Thursday 02 October 2025  15:13:30 +0000 (0:00:00.056)       0:00:31.212 ******
2025-10-02 15:13:30.485250 | controller | ok: [instance]
2025-10-02 15:13:30.765533 | controller |
2025-10-02 15:13:30.765574 | controller | TASK [ci_gen_kustomize_values : Expose common data for future usage] ***********
2025-10-02 15:13:30.765582 | controller | Thursday 02 October 2025  15:13:30 +0000 (0:00:00.214)       0:00:31.427 ******
2025-10-02 15:13:30.765594 | controller | ok: [instance]
2025-10-02 15:13:30.842007 | controller |
2025-10-02 15:13:30.842050 | controller | TASK [ci_gen_kustomize_values : Ensure we get the needed data depending on the values type] ***
2025-10-02 15:13:30.842060 | controller | Thursday 02 October 2025  15:13:30 +0000 (0:00:00.280)       0:00:31.707 ******
2025-10-02 15:13:30.842073 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/edpm_nodeset_values.yml for instance
2025-10-02 15:13:30.917933 | controller |
2025-10-02 15:13:30.917973 | controller | TASK [ci_gen_kustomize_values : Check if all required variables for accessing the node is provided.] ***
2025-10-02 15:13:30.917983 | controller | Thursday 02 October 2025  15:13:30 +0000 (0:00:00.076)       0:00:31.784 ******
2025-10-02 15:13:30.917997 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/edpm_core_asserts.yml for instance
2025-10-02 15:13:30.965924 | controller |
2025-10-02 15:13:30.965964 | controller | TASK [ci_gen_kustomize_values : Ensure the required parameters are defined and configured.] ***
2025-10-02 15:13:30.965973 | controller | Thursday 02 October 2025  15:13:30 +0000 (0:00:00.076)       0:00:31.860 ******
2025-10-02 15:13:30.965989 | controller | ok: [instance] => changed=false
2025-10-02 15:13:31.019997 | controller |   msg: All assertions passed
2025-10-02 15:13:31.020044 | controller |
2025-10-02 15:13:31.020055 | controller | TASK [ci_gen_kustomize_values : Get common data for dataplane templating] ******
2025-10-02 15:13:31.020063 | controller | Thursday 02 October 2025  15:13:30 +0000 (0:00:00.047)       0:00:31.908 ******
2025-10-02 15:13:31.020076 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/edpm_core_facts.yml for instance
2025-10-02 15:13:31.020107 | controller |
2025-10-02 15:13:31.020116 | controller | TASK [ci_gen_kustomize_values : Fetch the already deployed services for further usage] ***
2025-10-02 15:13:31.062495 | controller | Thursday 02 October 2025  15:13:31 +0000 (0:00:00.054)       0:00:31.962 ******
2025-10-02 15:13:31.062538 | controller | skipping: [instance]
2025-10-02 15:13:31.105941 | controller |
2025-10-02 15:13:31.105964 | controller | TASK [ci_gen_kustomize_values : Expose the deployed services as a fact] ********
2025-10-02 15:13:31.105973 | controller | Thursday 02 October 2025  15:13:31 +0000 (0:00:00.042)       0:00:32.004 ******
2025-10-02 15:13:31.105983 | controller | ok: [instance]
2025-10-02 15:13:31.106011 | controller |
2025-10-02 15:13:31.106205 | controller | TASK [ci_gen_kustomize_values : Check if required variables for nova migration are provided.] ***
2025-10-02 15:13:31.151919 | controller | Thursday 02 October 2025  15:13:31 +0000 (0:00:00.043)       0:00:32.048 ******
2025-10-02 15:13:31.151949 | controller | ok: [instance] => changed=false
2025-10-02 15:13:31.151978 | controller |   msg: All assertions passed
2025-10-02 15:13:31.151988 | controller |
2025-10-02 15:13:31.152180 | controller | TASK [ci_gen_kustomize_values : Ensure output directory exists] ****************
2025-10-02 15:13:31.368958 | controller | Thursday 02 October 2025  15:13:31 +0000 (0:00:00.045)       0:00:32.094 ******
2025-10-02 15:13:31.368999 | controller | changed: [instance]
2025-10-02 15:13:31.788387 | controller |
2025-10-02 15:13:31.788420 | controller | TASK [ci_gen_kustomize_values : Generate CI snippet] ***************************
2025-10-02 15:13:31.788429 | controller | Thursday 02 October 2025  15:13:31 +0000 (0:00:00.216)       0:00:32.311 ******
2025-10-02 15:13:31.788445 | controller | changed: [instance]
2025-10-02 15:13:31.788464 | controller |
2025-10-02 15:13:31.788698 | controller | TASK [ci_gen_kustomize_values : Generate the base64 CI ConfigMap patches] ******
2025-10-02 15:13:31.842766 | controller | Thursday 02 October 2025  15:13:31 +0000 (0:00:00.419)       0:00:32.730 ******
2025-10-02 15:13:31.842791 | controller | ok: [instance]
2025-10-02 15:13:32.204506 | controller |
2025-10-02 15:13:32.204549 | controller | TASK [ci_gen_kustomize_values : Push base64 CI patches] ************************
2025-10-02 15:13:32.204559 | controller | Thursday 02 October 2025  15:13:31 +0000 (0:00:00.054)       0:00:32.785 ******
2025-10-02 15:13:32.204571 | controller | changed: [instance]
2025-10-02 15:13:32.604494 | controller |
2025-10-02 15:13:32.604544 | controller | TASK [ci_gen_kustomize_values : Push user provided dataset] ********************
2025-10-02 15:13:32.604552 | controller | Thursday 02 October 2025  15:13:32 +0000 (0:00:00.361)       0:00:33.146 ******
2025-10-02 15:13:32.604578 | controller | changed: [instance]
2025-10-02 15:13:32.984784 | controller |
2025-10-02 15:13:32.984822 | controller | TASK [ci_gen_kustomize_values : Copy the base values.yaml] *********************
2025-10-02 15:13:32.984830 | controller | Thursday 02 October 2025  15:13:32 +0000 (0:00:00.399)       0:00:33.546 ******
2025-10-02 15:13:32.984856 | controller | changed: [instance]
2025-10-02 15:13:33.041023 | controller |
2025-10-02 15:13:33.041068 | controller | TASK [ci_gen_kustomize_values : Generate values file] **************************
2025-10-02 15:13:33.041078 | controller | Thursday 02 October 2025  15:13:32 +0000 (0:00:00.380)       0:00:33.926 ******
2025-10-02 15:13:33.041091 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_values.yml for instance
2025-10-02 15:13:33.082949 | controller |
2025-10-02 15:13:33.082994 | controller | TASK [ci_gen_kustomize_values : Ensure we have needed parameter] ***************
2025-10-02 15:13:33.083005 | controller | Thursday 02 October 2025  15:13:33 +0000 (0:00:00.056)       0:00:33.983 ******
2025-10-02 15:13:33.083018 | controller | ok: [instance] => changed=false
2025-10-02 15:13:33.300695 | controller |   msg: All assertions passed
2025-10-02 15:13:33.300730 | controller |
2025-10-02 15:13:33.300738 | controller | TASK [ci_gen_kustomize_values : List snippets] *********************************
2025-10-02 15:13:33.300745 | controller | Thursday 02 October 2025  15:13:33 +0000 (0:00:00.041)       0:00:34.025 ******
2025-10-02 15:13:33.300755 | controller | ok: [instance]
2025-10-02 15:13:33.339404 | controller |
2025-10-02 15:13:33.339426 | controller | TASK [ci_gen_kustomize_values : Ensure _content is empty] **********************
2025-10-02 15:13:33.339433 | controller | Thursday 02 October 2025  15:13:33 +0000 (0:00:00.217)       0:00:34.243 ******
2025-10-02 15:13:33.339442 | controller | ok: [instance]
2025-10-02 15:13:33.931868 | controller |
2025-10-02 15:13:33.931903 | controller | TASK [ci_gen_kustomize_values : Load various snippet files] ********************
2025-10-02 15:13:33.931912 | controller | Thursday 02 October 2025  15:13:33 +0000 (0:00:00.038)       0:00:34.282 ******
2025-10-02 15:13:33.931923 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values/02_ci_data.yaml)
2025-10-02 15:13:34.051627 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values/03_user_data_b64.yaml)
2025-10-02 15:13:34.051686 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values/04_user_data.yaml)
2025-10-02 15:13:34.051702 | controller |
2025-10-02 15:13:34.051709 | controller | TASK [ci_gen_kustomize_values : Combine snippets] ******************************
2025-10-02 15:13:34.051715 | controller | Thursday 02 October 2025  15:13:33 +0000 (0:00:00.591)       0:00:34.873 ******
2025-10-02 15:13:34.051726 | controller | ok: [instance] => (item=02_ci_data.yaml)
2025-10-02 15:13:34.287983 | controller | ok: [instance] => (item=03_user_data_b64.yaml)
2025-10-02 15:13:34.288024 | controller | ok: [instance] => (item=04_user_data.yaml)
2025-10-02 15:13:34.288032 | controller |
2025-10-02 15:13:34.288039 | controller | TASK [ci_gen_kustomize_values : Ensure directories exist] **********************
2025-10-02 15:13:34.288046 | controller | Thursday 02 October 2025  15:13:34 +0000 (0:00:00.119)       0:00:34.993 ******
2025-10-02 15:13:34.288057 | controller | changed: [instance]
2025-10-02 15:13:34.288084 | controller |
2025-10-02 15:13:34.288263 | controller | TASK [ci_gen_kustomize_values : Output values file] ****************************
2025-10-02 15:13:34.288310 | controller | Thursday 02 October 2025  15:13:34 +0000 (0:00:00.236)       0:00:35.230 ******
2025-10-02 15:13:34.691037 | controller | changed: [instance]
2025-10-02 15:13:34.951551 | controller |
2025-10-02 15:13:34.951588 | controller | TASK [kustomize_deploy : Copy generated values for examples/va/hci/edpm-pre-ceph/nodeset] ***
2025-10-02 15:13:34.951597 | controller | Thursday 02 October 2025  15:13:34 +0000 (0:00:00.403)       0:00:35.633 ******
2025-10-02 15:13:34.951608 | controller | changed: [instance] => (item=edpm-nodeset-values)
2025-10-02 15:13:34.994902 | controller |
2025-10-02 15:13:34.994930 | controller | TASK [kustomize_deploy : Stop before building kustomization if requested] ******
2025-10-02 15:13:34.994937 | controller | Thursday 02 October 2025  15:13:34 +0000 (0:00:00.259)       0:00:35.892 ******
2025-10-02 15:13:34.994947 | controller | skipping: [instance]
2025-10-02 15:13:34.995191 | controller |
2025-10-02 15:13:34.995206 | controller | TASK [kustomize_deploy : Build kustomized content for examples/va/hci/edpm-pre-ceph/nodeset] ***
2025-10-02 15:13:35.333817 | controller | Thursday 02 October 2025  15:13:34 +0000 (0:00:00.044)       0:00:35.937 ******
2025-10-02 15:13:35.333882 | controller | changed: [instance]
2025-10-02 15:13:35.736510 | controller |
2025-10-02 15:13:35.736557 | controller | TASK [kustomize_deploy : Output kustomize build in final file] *****************
2025-10-02 15:13:35.736566 | controller | Thursday 02 October 2025  15:13:35 +0000 (0:00:00.338)       0:00:36.275 ******
2025-10-02 15:13:35.736578 | controller | changed: [instance]
2025-10-02 15:13:35.995621 | controller |
2025-10-02 15:13:35.995683 | controller | TASK [kustomize_deploy : Store kustomized content in artifacts for examples/va/hci/edpm-pre-ceph/nodeset] ***
2025-10-02 15:13:35.995692 | controller | Thursday 02 October 2025  15:13:35 +0000 (0:00:00.402)       0:00:36.678 ******
2025-10-02 15:13:35.995706 | controller | changed: [instance]
2025-10-02 15:13:36.043796 | controller |
2025-10-02 15:13:36.043831 | controller | TASK [kustomize_deploy : Stop after building kustomization if requested] *******
2025-10-02 15:13:36.043868 | controller | Thursday 02 October 2025  15:13:35 +0000 (0:00:00.259)       0:00:36.937 ******
2025-10-02 15:13:36.043882 | controller | skipping: [instance]
2025-10-02 15:13:36.093540 | controller |
2025-10-02 15:13:36.093575 | controller | TASK [kustomize_deploy : Apply generated content for examples/va/hci/edpm-pre-ceph/nodeset] ***
2025-10-02 15:13:36.093584 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.048)       0:00:36.985 ******
2025-10-02 15:13:36.093595 | controller | skipping: [instance]
2025-10-02 15:13:36.134956 | controller |
2025-10-02 15:13:36.135001 | controller | TASK [kustomize_deploy : Run Wait Conditions for examples/va/hci/edpm-pre-ceph/nodeset] ***
2025-10-02 15:13:36.135011 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.048)       0:00:37.034 ******
2025-10-02 15:13:36.135031 | controller | skipping: [instance] => (item=oc -n openstack wait osdpns openstack-edpm --for condition=SetupReady --timeout=10m)
2025-10-02 15:13:36.135070 | controller | skipping: [instance]
2025-10-02 15:13:36.135329 | controller |
2025-10-02 15:13:36.135360 | controller | TASK [kustomize_deploy : Stop after applying CRs if requested] *****************
2025-10-02 15:13:36.174573 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.042)       0:00:37.077 ******
2025-10-02 15:13:36.174603 | controller | skipping: [instance]
2025-10-02 15:13:36.224493 | controller |
2025-10-02 15:13:36.224525 | controller | TASK [Executing post_stage hooks for examples/va/hci/edpm-pre-ceph/nodeset] ****
2025-10-02 15:13:36.224535 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.039)       0:00:37.117 ******
2025-10-02 15:13:36.224548 | controller | skipping: [instance]
2025-10-02 15:13:36.272712 | controller |
2025-10-02 15:13:36.272743 | controller | TASK [kustomize_deploy : Assert mandatory bits are defined] ********************
2025-10-02 15:13:36.272752 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.049)       0:00:37.166 ******
2025-10-02 15:13:36.272763 | controller | ok: [instance] => changed=false
2025-10-02 15:13:36.305009 | controller |   msg: All assertions passed
2025-10-02 15:13:36.305058 | controller |
2025-10-02 15:13:36.305068 | controller | TASK [kustomize_deploy : Check custom wait conditions] *************************
2025-10-02 15:13:36.305077 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.048)       0:00:37.214 ******
2025-10-02 15:13:36.305090 | controller | skipping: [instance]
2025-10-02 15:13:36.342385 | controller |
2025-10-02 15:13:36.342426 | controller | TASK [kustomize_deploy : Check builtin wait conditions] ************************
2025-10-02 15:13:36.342435 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.032)       0:00:37.247 ******
2025-10-02 15:13:36.342447 | controller | ok: [instance] => (item=oc -n openstack wait osdpns openstack-edpm --for condition=Ready --timeout=30m)
2025-10-02 15:13:36.372441 | controller |
2025-10-02 15:13:36.372472 | controller | TASK [kustomize_deploy : Check wait_conditions validation result] **************
2025-10-02 15:13:36.372480 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.037)       0:00:37.284 ******
2025-10-02 15:13:36.372492 | controller | skipping: [instance]
2025-10-02 15:13:36.410023 | controller |
2025-10-02 15:13:36.410073 | controller | TASK [kustomize_deploy : Set stage_wait_conditions fact] ***********************
2025-10-02 15:13:36.410083 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.030)       0:00:37.314 ******
2025-10-02 15:13:36.410096 | controller | ok: [instance]
2025-10-02 15:13:36.410125 | controller |
2025-10-02 15:13:36.410144 | controller | TASK [kustomize_deploy : Ensure source files exists] ***************************
2025-10-02 15:13:36.410165 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.037)       0:00:37.352 ******
2025-10-02 15:13:36.639771 | controller | ok: [instance] => (item={'name': 'edpm-deployment-values', 'src_file': 'values.yaml'})
2025-10-02 15:13:36.701363 | controller |
2025-10-02 15:13:36.701401 | controller | TASK [kustomize_deploy : Assert source files exist] ****************************
2025-10-02 15:13:36.701411 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.229)       0:00:37.581 ******
2025-10-02 15:13:36.701424 | controller | ok: [instance] => (item=values.yaml)
2025-10-02 15:13:36.741890 | controller |
2025-10-02 15:13:36.741913 | controller | TASK [Executing pre_stage hooks for examples/va/hci/edpm-pre-ceph/deployment] ***
2025-10-02 15:13:36.741920 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.061)       0:00:37.643 ******
2025-10-02 15:13:36.741930 | controller | skipping: [instance]
2025-10-02 15:13:36.742337 | controller |
2025-10-02 15:13:36.818599 | controller | TASK [Generate values.yaml for examples/va/hci/edpm-pre-ceph/deployment] *******
2025-10-02 15:13:36.818629 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.041)       0:00:37.684 ******
2025-10-02 15:13:36.818648 | controller |
2025-10-02 15:13:36.876900 | controller | TASK [ci_gen_kustomize_values : Generate snippets files] ***********************
2025-10-02 15:13:36.876926 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.076)       0:00:37.761 ******
2025-10-02 15:13:36.876939 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_snippets.yml for instance
2025-10-02 15:13:36.877303 | controller |
2025-10-02 15:13:36.925912 | controller | TASK [ci_gen_kustomize_values : Ensure needed parameter is properly set] *******
2025-10-02 15:13:36.925935 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.058)       0:00:37.819 ******
2025-10-02 15:13:36.925945 | controller | ok: [instance] => changed=false
2025-10-02 15:13:36.926230 | controller |   msg: All assertions passed
2025-10-02 15:13:36.926248 | controller |
2025-10-02 15:13:37.148918 | controller | TASK [ci_gen_kustomize_values : Stat original source file] *********************
2025-10-02 15:13:37.148963 | controller | Thursday 02 October 2025  15:13:36 +0000 (0:00:00.048)       0:00:37.868 ******
2025-10-02 15:13:37.148976 | controller | ok: [instance]
2025-10-02 15:13:37.149000 | controller |
2025-10-02 15:13:37.149008 | controller | TASK [ci_gen_kustomize_values : Assert source file exists] *********************
2025-10-02 15:13:37.149028 | controller | Thursday 02 October 2025  15:13:37 +0000 (0:00:00.222)       0:00:38.091 ******
2025-10-02 15:13:37.197794 | controller | ok: [instance] => changed=false
2025-10-02 15:13:37.407493 | controller |   msg: All assertions passed
2025-10-02 15:13:37.407533 | controller |
2025-10-02 15:13:37.407542 | controller | TASK [ci_gen_kustomize_values : Load original values file] *********************
2025-10-02 15:13:37.407549 | controller | Thursday 02 October 2025  15:13:37 +0000 (0:00:00.048)       0:00:38.140 ******
2025-10-02 15:13:37.407560 | controller | ok: [instance]
2025-10-02 15:13:37.622308 | controller |
2025-10-02 15:13:37.622370 | controller | TASK [ci_gen_kustomize_values : Expose common data for future usage] ***********
2025-10-02 15:13:37.622380 | controller | Thursday 02 October 2025  15:13:37 +0000 (0:00:00.209)       0:00:38.349 ******
2025-10-02 15:13:37.622395 | controller | ok: [instance]
2025-10-02 15:13:37.666455 | controller |
2025-10-02 15:13:37.666485 | controller | TASK [ci_gen_kustomize_values : Ensure we get the needed data depending on the values type] ***
2025-10-02 15:13:37.666497 | controller | Thursday 02 October 2025  15:13:37 +0000 (0:00:00.214)       0:00:38.564 ******
2025-10-02 15:13:37.666509 | controller | skipping: [instance]
2025-10-02 15:13:37.885197 | controller |
2025-10-02 15:13:37.885236 | controller | TASK [ci_gen_kustomize_values : Ensure output directory exists] ****************
2025-10-02 15:13:37.885244 | controller | Thursday 02 October 2025  15:13:37 +0000 (0:00:00.044)       0:00:38.608 ******
2025-10-02 15:13:37.885256 | controller | changed: [instance]
2025-10-02 15:13:37.937757 | controller |
2025-10-02 15:13:37.937793 | controller | TASK [ci_gen_kustomize_values : Generate CI snippet] ***************************
2025-10-02 15:13:37.937801 | controller | Thursday 02 October 2025  15:13:37 +0000 (0:00:00.218)       0:00:38.827 ******
2025-10-02 15:13:37.937812 | controller | skipping: [instance]
2025-10-02 15:13:37.992937 | controller |
2025-10-02 15:13:37.992970 | controller | TASK [ci_gen_kustomize_values : Generate the base64 CI ConfigMap patches] ******
2025-10-02 15:13:37.992978 | controller | Thursday 02 October 2025  15:13:37 +0000 (0:00:00.052)       0:00:38.880 ******
2025-10-02 15:13:37.992989 | controller | ok: [instance]
2025-10-02 15:13:38.341949 | controller |
2025-10-02 15:13:38.341983 | controller | TASK [ci_gen_kustomize_values : Push base64 CI patches] ************************
2025-10-02 15:13:38.341991 | controller | Thursday 02 October 2025  15:13:37 +0000 (0:00:00.055)       0:00:38.935 ******
2025-10-02 15:13:38.342009 | controller | changed: [instance]
2025-10-02 15:13:38.698744 | controller |
2025-10-02 15:13:38.698785 | controller | TASK [ci_gen_kustomize_values : Push user provided dataset] ********************
2025-10-02 15:13:38.698793 | controller | Thursday 02 October 2025  15:13:38 +0000 (0:00:00.348)       0:00:39.284 ******
2025-10-02 15:13:38.698805 | controller | changed: [instance]
2025-10-02 15:13:39.069793 | controller |
2025-10-02 15:13:39.069852 | controller | TASK [ci_gen_kustomize_values : Copy the base values.yaml] *********************
2025-10-02 15:13:39.069864 | controller | Thursday 02 October 2025  15:13:38 +0000 (0:00:00.356)       0:00:39.640 ******
2025-10-02 15:13:39.069876 | controller | changed: [instance]
2025-10-02 15:13:39.128635 | controller |
2025-10-02 15:13:39.128664 | controller | TASK [ci_gen_kustomize_values : Generate values file] **************************
2025-10-02 15:13:39.128690 | controller | Thursday 02 October 2025  15:13:39 +0000 (0:00:00.371)       0:00:40.011 ******
2025-10-02 15:13:39.128701 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_values.yml for instance
2025-10-02 15:13:39.173029 | controller |
2025-10-02 15:13:39.173105 | controller | TASK [ci_gen_kustomize_values : Ensure we have needed parameter] ***************
2025-10-02 15:13:39.173118 | controller | Thursday 02 October 2025  15:13:39 +0000 (0:00:00.058)       0:00:40.070 ******
2025-10-02 15:13:39.173137 | controller | ok: [instance] => changed=false
2025-10-02 15:13:39.386554 | controller |   msg: All assertions passed
2025-10-02 15:13:39.386593 | controller |
2025-10-02 15:13:39.386601 | controller | TASK [ci_gen_kustomize_values : List snippets] *********************************
2025-10-02 15:13:39.386613 | controller | Thursday 02 October 2025  15:13:39 +0000 (0:00:00.044)       0:00:40.115 ******
2025-10-02 15:13:39.386624 | controller | ok: [instance]
2025-10-02 15:13:39.431338 | controller |
2025-10-02 15:13:39.431387 | controller | TASK [ci_gen_kustomize_values : Ensure _content is empty] **********************
2025-10-02 15:13:39.431395 | controller | Thursday 02 October 2025  15:13:39 +0000 (0:00:00.213)       0:00:40.328 ******
2025-10-02 15:13:39.431407 | controller | ok: [instance]
2025-10-02 15:13:39.832529 | controller |
2025-10-02 15:13:39.832569 | controller | TASK [ci_gen_kustomize_values : Load various snippet files] ********************
2025-10-02 15:13:39.832577 | controller | Thursday 02 October 2025  15:13:39 +0000 (0:00:00.044)       0:00:40.373 ******
2025-10-02 15:13:39.832590 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values/03_user_data_b64.yaml)
2025-10-02 15:13:39.918682 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values/04_user_data.yaml)
2025-10-02 15:13:39.918733 | controller |
2025-10-02 15:13:39.918744 | controller | TASK [ci_gen_kustomize_values : Combine snippets] ******************************
2025-10-02 15:13:39.918752 | controller | Thursday 02 October 2025  15:13:39 +0000 (0:00:00.401)       0:00:40.774 ******
2025-10-02 15:13:39.918767 | controller | ok: [instance] => (item=03_user_data_b64.yaml)
2025-10-02 15:13:40.130447 | controller | ok: [instance] => (item=04_user_data.yaml)
2025-10-02 15:13:40.130483 | controller |
2025-10-02 15:13:40.130491 | controller | TASK [ci_gen_kustomize_values : Ensure directories exist] **********************
2025-10-02 15:13:40.130497 | controller | Thursday 02 October 2025  15:13:39 +0000 (0:00:00.086)       0:00:40.860 ******
2025-10-02 15:13:40.130508 | controller | changed: [instance]
2025-10-02 15:13:40.493357 | controller |
2025-10-02 15:13:40.493419 | controller | TASK [ci_gen_kustomize_values : Output values file] ****************************
2025-10-02 15:13:40.493428 | controller | Thursday 02 October 2025  15:13:40 +0000 (0:00:00.212)       0:00:41.072 ******
2025-10-02 15:13:40.493442 | controller | changed: [instance]
2025-10-02 15:13:40.732940 | controller |
2025-10-02 15:13:40.732984 | controller | TASK [kustomize_deploy : Copy generated values for examples/va/hci/edpm-pre-ceph/deployment] ***
2025-10-02 15:13:40.733000 | controller | Thursday 02 October 2025  15:13:40 +0000 (0:00:00.362)       0:00:41.435 ******
2025-10-02 15:13:40.733013 | controller | changed: [instance] => (item=edpm-deployment-values)
2025-10-02 15:13:40.733040 | controller |
2025-10-02 15:13:40.733048 | controller | TASK [kustomize_deploy : Stop before building kustomization if requested] ******
2025-10-02 15:13:40.733170 | controller | Thursday 02 October 2025  15:13:40 +0000 (0:00:00.239)       0:00:41.675 ******
2025-10-02 15:13:40.773247 | controller | skipping: [instance]
2025-10-02 15:13:41.075978 | controller |
2025-10-02 15:13:41.076024 | controller | TASK [kustomize_deploy : Build kustomized content for examples/va/hci/edpm-pre-ceph/deployment] ***
2025-10-02 15:13:41.076033 | controller | Thursday 02 October 2025  15:13:40 +0000 (0:00:00.040)       0:00:41.715 ******
2025-10-02 15:13:41.076045 | controller | changed: [instance]
2025-10-02 15:13:41.076070 | controller |
2025-10-02 15:13:41.076078 | controller | TASK [kustomize_deploy : Output kustomize build in final file] *****************
2025-10-02 15:13:41.076176 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.302)       0:00:42.018 ******
2025-10-02 15:13:41.443702 | controller | changed: [instance]
2025-10-02 15:13:41.664696 | controller |
2025-10-02 15:13:41.664732 | controller | TASK [kustomize_deploy : Store kustomized content in artifacts for examples/va/hci/edpm-pre-ceph/deployment] ***
2025-10-02 15:13:41.664741 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.367)       0:00:42.385 ******
2025-10-02 15:13:41.664753 | controller | changed: [instance]
2025-10-02 15:13:41.703827 | controller |
2025-10-02 15:13:41.703884 | controller | TASK [kustomize_deploy : Stop after building kustomization if requested] *******
2025-10-02 15:13:41.703893 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.221)       0:00:42.606 ******
2025-10-02 15:13:41.703904 | controller | skipping: [instance]
2025-10-02 15:13:41.745050 | controller |
2025-10-02 15:13:41.745116 | controller | TASK [kustomize_deploy : Apply generated content for examples/va/hci/edpm-pre-ceph/deployment] ***
2025-10-02 15:13:41.745152 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.039)       0:00:42.646 ******
2025-10-02 15:13:41.745169 | controller | skipping: [instance]
2025-10-02 15:13:41.745177 | controller |
2025-10-02 15:13:41.745188 | controller | TASK [kustomize_deploy : Run Wait Conditions for examples/va/hci/edpm-pre-ceph/deployment] ***
2025-10-02 15:13:41.787723 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.041)       0:00:42.687 ******
2025-10-02 15:13:41.787765 | controller | skipping: [instance] => (item=oc -n openstack wait osdpns openstack-edpm --for condition=Ready --timeout=30m)
2025-10-02 15:13:41.825697 | controller | skipping: [instance]
2025-10-02 15:13:41.825731 | controller |
2025-10-02 15:13:41.825742 | controller | TASK [kustomize_deploy : Stop after applying CRs if requested] *****************
2025-10-02 15:13:41.825749 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.042)       0:00:42.729 ******
2025-10-02 15:13:41.825759 | controller | skipping: [instance]
2025-10-02 15:13:41.868570 | controller |
2025-10-02 15:13:41.868596 | controller | TASK [Executing post_stage hooks for examples/va/hci/edpm-pre-ceph/deployment] ***
2025-10-02 15:13:41.868603 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.038)       0:00:42.768 ******
2025-10-02 15:13:41.868614 | controller | skipping: [instance]
2025-10-02 15:13:41.909560 | controller |
2025-10-02 15:13:41.909589 | controller | TASK [kustomize_deploy : Assert mandatory bits are defined] ********************
2025-10-02 15:13:41.909598 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.043)       0:00:42.811 ******
2025-10-02 15:13:41.909609 | controller | ok: [instance] => changed=false
2025-10-02 15:13:41.935907 | controller |   msg: All assertions passed
2025-10-02 15:13:41.935931 | controller |
2025-10-02 15:13:41.935949 | controller | TASK [kustomize_deploy : Check custom wait conditions] *************************
2025-10-02 15:13:41.935957 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.040)       0:00:42.851 ******
2025-10-02 15:13:41.935967 | controller | skipping: [instance]
2025-10-02 15:13:41.935995 | controller |
2025-10-02 15:13:41.936205 | controller | TASK [kustomize_deploy : Check builtin wait conditions] ************************
2025-10-02 15:13:41.964900 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.026)       0:00:42.878 ******
2025-10-02 15:13:41.964922 | controller | ok: [instance] => (item=oc -n openstack wait osdpns openstack-edpm --for condition=SetupReady --timeout=10m)
2025-10-02 15:13:41.965313 | controller |
2025-10-02 15:13:41.988024 | controller | TASK [kustomize_deploy : Check wait_conditions validation result] **************
2025-10-02 15:13:41.988042 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.029)       0:00:42.907 ******
2025-10-02 15:13:41.988052 | controller | skipping: [instance]
2025-10-02 15:13:42.017216 | controller |
2025-10-02 15:13:42.017235 | controller | TASK [kustomize_deploy : Set stage_wait_conditions fact] ***********************
2025-10-02 15:13:42.017242 | controller | Thursday 02 October 2025  15:13:41 +0000 (0:00:00.022)       0:00:42.930 ******
2025-10-02 15:13:42.017251 | controller | ok: [instance]
2025-10-02 15:13:42.424940 | controller |
2025-10-02 15:13:42.424976 | controller | TASK [kustomize_deploy : Ensure source files exists] ***************************
2025-10-02 15:13:42.424986 | controller | Thursday 02 October 2025  15:13:42 +0000 (0:00:00.029)       0:00:42.959 ******
2025-10-02 15:13:42.424999 | controller | ok: [instance] => (item={'name': 'service-values', 'src_file': 'service-values.yaml'})
2025-10-02 15:13:42.425033 | controller | ok: [instance] => (item={'name': 'edpm-nodeset-values-post-ceph', 'src_file': 'values.yaml'})
2025-10-02 15:13:42.425042 | controller |
2025-10-02 15:13:42.425051 | controller | TASK [kustomize_deploy : Assert source files exist] ****************************
2025-10-02 15:13:42.425112 | controller | Thursday 02 October 2025  15:13:42 +0000 (0:00:00.407)       0:00:43.367 ******
2025-10-02 15:13:42.512526 | controller | ok: [instance] => (item=service-values.yaml)
2025-10-02 15:13:42.551333 | controller | ok: [instance] => (item=values.yaml)
2025-10-02 15:13:42.551360 | controller |
2025-10-02 15:13:42.551370 | controller | TASK [Executing pre_stage hooks for examples/va/hci] ***************************
2025-10-02 15:13:42.551378 | controller | Thursday 02 October 2025  15:13:42 +0000 (0:00:00.087)       0:00:43.454 ******
2025-10-02 15:13:42.551389 | controller | skipping: [instance]
2025-10-02 15:13:42.667977 | controller |
2025-10-02 15:13:42.668019 | controller | TASK [Generate values.yaml for examples/va/hci] ********************************
2025-10-02 15:13:42.668037 | controller | Thursday 02 October 2025  15:13:42 +0000 (0:00:00.039)       0:00:43.493 ******
2025-10-02 15:13:42.668050 | controller |
2025-10-02 15:13:42.668075 | controller | TASK [ci_gen_kustomize_values : Generate snippets files] ***********************
2025-10-02 15:13:42.668085 | controller | Thursday 02 October 2025  15:13:42 +0000 (0:00:00.116)       0:00:43.610 ******
2025-10-02 15:13:42.727367 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_snippets.yml for instance
2025-10-02 15:13:42.775414 | controller |
2025-10-02 15:13:42.775450 | controller | TASK [ci_gen_kustomize_values : Ensure needed parameter is properly set] *******
2025-10-02 15:13:42.775458 | controller | Thursday 02 October 2025  15:13:42 +0000 (0:00:00.059)       0:00:43.669 ******
2025-10-02 15:13:42.775469 | controller | ok: [instance] => changed=false
2025-10-02 15:13:42.986412 | controller |   msg: All assertions passed
2025-10-02 15:13:42.986453 | controller |
2025-10-02 15:13:42.986461 | controller | TASK [ci_gen_kustomize_values : Stat original source file] *********************
2025-10-02 15:13:42.986468 | controller | Thursday 02 October 2025  15:13:42 +0000 (0:00:00.047)       0:00:43.717 ******
2025-10-02 15:13:42.986479 | controller | ok: [instance]
2025-10-02 15:13:43.035985 | controller |
2025-10-02 15:13:43.036030 | controller | TASK [ci_gen_kustomize_values : Assert source file exists] *********************
2025-10-02 15:13:43.036038 | controller | Thursday 02 October 2025  15:13:42 +0000 (0:00:00.210)       0:00:43.928 ******
2025-10-02 15:13:43.036050 | controller | ok: [instance] => changed=false
2025-10-02 15:13:43.036075 | controller |   msg: All assertions passed
2025-10-02 15:13:43.036081 | controller |
2025-10-02 15:13:43.036088 | controller | TASK [ci_gen_kustomize_values : Load original values file] *********************
2025-10-02 15:13:43.036205 | controller | Thursday 02 October 2025  15:13:43 +0000 (0:00:00.049)       0:00:43.978 ******
2025-10-02 15:13:43.243890 | controller | ok: [instance]
2025-10-02 15:13:43.469258 | controller |
2025-10-02 15:13:43.469294 | controller | TASK [ci_gen_kustomize_values : Expose common data for future usage] ***********
2025-10-02 15:13:43.469302 | controller | Thursday 02 October 2025  15:13:43 +0000 (0:00:00.208)       0:00:44.186 ******
2025-10-02 15:13:43.469314 | controller | ok: [instance]
2025-10-02 15:13:43.509872 | controller |
2025-10-02 15:13:43.509906 | controller | TASK [ci_gen_kustomize_values : Ensure we get the needed data depending on the values type] ***
2025-10-02 15:13:43.509914 | controller | Thursday 02 October 2025  15:13:43 +0000 (0:00:00.225)       0:00:44.411 ******
2025-10-02 15:13:43.509925 | controller | skipping: [instance]
2025-10-02 15:13:43.717576 | controller |
2025-10-02 15:13:43.717609 | controller | TASK [ci_gen_kustomize_values : Ensure output directory exists] ****************
2025-10-02 15:13:43.717618 | controller | Thursday 02 October 2025  15:13:43 +0000 (0:00:00.040)       0:00:44.452 ******
2025-10-02 15:13:43.717628 | controller | ok: [instance]
2025-10-02 15:13:43.764710 | controller |
2025-10-02 15:13:43.764747 | controller | TASK [ci_gen_kustomize_values : Generate CI snippet] ***************************
2025-10-02 15:13:43.764755 | controller | Thursday 02 October 2025  15:13:43 +0000 (0:00:00.207)       0:00:44.659 ******
2025-10-02 15:13:43.764766 | controller | skipping: [instance]
2025-10-02 15:13:43.817425 | controller |
2025-10-02 15:13:43.817459 | controller | TASK [ci_gen_kustomize_values : Generate the base64 CI ConfigMap patches] ******
2025-10-02 15:13:43.817466 | controller | Thursday 02 October 2025  15:13:43 +0000 (0:00:00.047)       0:00:44.707 ******
2025-10-02 15:13:43.817477 | controller | ok: [instance]
2025-10-02 15:13:44.196678 | controller |
2025-10-02 15:13:44.196724 | controller | TASK [ci_gen_kustomize_values : Push base64 CI patches] ************************
2025-10-02 15:13:44.196732 | controller | Thursday 02 October 2025  15:13:43 +0000 (0:00:00.052)       0:00:44.759 ******
2025-10-02 15:13:44.196743 | controller | ok: [instance]
2025-10-02 15:13:44.582194 | controller |
2025-10-02 15:13:44.582229 | controller | TASK [ci_gen_kustomize_values : Push user provided dataset] ********************
2025-10-02 15:13:44.582237 | controller | Thursday 02 October 2025  15:13:44 +0000 (0:00:00.379)       0:00:45.138 ******
2025-10-02 15:13:44.582247 | controller | ok: [instance]
2025-10-02 15:13:44.995395 | controller |
2025-10-02 15:13:44.995430 | controller | TASK [ci_gen_kustomize_values : Copy the base values.yaml] *********************
2025-10-02 15:13:44.995449 | controller | Thursday 02 October 2025  15:13:44 +0000 (0:00:00.385)       0:00:45.524 ******
2025-10-02 15:13:44.995461 | controller | changed: [instance]
2025-10-02 15:13:45.058489 | controller |
2025-10-02 15:13:45.058537 | controller | TASK [ci_gen_kustomize_values : Generate values file] **************************
2025-10-02 15:13:45.058545 | controller | Thursday 02 October 2025  15:13:44 +0000 (0:00:00.413)       0:00:45.937 ******
2025-10-02 15:13:45.058557 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_values.yml for instance
2025-10-02 15:13:45.107492 | controller |
2025-10-02 15:13:45.107533 | controller | TASK [ci_gen_kustomize_values : Ensure we have needed parameter] ***************
2025-10-02 15:13:45.107544 | controller | Thursday 02 October 2025  15:13:45 +0000 (0:00:00.062)       0:00:46.000 ******
2025-10-02 15:13:45.107555 | controller | ok: [instance] => changed=false
2025-10-02 15:13:45.339226 | controller |   msg: All assertions passed
2025-10-02 15:13:45.339266 | controller |
2025-10-02 15:13:45.339274 | controller | TASK [ci_gen_kustomize_values : List snippets] *********************************
2025-10-02 15:13:45.339280 | controller | Thursday 02 October 2025  15:13:45 +0000 (0:00:00.048)       0:00:46.049 ******
2025-10-02 15:13:45.339291 | controller | ok: [instance]
2025-10-02 15:13:45.383503 | controller |
2025-10-02 15:13:45.383543 | controller | TASK [ci_gen_kustomize_values : Ensure _content is empty] **********************
2025-10-02 15:13:45.383551 | controller | Thursday 02 October 2025  15:13:45 +0000 (0:00:00.232)       0:00:46.281 ******
2025-10-02 15:13:45.383563 | controller | ok: [instance]
2025-10-02 15:13:45.792546 | controller |
2025-10-02 15:13:45.792588 | controller | TASK [ci_gen_kustomize_values : Load various snippet files] ********************
2025-10-02 15:13:45.792597 | controller | Thursday 02 October 2025  15:13:45 +0000 (0:00:00.044)       0:00:46.325 ******
2025-10-02 15:13:45.792609 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/service-values/03_user_data_b64.yaml)
2025-10-02 15:13:45.885901 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/service-values/04_user_data.yaml)
2025-10-02 15:13:45.885942 | controller |
2025-10-02 15:13:45.885951 | controller | TASK [ci_gen_kustomize_values : Combine snippets] ******************************
2025-10-02 15:13:45.885957 | controller | Thursday 02 October 2025  15:13:45 +0000 (0:00:00.408)       0:00:46.734 ******
2025-10-02 15:13:45.885968 | controller | ok: [instance] => (item=03_user_data_b64.yaml)
2025-10-02 15:13:46.107919 | controller | ok: [instance] => (item=04_user_data.yaml)
2025-10-02 15:13:46.107955 | controller |
2025-10-02 15:13:46.107964 | controller | TASK [ci_gen_kustomize_values : Ensure directories exist] **********************
2025-10-02 15:13:46.107970 | controller | Thursday 02 October 2025  15:13:45 +0000 (0:00:00.093)       0:00:46.827 ******
2025-10-02 15:13:46.107980 | controller | ok: [instance]
2025-10-02 15:13:46.108176 | controller |
2025-10-02 15:13:46.108191 | controller | TASK [ci_gen_kustomize_values : Output values file] ****************************
2025-10-02 15:13:46.538643 | controller | Thursday 02 October 2025  15:13:46 +0000 (0:00:00.222)       0:00:47.050 ******
2025-10-02 15:13:46.538682 | controller | changed: [instance]
2025-10-02 15:13:46.596746 | controller |
2025-10-02 15:13:46.596775 | controller | TASK [ci_gen_kustomize_values : Generate snippets files] ***********************
2025-10-02 15:13:46.596783 | controller | Thursday 02 October 2025  15:13:46 +0000 (0:00:00.430)       0:00:47.480 ******
2025-10-02 15:13:46.596794 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_snippets.yml for instance
2025-10-02 15:13:46.642507 | controller |
2025-10-02 15:13:46.642535 | controller | TASK [ci_gen_kustomize_values : Ensure needed parameter is properly set] *******
2025-10-02 15:13:46.642543 | controller | Thursday 02 October 2025  15:13:46 +0000 (0:00:00.058)       0:00:47.539 ******
2025-10-02 15:13:46.642553 | controller | ok: [instance] => changed=false
2025-10-02 15:13:46.856849 | controller |   msg: All assertions passed
2025-10-02 15:13:46.856883 | controller |
2025-10-02 15:13:46.856891 | controller | TASK [ci_gen_kustomize_values : Stat original source file] *********************
2025-10-02 15:13:46.856897 | controller | Thursday 02 October 2025  15:13:46 +0000 (0:00:00.045)       0:00:47.584 ******
2025-10-02 15:13:46.856918 | controller | ok: [instance]
2025-10-02 15:13:46.911074 | controller |
2025-10-02 15:13:46.911098 | controller | TASK [ci_gen_kustomize_values : Assert source file exists] *********************
2025-10-02 15:13:46.911106 | controller | Thursday 02 October 2025  15:13:46 +0000 (0:00:00.214)       0:00:47.798 ******
2025-10-02 15:13:46.911117 | controller | ok: [instance] => changed=false
2025-10-02 15:13:47.129490 | controller |   msg: All assertions passed
2025-10-02 15:13:47.129521 | controller |
2025-10-02 15:13:47.129529 | controller | TASK [ci_gen_kustomize_values : Load original values file] *********************
2025-10-02 15:13:47.129536 | controller | Thursday 02 October 2025  15:13:46 +0000 (0:00:00.053)       0:00:47.852 ******
2025-10-02 15:13:47.129546 | controller | ok: [instance]
2025-10-02 15:13:47.312536 | controller |
2025-10-02 15:13:47.312576 | controller | TASK [ci_gen_kustomize_values : Expose common data for future usage] ***********
2025-10-02 15:13:47.312586 | controller | Thursday 02 October 2025  15:13:47 +0000 (0:00:00.218)       0:00:48.071 ******
2025-10-02 15:13:47.312599 | controller | ok: [instance]
2025-10-02 15:13:47.357361 | controller |
2025-10-02 15:13:47.357391 | controller | TASK [ci_gen_kustomize_values : Ensure we get the needed data depending on the values type] ***
2025-10-02 15:13:47.357400 | controller | Thursday 02 October 2025  15:13:47 +0000 (0:00:00.182)       0:00:48.254 ******
2025-10-02 15:13:47.357410 | controller | skipping: [instance]
2025-10-02 15:13:47.581521 | controller |
2025-10-02 15:13:47.581558 | controller | TASK [ci_gen_kustomize_values : Ensure output directory exists] ****************
2025-10-02 15:13:47.581572 | controller | Thursday 02 October 2025  15:13:47 +0000 (0:00:00.045)       0:00:48.299 ******
2025-10-02 15:13:47.581584 | controller | changed: [instance]
2025-10-02 15:13:47.636356 | controller |
2025-10-02 15:13:47.636395 | controller | TASK [ci_gen_kustomize_values : Generate CI snippet] ***************************
2025-10-02 15:13:47.636405 | controller | Thursday 02 October 2025  15:13:47 +0000 (0:00:00.224)       0:00:48.523 ******
2025-10-02 15:13:47.636419 | controller | skipping: [instance]
2025-10-02 15:13:47.698793 | controller |
2025-10-02 15:13:47.698819 | controller | TASK [ci_gen_kustomize_values : Generate the base64 CI ConfigMap patches] ******
2025-10-02 15:13:47.698827 | controller | Thursday 02 October 2025  15:13:47 +0000 (0:00:00.054)       0:00:48.578 ******
2025-10-02 15:13:47.698854 | controller | ok: [instance]
2025-10-02 15:13:48.075872 | controller |
2025-10-02 15:13:48.075912 | controller | TASK [ci_gen_kustomize_values : Push base64 CI patches] ************************
2025-10-02 15:13:48.075920 | controller | Thursday 02 October 2025  15:13:47 +0000 (0:00:00.062)       0:00:48.640 ******
2025-10-02 15:13:48.075931 | controller | changed: [instance]
2025-10-02 15:13:48.436542 | controller |
2025-10-02 15:13:48.436575 | controller | TASK [ci_gen_kustomize_values : Push user provided dataset] ********************
2025-10-02 15:13:48.436583 | controller | Thursday 02 October 2025  15:13:48 +0000 (0:00:00.376)       0:00:49.017 ******
2025-10-02 15:13:48.436594 | controller | changed: [instance]
2025-10-02 15:13:48.793907 | controller |
2025-10-02 15:13:48.793941 | controller | TASK [ci_gen_kustomize_values : Copy the base values.yaml] *********************
2025-10-02 15:13:48.793949 | controller | Thursday 02 October 2025  15:13:48 +0000 (0:00:00.361)       0:00:49.378 ******
2025-10-02 15:13:48.793960 | controller | changed: [instance]
2025-10-02 15:13:48.851824 | controller |
2025-10-02 15:13:48.851880 | controller | TASK [ci_gen_kustomize_values : Generate values file] **************************
2025-10-02 15:13:48.851888 | controller | Thursday 02 October 2025  15:13:48 +0000 (0:00:00.357)       0:00:49.736 ******
2025-10-02 15:13:48.851900 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_values.yml for instance
2025-10-02 15:13:48.895162 | controller |
2025-10-02 15:13:48.895194 | controller | TASK [ci_gen_kustomize_values : Ensure we have needed parameter] ***************
2025-10-02 15:13:48.895202 | controller | Thursday 02 October 2025  15:13:48 +0000 (0:00:00.057)       0:00:49.793 ******
2025-10-02 15:13:48.895213 | controller | ok: [instance] => changed=false
2025-10-02 15:13:49.101606 | controller |   msg: All assertions passed
2025-10-02 15:13:49.101639 | controller |
2025-10-02 15:13:49.101646 | controller | TASK [ci_gen_kustomize_values : List snippets] *********************************
2025-10-02 15:13:49.101653 | controller | Thursday 02 October 2025  15:13:48 +0000 (0:00:00.043)       0:00:49.837 ******
2025-10-02 15:13:49.101668 | controller | ok: [instance]
2025-10-02 15:13:49.141621 | controller |
2025-10-02 15:13:49.141659 | controller | TASK [ci_gen_kustomize_values : Ensure _content is empty] **********************
2025-10-02 15:13:49.141667 | controller | Thursday 02 October 2025  15:13:49 +0000 (0:00:00.206)       0:00:50.043 ******
2025-10-02 15:13:49.141678 | controller | ok: [instance]
2025-10-02 15:13:49.537918 | controller |
2025-10-02 15:13:49.537953 | controller | TASK [ci_gen_kustomize_values : Load various snippet files] ********************
2025-10-02 15:13:49.537962 | controller | Thursday 02 October 2025  15:13:49 +0000 (0:00:00.039)       0:00:50.083 ******
2025-10-02 15:13:49.537973 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values-post-ceph/03_user_data_b64.yaml)
2025-10-02 15:13:49.538341 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values-post-ceph/04_user_data.yaml)
2025-10-02 15:13:49.624745 | controller |
2025-10-02 15:13:49.624778 | controller | TASK [ci_gen_kustomize_values : Combine snippets] ******************************
2025-10-02 15:13:49.624786 | controller | Thursday 02 October 2025  15:13:49 +0000 (0:00:00.396)       0:00:50.480 ******
2025-10-02 15:13:49.624797 | controller | ok: [instance] => (item=03_user_data_b64.yaml)
2025-10-02 15:13:49.841964 | controller | ok: [instance] => (item=04_user_data.yaml)
2025-10-02 15:13:49.841999 | controller |
2025-10-02 15:13:49.842007 | controller | TASK [ci_gen_kustomize_values : Ensure directories exist] **********************
2025-10-02 15:13:49.842013 | controller | Thursday 02 October 2025  15:13:49 +0000 (0:00:00.086)       0:00:50.566 ******
2025-10-02 15:13:49.842024 | controller | changed: [instance]
2025-10-02 15:13:49.842047 | controller |
2025-10-02 15:13:49.842054 | controller | TASK [ci_gen_kustomize_values : Output values file] ****************************
2025-10-02 15:13:49.842151 | controller | Thursday 02 October 2025  15:13:49 +0000 (0:00:00.217)       0:00:50.784 ******
2025-10-02 15:13:50.262675 | controller | changed: [instance]
2025-10-02 15:13:50.690992 | controller |
2025-10-02 15:13:50.691025 | controller | TASK [kustomize_deploy : Copy generated values for examples/va/hci] ************
2025-10-02 15:13:50.691033 | controller | Thursday 02 October 2025  15:13:50 +0000 (0:00:00.420)       0:00:51.205 ******
2025-10-02 15:13:50.691044 | controller | changed: [instance] => (item=service-values)
2025-10-02 15:13:50.727722 | controller | changed: [instance] => (item=edpm-nodeset-values-post-ceph)
2025-10-02 15:13:50.727752 | controller |
2025-10-02 15:13:50.727760 | controller | TASK [kustomize_deploy : Stop before building kustomization if requested] ******
2025-10-02 15:13:50.727766 | controller | Thursday 02 October 2025  15:13:50 +0000 (0:00:00.427)       0:00:51.633 ******
2025-10-02 15:13:50.727780 | controller | skipping: [instance]
2025-10-02 15:13:51.118264 | controller |
2025-10-02 15:13:51.118296 | controller | TASK [kustomize_deploy : Build kustomized content for examples/va/hci] *********
2025-10-02 15:13:51.118305 | controller | Thursday 02 October 2025  15:13:50 +0000 (0:00:00.037)       0:00:51.670 ******
2025-10-02 15:13:51.118315 | controller | changed: [instance]
2025-10-02 15:13:51.480921 | controller |
2025-10-02 15:13:51.480960 | controller | TASK [kustomize_deploy : Output kustomize build in final file] *****************
2025-10-02 15:13:51.480972 | controller | Thursday 02 October 2025  15:13:51 +0000 (0:00:00.390)       0:00:52.060 ******
2025-10-02 15:13:51.480988 | controller | changed: [instance]
2025-10-02 15:13:51.481021 | controller |
2025-10-02 15:13:51.481038 | controller | TASK [kustomize_deploy : Store kustomized content in artifacts for examples/va/hci] ***
2025-10-02 15:13:51.481050 | controller | Thursday 02 October 2025  15:13:51 +0000 (0:00:00.362)       0:00:52.423 ******
2025-10-02 15:13:51.693572 | controller | changed: [instance]
2025-10-02 15:13:51.731936 | controller |
2025-10-02 15:13:51.731971 | controller | TASK [kustomize_deploy : Stop after building kustomization if requested] *******
2025-10-02 15:13:51.731980 | controller | Thursday 02 October 2025  15:13:51 +0000 (0:00:00.212)       0:00:52.635 ******
2025-10-02 15:13:51.731993 | controller | skipping: [instance]
2025-10-02 15:13:51.732022 | controller |
2025-10-02 15:13:51.732250 | controller | TASK [kustomize_deploy : Apply generated content for examples/va/hci] **********
2025-10-02 15:13:51.773315 | controller | Thursday 02 October 2025  15:13:51 +0000 (0:00:00.038)       0:00:52.674 ******
2025-10-02 15:13:51.773359 | controller | skipping: [instance]
2025-10-02 15:13:51.819790 | controller |
2025-10-02 15:13:51.819815 | controller | TASK [kustomize_deploy : Run Wait Conditions for examples/va/hci] **************
2025-10-02 15:13:51.819823 | controller | Thursday 02 October 2025  15:13:51 +0000 (0:00:00.040)       0:00:52.715 ******
2025-10-02 15:13:51.819834 | controller | skipping: [instance] => (item=oc -n openstack wait osdpns openstack-edpm --for condition=SetupReady --timeout=10m)
2025-10-02 15:13:51.869563 | controller | skipping: [instance]
2025-10-02 15:13:51.869592 | controller |
2025-10-02 15:13:51.869600 | controller | TASK [kustomize_deploy : Stop after applying CRs if requested] *****************
2025-10-02 15:13:51.869608 | controller | Thursday 02 October 2025  15:13:51 +0000 (0:00:00.046)       0:00:52.762 ******
2025-10-02 15:13:51.869618 | controller | skipping: [instance]
2025-10-02 15:13:51.925931 | controller |
2025-10-02 15:13:51.925968 | controller | TASK [Executing post_stage hooks for examples/va/hci] **************************
2025-10-02 15:13:51.925976 | controller | Thursday 02 October 2025  15:13:51 +0000 (0:00:00.049)       0:00:52.811 ******
2025-10-02 15:13:51.925987 | controller | skipping: [instance]
2025-10-02 15:13:51.974316 | controller |
2025-10-02 15:13:51.974342 | controller | TASK [kustomize_deploy : Assert mandatory bits are defined] ********************
2025-10-02 15:13:51.974349 | controller | Thursday 02 October 2025  15:13:51 +0000 (0:00:00.056)       0:00:52.867 ******
2025-10-02 15:13:51.974359 | controller | ok: [instance] => changed=false
2025-10-02 15:13:52.001970 | controller |   msg: All assertions passed
2025-10-02 15:13:52.002011 | controller |
2025-10-02 15:13:52.002021 | controller | TASK [kustomize_deploy : Check custom wait conditions] *************************
2025-10-02 15:13:52.002029 | controller | Thursday 02 October 2025  15:13:51 +0000 (0:00:00.048)       0:00:52.916 ******
2025-10-02 15:13:52.002041 | controller | skipping: [instance]
2025-10-02 15:13:52.002069 | controller |
2025-10-02 15:13:52.002078 | controller | TASK [kustomize_deploy : Check builtin wait conditions] ************************
2025-10-02 15:13:52.002104 | controller | Thursday 02 October 2025  15:13:51 +0000 (0:00:00.028)       0:00:52.944 ******
2025-10-02 15:13:52.038553 | controller | ok: [instance] => (item=oc -n openstack wait osdpns openstack-edpm --for condition=Ready --timeout=80m)
2025-10-02 15:13:52.066979 | controller |
2025-10-02 15:13:52.067022 | controller | TASK [kustomize_deploy : Check wait_conditions validation result] **************
2025-10-02 15:13:52.067033 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.036)       0:00:52.980 ******
2025-10-02 15:13:52.067046 | controller | skipping: [instance]
2025-10-02 15:13:52.101415 | controller |
2025-10-02 15:13:52.101452 | controller | TASK [kustomize_deploy : Set stage_wait_conditions fact] ***********************
2025-10-02 15:13:52.101462 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.028)       0:00:53.009 ******
2025-10-02 15:13:52.101475 | controller | ok: [instance]
2025-10-02 15:13:52.330118 | controller |
2025-10-02 15:13:52.330159 | controller | TASK [kustomize_deploy : Ensure source files exists] ***************************
2025-10-02 15:13:52.330169 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.034)       0:00:53.043 ******
2025-10-02 15:13:52.330183 | controller | ok: [instance] => (item={'name': 'edpm-deployment-values-post-ceph', 'src_file': 'values.yaml'})
2025-10-02 15:13:52.400474 | controller |
2025-10-02 15:13:52.400510 | controller | TASK [kustomize_deploy : Assert source files exist] ****************************
2025-10-02 15:13:52.400519 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.228)       0:00:53.271 ******
2025-10-02 15:13:52.400530 | controller | ok: [instance] => (item=values.yaml)
2025-10-02 15:13:52.448687 | controller |
2025-10-02 15:13:52.448728 | controller | TASK [Executing pre_stage hooks for examples/va/hci/deployment] ****************
2025-10-02 15:13:52.448741 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.070)       0:00:53.342 ******
2025-10-02 15:13:52.448751 | controller | skipping: [instance]
2025-10-02 15:13:52.526543 | controller |
2025-10-02 15:13:52.526573 | controller | TASK [Generate values.yaml for examples/va/hci/deployment] *********************
2025-10-02 15:13:52.526581 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.048)       0:00:53.390 ******
2025-10-02 15:13:52.526591 | controller |
2025-10-02 15:13:52.594961 | controller | TASK [ci_gen_kustomize_values : Generate snippets files] ***********************
2025-10-02 15:13:52.595008 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.078)       0:00:53.468 ******
2025-10-02 15:13:52.595022 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_snippets.yml for instance
2025-10-02 15:13:52.642949 | controller |
2025-10-02 15:13:52.642987 | controller | TASK [ci_gen_kustomize_values : Ensure needed parameter is properly set] *******
2025-10-02 15:13:52.642995 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.068)       0:00:53.537 ******
2025-10-02 15:13:52.643006 | controller | ok: [instance] => changed=false
2025-10-02 15:13:52.850430 | controller |   msg: All assertions passed
2025-10-02 15:13:52.850464 | controller |
2025-10-02 15:13:52.850472 | controller | TASK [ci_gen_kustomize_values : Stat original source file] *********************
2025-10-02 15:13:52.850479 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.048)       0:00:53.585 ******
2025-10-02 15:13:52.850489 | controller | ok: [instance]
2025-10-02 15:13:52.897369 | controller |
2025-10-02 15:13:52.897402 | controller | TASK [ci_gen_kustomize_values : Assert source file exists] *********************
2025-10-02 15:13:52.897410 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.207)       0:00:53.792 ******
2025-10-02 15:13:52.897421 | controller | ok: [instance] => changed=false
2025-10-02 15:13:53.107310 | controller |   msg: All assertions passed
2025-10-02 15:13:53.107355 | controller |
2025-10-02 15:13:53.107364 | controller | TASK [ci_gen_kustomize_values : Load original values file] *********************
2025-10-02 15:13:53.107370 | controller | Thursday 02 October 2025  15:13:52 +0000 (0:00:00.046)       0:00:53.839 ******
2025-10-02 15:13:53.107381 | controller | ok: [instance]
2025-10-02 15:13:53.279967 | controller |
2025-10-02 15:13:53.280015 | controller | TASK [ci_gen_kustomize_values : Expose common data for future usage] ***********
2025-10-02 15:13:53.280023 | controller | Thursday 02 October 2025  15:13:53 +0000 (0:00:00.209)       0:00:54.049 ******
2025-10-02 15:13:53.280034 | controller | ok: [instance]
2025-10-02 15:13:53.325680 | controller |
2025-10-02 15:13:53.325769 | controller | TASK [ci_gen_kustomize_values : Ensure we get the needed data depending on the values type] ***
2025-10-02 15:13:53.325780 | controller | Thursday 02 October 2025  15:13:53 +0000 (0:00:00.172)       0:00:54.221 ******
2025-10-02 15:13:53.325793 | controller | skipping: [instance]
2025-10-02 15:13:53.556405 | controller |
2025-10-02 15:13:53.556463 | controller | TASK [ci_gen_kustomize_values : Ensure output directory exists] ****************
2025-10-02 15:13:53.556471 | controller | Thursday 02 October 2025  15:13:53 +0000 (0:00:00.045)       0:00:54.267 ******
2025-10-02 15:13:53.556484 | controller | changed: [instance]
2025-10-02 15:13:53.610566 | controller |
2025-10-02 15:13:53.610611 | controller | TASK [ci_gen_kustomize_values : Generate CI snippet] ***************************
2025-10-02 15:13:53.610619 | controller | Thursday 02 October 2025  15:13:53 +0000 (0:00:00.231)       0:00:54.498 ******
2025-10-02 15:13:53.610631 | controller | skipping: [instance]
2025-10-02 15:13:53.668998 | controller |
2025-10-02 15:13:53.669047 | controller | TASK [ci_gen_kustomize_values : Generate the base64 CI ConfigMap patches] ******
2025-10-02 15:13:53.669057 | controller | Thursday 02 October 2025  15:13:53 +0000 (0:00:00.054)       0:00:54.552 ******
2025-10-02 15:13:53.669071 | controller | ok: [instance]
2025-10-02 15:13:54.061278 | controller |
2025-10-02 15:13:54.061320 | controller | TASK [ci_gen_kustomize_values : Push base64 CI patches] ************************
2025-10-02 15:13:54.061329 | controller | Thursday 02 October 2025  15:13:53 +0000 (0:00:00.058)       0:00:54.611 ******
2025-10-02 15:13:54.061340 | controller | changed: [instance]
2025-10-02 15:13:54.479564 | controller |
2025-10-02 15:13:54.479598 | controller | TASK [ci_gen_kustomize_values : Push user provided dataset] ********************
2025-10-02 15:13:54.479607 | controller | Thursday 02 October 2025  15:13:54 +0000 (0:00:00.391)       0:00:55.003 ******
2025-10-02 15:13:54.479617 | controller | changed: [instance]
2025-10-02 15:13:54.846098 | controller |
2025-10-02 15:13:54.846134 | controller | TASK [ci_gen_kustomize_values : Copy the base values.yaml] *********************
2025-10-02 15:13:54.846143 | controller | Thursday 02 October 2025  15:13:54 +0000 (0:00:00.418)       0:00:55.421 ******
2025-10-02 15:13:54.846154 | controller | changed: [instance]
2025-10-02 15:13:54.904665 | controller |
2025-10-02 15:13:54.904696 | controller | TASK [ci_gen_kustomize_values : Generate values file] **************************
2025-10-02 15:13:54.904704 | controller | Thursday 02 October 2025  15:13:54 +0000 (0:00:00.366)       0:00:55.788 ******
2025-10-02 15:13:54.904715 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/ci_gen_kustomize_values/tasks/generate_values.yml for instance
2025-10-02 15:13:54.947949 | controller |
2025-10-02 15:13:54.947975 | controller | TASK [ci_gen_kustomize_values : Ensure we have needed parameter] ***************
2025-10-02 15:13:54.947987 | controller | Thursday 02 October 2025  15:13:54 +0000 (0:00:00.058)       0:00:55.847 ******
2025-10-02 15:13:54.947997 | controller | ok: [instance] => changed=false
2025-10-02 15:13:54.948018 | controller |   msg: All assertions passed
2025-10-02 15:13:54.948026 | controller |
2025-10-02 15:13:54.948218 | controller | TASK [ci_gen_kustomize_values : List snippets] *********************************
2025-10-02 15:13:55.158947 | controller | Thursday 02 October 2025  15:13:54 +0000 (0:00:00.043)       0:00:55.890 ******
2025-10-02 15:13:55.158991 | controller | ok: [instance]
2025-10-02 15:13:55.198008 | controller |
2025-10-02 15:13:55.198056 | controller | TASK [ci_gen_kustomize_values : Ensure _content is empty] **********************
2025-10-02 15:13:55.198065 | controller | Thursday 02 October 2025  15:13:55 +0000 (0:00:00.210)       0:00:56.101 ******
2025-10-02 15:13:55.198076 | controller | ok: [instance]
2025-10-02 15:13:55.609345 | controller |
2025-10-02 15:13:55.609387 | controller | TASK [ci_gen_kustomize_values : Load various snippet files] ********************
2025-10-02 15:13:55.609395 | controller | Thursday 02 October 2025  15:13:55 +0000 (0:00:00.039)       0:00:56.140 ******
2025-10-02 15:13:55.609407 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values-post-ceph/03_user_data_b64.yaml)
2025-10-02 15:13:55.700418 | controller | ok: [instance] => (item=/home/zuul/ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values-post-ceph/04_user_data.yaml)
2025-10-02 15:13:55.700461 | controller |
2025-10-02 15:13:55.700469 | controller | TASK [ci_gen_kustomize_values : Combine snippets] ******************************
2025-10-02 15:13:55.700475 | controller | Thursday 02 October 2025  15:13:55 +0000 (0:00:00.410)       0:00:56.551 ******
2025-10-02 15:13:55.700486 | controller | ok: [instance] => (item=03_user_data_b64.yaml)
2025-10-02 15:13:55.931946 | controller | ok: [instance] => (item=04_user_data.yaml)
2025-10-02 15:13:55.931988 | controller |
2025-10-02 15:13:55.931996 | controller | TASK [ci_gen_kustomize_values : Ensure directories exist] **********************
2025-10-02 15:13:55.932003 | controller | Thursday 02 October 2025  15:13:55 +0000 (0:00:00.091)       0:00:56.642 ******
2025-10-02 15:13:55.932014 | controller | changed: [instance]
2025-10-02 15:13:55.932251 | controller |
2025-10-02 15:13:55.932265 | controller | TASK [ci_gen_kustomize_values : Output values file] ****************************
2025-10-02 15:13:56.320702 | controller | Thursday 02 October 2025  15:13:55 +0000 (0:00:00.231)       0:00:56.874 ******
2025-10-02 15:13:56.320762 | controller | changed: [instance]
2025-10-02 15:13:56.594064 | controller |
2025-10-02 15:13:56.594122 | controller | TASK [kustomize_deploy : Copy generated values for examples/va/hci/deployment] ***
2025-10-02 15:13:56.594131 | controller | Thursday 02 October 2025  15:13:56 +0000 (0:00:00.388)       0:00:57.262 ******
2025-10-02 15:13:56.594145 | controller | changed: [instance] => (item=edpm-deployment-values-post-ceph)
2025-10-02 15:13:56.642042 | controller |
2025-10-02 15:13:56.642110 | controller | TASK [kustomize_deploy : Stop before building kustomization if requested] ******
2025-10-02 15:13:56.642120 | controller | Thursday 02 October 2025  15:13:56 +0000 (0:00:00.272)       0:00:57.535 ******
2025-10-02 15:13:56.642137 | controller | skipping: [instance]
2025-10-02 15:13:56.995023 | controller |
2025-10-02 15:13:56.995073 | controller | TASK [kustomize_deploy : Build kustomized content for examples/va/hci/deployment] ***
2025-10-02 15:13:56.995082 | controller | Thursday 02 October 2025  15:13:56 +0000 (0:00:00.048)       0:00:57.583 ******
2025-10-02 15:13:56.995096 | controller | changed: [instance]
2025-10-02 15:13:57.409915 | controller |
2025-10-02 15:13:57.409978 | controller | TASK [kustomize_deploy : Output kustomize build in final file] *****************
2025-10-02 15:13:57.409987 | controller | Thursday 02 October 2025  15:13:56 +0000 (0:00:00.352)       0:00:57.936 ******
2025-10-02 15:13:57.410010 | controller | changed: [instance]
2025-10-02 15:13:57.656394 | controller |
2025-10-02 15:13:57.656436 | controller | TASK [kustomize_deploy : Store kustomized content in artifacts for examples/va/hci/deployment] ***
2025-10-02 15:13:57.656446 | controller | Thursday 02 October 2025  15:13:57 +0000 (0:00:00.414)       0:00:58.351 ******
2025-10-02 15:13:57.656457 | controller | changed: [instance]
2025-10-02 15:13:57.709478 | controller |
2025-10-02 15:13:57.709528 | controller | TASK [kustomize_deploy : Stop after building kustomization if requested] *******
2025-10-02 15:13:57.709536 | controller | Thursday 02 October 2025  15:13:57 +0000 (0:00:00.246)       0:00:58.597 ******
2025-10-02 15:13:57.709548 | controller | skipping: [instance]
2025-10-02 15:13:57.752969 | controller |
2025-10-02 15:13:57.753007 | controller | TASK [kustomize_deploy : Apply generated content for examples/va/hci/deployment] ***
2025-10-02 15:13:57.753015 | controller | Thursday 02 October 2025  15:13:57 +0000 (0:00:00.053)       0:00:58.651 ******
2025-10-02 15:13:57.753027 | controller | skipping: [instance]
2025-10-02 15:13:57.753054 | controller |
2025-10-02 15:13:57.753348 | controller | TASK [kustomize_deploy : Run Wait Conditions for examples/va/hci/deployment] ***
2025-10-02 15:13:57.798966 | controller | Thursday 02 October 2025  15:13:57 +0000 (0:00:00.043)       0:00:58.695 ******
2025-10-02 15:13:57.799015 | controller | skipping: [instance] => (item=oc -n openstack wait osdpns openstack-edpm --for condition=Ready --timeout=80m)
2025-10-02 15:13:57.799155 | controller | skipping: [instance]
2025-10-02 15:13:57.799167 | controller |
2025-10-02 15:13:57.799178 | controller | TASK [kustomize_deploy : Stop after applying CRs if requested] *****************
2025-10-02 15:13:57.799277 | controller | Thursday 02 October 2025  15:13:57 +0000 (0:00:00.046)       0:00:58.741 ******
2025-10-02 15:13:57.845563 | controller | skipping: [instance]
2025-10-02 15:13:57.893672 | controller |
2025-10-02 15:13:57.893716 | controller | TASK [Executing post_stage hooks for examples/va/hci/deployment] ***************
2025-10-02 15:13:57.893730 | controller | Thursday 02 October 2025  15:13:57 +0000 (0:00:00.046)       0:00:58.787 ******
2025-10-02 15:13:57.893742 | controller | skipping: [instance]
2025-10-02 15:13:58.105223 | controller |
2025-10-02 15:13:58.105264 | controller | TASK [Run loop deployment again] ***********************************************
2025-10-02 15:13:58.105274 | controller | Thursday 02 October 2025  15:13:57 +0000 (0:00:00.047)       0:00:58.835 ******
2025-10-02 15:13:58.105286 | controller |
2025-10-02 15:13:58.147575 | controller | TASK [kustomize_deploy : Assert mandatory bits are defined] ********************
2025-10-02 15:13:58.147613 | controller | Thursday 02 October 2025  15:13:58 +0000 (0:00:00.211)       0:00:59.047 ******
2025-10-02 15:13:58.147637 | controller | ok: [instance] => changed=false
2025-10-02 15:13:58.177386 | controller |   msg: All assertions passed
2025-10-02 15:13:58.177411 | controller |
2025-10-02 15:13:58.177419 | controller | TASK [kustomize_deploy : Check custom wait conditions] *************************
2025-10-02 15:13:58.177425 | controller | Thursday 02 October 2025  15:13:58 +0000 (0:00:00.042)       0:00:59.089 ******
2025-10-02 15:13:58.177434 | controller | failed: [instance] (item=sudo cat /etc/passwd) => changed=false
2025-10-02 15:13:58.177587 | controller |   ansible_loop_var: item
2025-10-02 15:13:58.177725 | controller |   assertion: item is match(_pattern)
2025-10-02 15:13:58.177896 | controller |   evaluated_to: false
2025-10-02 15:13:58.178032 | controller |   item: sudo cat /etc/passwd
2025-10-02 15:13:58.178161 | controller |   msg: 'The following custom condition is invalid: sudo cat /etc/passwd'
2025-10-02 15:13:58.179804 | controller | failed: [instance] (item=oc rsh exec blah) => changed=false
2025-10-02 15:13:58.179983 | controller |   ansible_loop_var: item
2025-10-02 15:13:58.180130 | controller |   assertion: item is match(_pattern)
2025-10-02 15:13:58.180274 | controller |   evaluated_to: false
2025-10-02 15:13:58.180409 | controller |   item: oc rsh exec blah
2025-10-02 15:13:58.180540 | controller |   msg: 'The following custom condition is invalid: oc rsh exec blah'
2025-10-02 15:13:58.183906 | controller | failed: [instance] (item=kubectl rsh exec bar) => changed=false
2025-10-02 15:13:58.184694 | controller |   ansible_loop_var: item
2025-10-02 15:13:58.184870 | controller |   assertion: item is match(_pattern)
2025-10-02 15:13:58.185013 | controller |   evaluated_to: false
2025-10-02 15:13:58.185142 | controller |   item: kubectl rsh exec bar
2025-10-02 15:13:58.185277 | controller |   msg: 'The following custom condition is invalid: kubectl rsh exec bar'
2025-10-02 15:13:58.193999 | controller | ...ignoring
2025-10-02 15:13:58.194161 | controller |
2025-10-02 15:13:58.194319 | controller | TASK [kustomize_deploy : Check builtin wait conditions] ************************
2025-10-02 15:13:58.194475 | controller | Thursday 02 October 2025  15:13:58 +0000 (0:00:00.047)       0:00:59.136 ******
2025-10-02 15:13:58.229591 | controller | ok: [instance] => (item=oc -n openstack wait nncp -l osp/nncm-config-type=standard --for jsonpath='{.status.conditions[0].reason}'=SuccessfullyConfigured --timeout=5m)
2025-10-02 15:13:58.252271 | controller |
2025-10-02 15:13:58.252297 | controller | TASK [kustomize_deploy : Check wait_conditions validation result] **************
2025-10-02 15:13:58.252305 | controller | Thursday 02 October 2025  15:13:58 +0000 (0:00:00.034)       0:00:59.171 ******
2025-10-02 15:13:58.252315 | controller | fatal: [instance]: FAILED! => changed=false
2025-10-02 15:13:58.280114 | controller |   msg: Review and correct the faulty wait_conditions listed above.
2025-10-02 15:13:58.280139 | controller |
2025-10-02 15:13:58.384802 | controller | TASK [Clear expected errors] ***************************************************
2025-10-02 15:13:58.384866 | controller | Thursday 02 October 2025  15:13:58 +0000 (0:00:00.031)       0:00:59.203 ******
2025-10-02 15:13:58.384877 | controller |
2025-10-02 15:13:58.384883 | controller | TASK [Ensure a successful end] *************************************************
2025-10-02 15:13:58.384889 | controller | Thursday 02 October 2025  15:13:58 +0000 (0:00:00.009)       0:00:59.213 ******
2025-10-02 15:13:58.384894 | controller |
2025-10-02 15:13:58.384899 | controller | PLAY RECAP *********************************************************************
2025-10-02 15:13:58.384905 | controller | instance                   : ok=261  changed=69   unreachable=0    failed=0    skipped=75   rescued=1    ignored=1
2025-10-02 15:13:58.384910 | controller |
2025-10-02 15:13:58.384915 | controller | Thursday 02 October 2025  15:13:58 +0000 (0:00:00.006)       0:00:59.219 ******
2025-10-02 15:13:58.384921 | controller | ===============================================================================
2025-10-02 15:13:58.384926 | controller | Gathering Facts --------------------------------------------------------- 0.88s
2025-10-02 15:13:58.384931 | controller | ci_gen_kustomize_values : Load various snippet files -------------------- 0.66s
2025-10-02 15:13:58.384936 | controller | ci_gen_kustomize_values : Load various snippet files -------------------- 0.64s
2025-10-02 15:13:58.384941 | controller | ci_gen_kustomize_values : Load various snippet files -------------------- 0.61s
2025-10-02 15:13:58.384946 | controller | ci_gen_kustomize_values : Load various snippet files -------------------- 0.59s
2025-10-02 15:13:58.384951 | controller | ci_gen_kustomize_values : Generate CI snippet --------------------------- 0.58s
2025-10-02 15:13:58.384957 | controller | kustomize_deploy : Build kustomized content for examples/va/hci/control-plane/networking/nncp --- 0.56s
2025-10-02 15:13:58.384963 | controller | ci_gen_kustomize_values : Generate CI snippet --------------------------- 0.53s
2025-10-02 15:13:58.384968 | controller | ci_gen_kustomize_values : Generate CI snippet --------------------------- 0.51s
2025-10-02 15:13:58.384973 | controller | ci_gen_kustomize_values : Copy the base values.yaml --------------------- 0.50s
2025-10-02 15:13:58.384978 | controller | kustomize_deploy : Copy generated values for examples/va/hci/control-plane --- 0.49s
2025-10-02 15:13:58.384984 | controller | ci_gen_kustomize_values : Output values file ---------------------------- 0.48s
2025-10-02 15:13:58.384989 | controller | ci_gen_kustomize_values : Output values file ---------------------------- 0.45s
2025-10-02 15:13:58.384994 | controller | kustomize_deploy : Ensure source files exists --------------------------- 0.45s
2025-10-02 15:13:58.384999 | controller | kustomize_deploy : Build kustomized content for examples/va/hci/control-plane/networking --- 0.45s
2025-10-02 15:13:58.385004 | controller | ci_gen_kustomize_values : Output values file ---------------------------- 0.43s
2025-10-02 15:13:58.385013 | controller | ci_gen_kustomize_values : Output values file ---------------------------- 0.43s
2025-10-02 15:13:58.385018 | controller | kustomize_deploy : Copy generated values for examples/va/hci ------------ 0.43s
2025-10-02 15:13:58.385024 | controller | ci_gen_kustomize_values : Output values file ---------------------------- 0.42s
2025-10-02 15:13:58.385033 | controller | ci_gen_kustomize_values : Generate CI snippet --------------------------- 0.42s
2025-10-02 15:13:58.385044 | controller | INFO     Running flexible_loop > cleanup
2025-10-02 15:13:58.385511 | controller | WARNING  Skipping, cleanup playbook not configured.
2025-10-02 15:13:58.386129 | controller | INFO     Writing /tmp/report.html report.
2025-10-02 15:13:58.866093 | controller | changed
2025-10-02 15:13:58.936582 | 
2025-10-02 15:13:58.936670 | PLAY RECAP
2025-10-02 15:13:58.936714 | controller | ok: 2 changed: 1 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0
2025-10-02 15:13:58.936739 | 
2025-10-02 15:13:59.033401 | RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-test.yml@main]
2025-10-02 15:13:59.034570 | POST-RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/collect-logs.yml@main]
2025-10-02 15:13:59.969641 | 
2025-10-02 15:13:59.969743 | PLAY [Run ci/playbooks/collect-logs.yml]
2025-10-02 15:13:59.991601 | 
2025-10-02 15:13:59.991729 | TASK [Filter out host if needed]
2025-10-02 15:14:00.000825 | controller | skipping: end_host conditional evaluated to False, continuing execution for controller
2025-10-02 15:14:00.006109 | 
2025-10-02 15:14:00.006222 | TASK [Ensure file is present]
2025-10-02 15:14:00.452674 | controller | ok
2025-10-02 15:14:00.464379 | 
2025-10-02 15:14:00.464486 | TASK [Manage molecule report file]
2025-10-02 15:14:01.059601 | controller | changed
2025-10-02 15:14:01.065388 | 
2025-10-02 15:14:01.065476 | TASK [Check if we get ci-framework-data basedir]
2025-10-02 15:14:01.268872 | controller | ok
2025-10-02 15:14:01.274295 | 
2025-10-02 15:14:01.274374 | TASK [Create ci-framework-data log directory for zuul]
2025-10-02 15:14:01.632055 | controller | changed
2025-10-02 15:14:01.637590 | 
2025-10-02 15:14:01.637663 | TASK [Copy ci-framework interesting files]
2025-10-02 15:14:01.908394 | controller | cp: cannot stat '/home/zuul/ci-framework-data/tests': No such file or directory
2025-10-02 15:14:02.180839 | controller | changed
2025-10-02 15:14:02.186569 | 
2025-10-02 15:14:02.186638 | TASK [Get SELinux listing]
2025-10-02 15:14:02.728616 | controller | changed
2025-10-02 15:14:02.734812 | 
2025-10-02 15:14:02.734899 | TASK [Generate log index]
2025-10-02 15:14:03.773158 | controller | changed
2025-10-02 15:14:03.778303 | 
2025-10-02 15:14:03.778385 | TASK [Get some env related data]
2025-10-02 15:14:04.411450 | controller | /home/zuul/.local/bin/ansible
2025-10-02 15:14:05.371411 | controller | changed
2025-10-02 15:14:05.376719 | 
2025-10-02 15:14:05.376798 | TASK [Generate list of logs to collect in home directory]
2025-10-02 15:14:05.809453 | controller | ok: All paths examined
2025-10-02 15:14:05.844303 | 
2025-10-02 15:14:05.844398 | LOOP [Copy logs from home directory]
2025-10-02 15:14:06.171070 | controller | changed:
2025-10-02 15:14:06.171210 | controller | {
2025-10-02 15:14:06.171239 | controller |   "atime": 1759417921.9759471,
2025-10-02 15:14:06.171261 | controller |   "ctime": 1759417943.0231788,
2025-10-02 15:14:06.171279 | controller |   "dev": 64513,
2025-10-02 15:14:06.171296 | controller |   "gid": 1000,
2025-10-02 15:14:06.171313 | controller |   "gr_name": "zuul",
2025-10-02 15:14:06.171329 | controller |   "inode": 4454766,
2025-10-02 15:14:06.171345 | controller |   "isblk": false,
2025-10-02 15:14:06.171362 | controller |   "ischr": false,
2025-10-02 15:14:06.171377 | controller |   "isdir": false,
2025-10-02 15:14:06.171391 | controller |   "isfifo": false,
2025-10-02 15:14:06.171406 | controller |   "isgid": false,
2025-10-02 15:14:06.171421 | controller |   "islnk": false,
2025-10-02 15:14:06.171451 | controller |   "isreg": true,
2025-10-02 15:14:06.171468 | controller |   "issock": false,
2025-10-02 15:14:06.171483 | controller |   "isuid": false,
2025-10-02 15:14:06.171497 | controller |   "mode": "0644",
2025-10-02 15:14:06.171513 | controller |   "mtime": 1759417943.0231788,
2025-10-02 15:14:06.171528 | controller |   "nlink": 1,
2025-10-02 15:14:06.171543 | controller |   "path": "/home/zuul/ansible.log",
2025-10-02 15:14:06.171559 | controller |   "pw_name": "zuul",
2025-10-02 15:14:06.171574 | controller |   "rgrp": true,
2025-10-02 15:14:06.171589 | controller |   "roth": true,
2025-10-02 15:14:06.171605 | controller |   "rusr": true,
2025-10-02 15:14:06.171621 | controller |   "size": 6749,
2025-10-02 15:14:06.171636 | controller |   "uid": 1000,
2025-10-02 15:14:06.171651 | controller |   "wgrp": false,
2025-10-02 15:14:06.171665 | controller |   "woth": false,
2025-10-02 15:14:06.171682 | controller |   "wusr": true,
2025-10-02 15:14:06.171698 | controller |   "xgrp": false,
2025-10-02 15:14:06.171713 | controller |   "xoth": false,
2025-10-02 15:14:06.171728 | controller |   "xusr": false
2025-10-02 15:14:06.171743 | controller | }
2025-10-02 15:14:06.178496 | 
2025-10-02 15:14:06.178601 | TASK [Copy crio stats log file]
2025-10-02 15:14:06.202579 | controller | skipping: Conditional result was False
2025-10-02 15:14:06.209975 | 
2025-10-02 15:14:06.210050 | TASK [Get SELinux related data]
2025-10-02 15:14:06.459651 | controller | <no matches>
2025-10-02 15:14:06.763289 | controller | ERROR
2025-10-02 15:14:06.763475 | controller | {
2025-10-02 15:14:06.763509 | controller |   "delta": "0:00:00.008850",
2025-10-02 15:14:06.763533 | controller |   "end": "2025-10-02 15:14:06.460636",
2025-10-02 15:14:06.763553 | controller |   "msg": "non-zero return code",
2025-10-02 15:14:06.763571 | controller |   "rc": 1,
2025-10-02 15:14:06.763589 | controller |   "start": "2025-10-02 15:14:06.451786"
2025-10-02 15:14:06.763606 | controller | }
2025-10-02 15:14:06.763628 | controller | ERROR: Ignoring Errors
2025-10-02 15:14:06.769448 | 
2025-10-02 15:14:06.769525 | TASK [Create system configuration directory]
2025-10-02 15:14:06.993049 | controller | changed
2025-10-02 15:14:06.998237 | 
2025-10-02 15:14:06.998310 | TASK [Get some of the system configurations]
2025-10-02 15:14:07.550329 | controller | changed
2025-10-02 15:14:07.555849 | 
2025-10-02 15:14:07.555940 | TASK [Copy generated documentation if available]
2025-10-02 15:14:07.602532 | controller | skipping: Conditional result was False
2025-10-02 15:14:07.608425 | 
2025-10-02 15:14:07.608508 | TASK [Copy generated AsciiDoc documentation if available]
2025-10-02 15:14:07.648640 | controller | skipping: Conditional result was False
2025-10-02 15:14:07.654681 | 
2025-10-02 15:14:07.654747 | TASK [Compress logs bigger than 2MB]
2025-10-02 15:14:08.225712 | controller | changed
2025-10-02 15:14:08.231269 | 
2025-10-02 15:14:08.231353 | TASK [Copy files from workspace on node]
2025-10-02 15:14:08.291614 | controller | ok
2025-10-02 15:14:08.336696 | 
2025-10-02 15:14:08.336805 | TASK [fetch-output : Set log path for multiple nodes]
2025-10-02 15:14:08.400890 | controller | skipping: Conditional result was False
2025-10-02 15:14:08.407596 | 
2025-10-02 15:14:08.407682 | TASK [fetch-output : Set log path for single node]
2025-10-02 15:14:08.477306 | controller | ok
2025-10-02 15:14:08.483522 | 
2025-10-02 15:14:08.483619 | LOOP [fetch-output : Ensure local output dirs]
2025-10-02 15:14:08.992279 | controller -> localhost | ok: "/var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/logs"
2025-10-02 15:14:08.992529 | controller -> localhost | changed: All items complete
2025-10-02 15:14:08.992561 | 
2025-10-02 15:14:09.292103 | controller -> localhost | changed: "/var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/artifacts"
2025-10-02 15:14:09.849412 | controller -> localhost | changed: "/var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/docs"
2025-10-02 15:14:09.858663 | 
2025-10-02 15:14:09.858768 | LOOP [fetch-output : Collect logs, artifacts and docs]
2025-10-02 15:14:10.825813 | controller | changed:
2025-10-02 15:14:10.826005 | controller | .d..t...... ./
2025-10-02 15:14:10.826039 | controller | >f+++++++++ README.html
2025-10-02 15:14:10.826064 | controller | >f+++++++++ ansible-execution.log
2025-10-02 15:14:10.826087 | controller | >f+++++++++ ansible.log
2025-10-02 15:14:10.826109 | controller | >f+++++++++ dmesg.log
2025-10-02 15:14:10.826129 | controller | >f+++++++++ installed-pkgs.log
2025-10-02 15:14:10.826151 | controller | >f+++++++++ python.log
2025-10-02 15:14:10.826173 | controller | >f+++++++++ registries.conf
2025-10-02 15:14:10.826193 | controller | >f+++++++++ report.html
2025-10-02 15:14:10.826215 | controller | >f+++++++++ selinux-denials.log
2025-10-02 15:14:10.826234 | controller | >f+++++++++ selinux-listing.log
2025-10-02 15:14:10.826253 | controller | cd+++++++++ ci-framework-data/
2025-10-02 15:14:10.826271 | controller | cd+++++++++ ci-framework-data/artifacts/
2025-10-02 15:14:10.826288 | controller | >f+++++++++ ci-framework-data/artifacts/nova_migration_key
2025-10-02 15:14:10.826306 | controller | >f+++++++++ ci-framework-data/artifacts/nova_migration_key.pub
2025-10-02 15:14:10.826322 | controller | >f+++++++++ ci-framework-data/artifacts/user_key
2025-10-02 15:14:10.826339 | controller | >f+++++++++ ci-framework-data/artifacts/user_key.pub
2025-10-02 15:14:10.826356 | controller | >f+++++++++ ci-framework-data/artifacts/zuul_inventory.yml
2025-10-02 15:14:10.826372 | controller | cd+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/
2025-10-02 15:14:10.826389 | controller | cd+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/edpm-deployment-values-post-ceph/
2025-10-02 15:14:10.826407 | controller | >f+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/edpm-deployment-values-post-ceph/values.yaml
2025-10-02 15:14:10.826425 | controller | cd+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/edpm-deployment-values/
2025-10-02 15:14:10.826459 | controller | >f+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/edpm-deployment-values/values.yaml
2025-10-02 15:14:10.826480 | controller | cd+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/edpm-nodeset-values-post-ceph/
2025-10-02 15:14:10.826498 | controller | >f+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/edpm-nodeset-values-post-ceph/values.yaml
2025-10-02 15:14:10.826515 | controller | cd+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/edpm-nodeset-values/
2025-10-02 15:14:10.826539 | controller | >f+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/edpm-nodeset-values/values.yaml
2025-10-02 15:14:10.826557 | controller | cd+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/network-values/
2025-10-02 15:14:10.826574 | controller | >f+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/network-values/values.yaml
2025-10-02 15:14:10.826591 | controller | cd+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/service-values/
2025-10-02 15:14:10.826607 | controller | >f+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/service-values/values.yaml
2025-10-02 15:14:10.826623 | controller | >f+++++++++ ci-framework-data/artifacts/ci_gen_kustomize_values/service-values/values.yaml.28946.2025-10-02@15:13:46~
2025-10-02 15:14:10.826639 | controller | cd+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/
2025-10-02 15:14:10.826656 | controller | cd+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values-post-ceph/
2025-10-02 15:14:10.826672 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values-post-ceph/01_original.yaml
2025-10-02 15:14:10.826688 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values-post-ceph/03_user_data_b64.yaml
2025-10-02 15:14:10.826707 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values-post-ceph/04_user_data.yaml
2025-10-02 15:14:10.826725 | controller | cd+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values/
2025-10-02 15:14:10.826742 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values/01_original.yaml
2025-10-02 15:14:10.826759 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values/03_user_data_b64.yaml
2025-10-02 15:14:10.826776 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-deployment-values/04_user_data.yaml
2025-10-02 15:14:10.826792 | controller | cd+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values-post-ceph/
2025-10-02 15:14:10.826808 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values-post-ceph/01_original.yaml
2025-10-02 15:14:10.826825 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values-post-ceph/03_user_data_b64.yaml
2025-10-02 15:14:10.826840 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values-post-ceph/04_user_data.yaml
2025-10-02 15:14:10.826856 | controller | cd+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values/
2025-10-02 15:14:10.826871 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values/01_original.yaml
2025-10-02 15:14:10.826886 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values/02_ci_data.yaml
2025-10-02 15:14:10.826903 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values/03_user_data_b64.yaml
2025-10-02 15:14:10.826958 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/edpm-nodeset-values/04_user_data.yaml
2025-10-02 15:14:10.826981 | controller | cd+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/network-values/
2025-10-02 15:14:10.827000 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/network-values/01_original.yaml
2025-10-02 15:14:10.827017 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/network-values/01_original.yaml.27203.2025-10-02@15:13:13~
2025-10-02 15:14:10.827034 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/network-values/02_ci_data.yaml
2025-10-02 15:14:10.827050 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/network-values/03_user_data_b64.yaml
2025-10-02 15:14:10.827065 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/network-values/04_user_data.yaml
2025-10-02 15:14:10.827081 | controller | cd+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/service-values/
2025-10-02 15:14:10.827101 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/service-values/01_original.yaml
2025-10-02 15:14:10.827118 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/service-values/01_original.yaml.28855.2025-10-02@15:13:44~
2025-10-02 15:14:10.827136 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/service-values/03_user_data_b64.yaml
2025-10-02 15:14:10.827153 | controller | >f+++++++++ ci-framework-data/artifacts/ci_k8s_snippets/service-values/04_user_data.yaml
2025-10-02 15:14:10.827171 | controller | cd+++++++++ ci-framework-data/artifacts/kustomize_deploy/
2025-10-02 15:14:10.827187 | controller | >f+++++++++ ci-framework-data/artifacts/kustomize_deploy/control-plane.yaml
2025-10-02 15:14:10.827204 | controller | >f+++++++++ ci-framework-data/artifacts/kustomize_deploy/deployment-post-ceph.yaml
2025-10-02 15:14:10.827220 | controller | >f+++++++++ ci-framework-data/artifacts/kustomize_deploy/deployment-pre-ceph.yaml
2025-10-02 15:14:10.827235 | controller | >f+++++++++ ci-framework-data/artifacts/kustomize_deploy/network.yaml
2025-10-02 15:14:10.827251 | controller | >f+++++++++ ci-framework-data/artifacts/kustomize_deploy/nncp.yaml
2025-10-02 15:14:10.827266 | controller | >f+++++++++ ci-framework-data/artifacts/kustomize_deploy/nodeset-post-ceph.yaml
2025-10-02 15:14:10.827282 | controller | >f+++++++++ ci-framework-data/artifacts/kustomize_deploy/nodeset-pre-ceph.yaml
2025-10-02 15:14:10.827298 | controller | cd+++++++++ ci-framework-data/artifacts/manifests/
2025-10-02 15:14:10.827314 | controller | cd+++++++++ ci-framework-data/artifacts/manifests/openstack/
2025-10-02 15:14:10.827329 | controller | cd+++++++++ ci-framework-data/artifacts/manifests/openstack/cr/
2025-10-02 15:14:10.827353 | controller | cd+++++++++ ci-framework-data/artifacts/parameters/
2025-10-02 15:14:10.827375 | controller | >f+++++++++ ci-framework-data/artifacts/parameters/zuul-params.yml
2025-10-02 15:14:10.827398 | controller | cd+++++++++ ci-framework-data/logs/
2025-10-02 15:14:10.827419 | controller | >f+++++++++ ci-framework-data/logs/molecule-execution.log
2025-10-02 15:14:10.827448 | controller | cd+++++++++ registries.conf.d/
2025-10-02 15:14:10.827472 | controller | >f+++++++++ registries.conf.d/000-shortnames.conf
2025-10-02 15:14:10.827494 | controller | cd+++++++++ system-config/
2025-10-02 15:14:10.827516 | controller | cd+++++++++ system-config/libvirt/
2025-10-02 15:14:10.827537 | controller | >f+++++++++ system-config/libvirt/libvirt-admin.conf
2025-10-02 15:14:10.827558 | controller | >f+++++++++ system-config/libvirt/libvirt.conf
2025-10-02 15:14:11.681394 | controller | changed: .d..t...... ./
2025-10-02 15:14:12.395588 | controller | changed: .d..t...... ./
2025-10-02 15:14:12.418567 | 
2025-10-02 15:14:12.418663 | TASK [Return artifact to Zuul]
2025-10-02 15:14:12.497625 | controller | ok
2025-10-02 15:14:12.559804 | 
2025-10-02 15:14:12.559922 | PLAY [Run ci/playbooks/collect-logs.yml on CRC host]
2025-10-02 15:14:12.560044 | 
2025-10-02 15:14:12.560074 | PLAY RECAP
2025-10-02 15:14:12.560114 | controller | ok: 18 changed: 13 unreachable: 0 failed: 0 skipped: 4 rescued: 0 ignored: 1
2025-10-02 15:14:12.560137 | 
2025-10-02 15:14:12.739172 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/collect-logs.yml@main]
2025-10-02 15:14:12.739893 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-ssh.yaml@master]
2025-10-02 15:14:13.925875 | 
2025-10-02 15:14:13.926028 | PLAY [all]
2025-10-02 15:14:13.971167 | 
2025-10-02 15:14:13.971283 | TASK [include_role : fetch-output]
2025-10-02 15:14:14.022446 | controller | ok
2025-10-02 15:14:14.043716 | 
2025-10-02 15:14:14.043846 | TASK [fetch-output : Set log path for multiple nodes]
2025-10-02 15:14:14.110829 | controller | skipping: Conditional result was False
2025-10-02 15:14:14.116708 | 
2025-10-02 15:14:14.116800 | TASK [fetch-output : Set log path for single node]
2025-10-02 15:14:14.185600 | controller | ok
2025-10-02 15:14:14.191941 | 
2025-10-02 15:14:14.192030 | LOOP [fetch-output : Ensure local output dirs]
2025-10-02 15:14:14.943077 | controller -> localhost | ok: "/var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/logs"
2025-10-02 15:14:15.360025 | controller -> localhost | ok: "/var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/artifacts"
2025-10-02 15:14:15.946642 | controller -> localhost | ok: "/var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/docs"
2025-10-02 15:14:15.962340 | 
2025-10-02 15:14:15.962461 | LOOP [fetch-output : Collect logs, artifacts and docs]
2025-10-02 15:14:17.234853 | controller | ok
2025-10-02 15:14:17.235085 | controller | ok: All items complete
2025-10-02 15:14:17.235121 | 
2025-10-02 15:14:18.146924 | controller | ok
2025-10-02 15:14:19.038840 | controller | ok
2025-10-02 15:14:19.056345 | 
2025-10-02 15:14:19.056461 | TASK [include_role : fetch-output-openshift]
2025-10-02 15:14:19.119667 | controller | skipping: Conditional result was False
2025-10-02 15:14:19.125983 | 
2025-10-02 15:14:19.126062 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir]
2025-10-02 15:14:19.856707 | controller -> localhost | ok: Item: artifacts Runtime: 0:00:00.053562
2025-10-02 15:14:20.458283 | controller -> localhost | ok: Item: docs Runtime: 0:00:00.047220
2025-10-02 15:14:20.550414 | 
2025-10-02 15:14:20.550521 | PLAY [all]
2025-10-02 15:14:20.591454 | 
2025-10-02 15:14:20.591937 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes]
2025-10-02 15:14:21.280691 | controller | changed
2025-10-02 15:14:21.340164 | 
2025-10-02 15:14:21.340260 | PLAY RECAP
2025-10-02 15:14:21.340306 | controller | ok: 5 changed: 2 unreachable: 0 failed: 0 skipped: 2 rescued: 0 ignored: 0
2025-10-02 15:14:21.340330 | 
2025-10-02 15:14:21.519343 | POST-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-ssh.yaml@master]
2025-10-02 15:14:21.523128 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-logs.yaml@master]
2025-10-02 15:14:22.631955 | 
2025-10-02 15:14:22.632073 | PLAY [localhost]
2025-10-02 15:14:22.656031 | 
2025-10-02 15:14:22.656147 | TASK [generate-zuul-manifest : Generate Zuul manifest]
2025-10-02 15:14:23.167622 | localhost | changed
2025-10-02 15:14:23.173419 | 
2025-10-02 15:14:23.173538 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul]
2025-10-02 15:14:23.220321 | localhost | ok
2025-10-02 15:14:23.233654 | 
2025-10-02 15:14:23.233762 | TASK [add-fileserver : Create SSH private key tempfile]
2025-10-02 15:14:24.093324 | localhost | changed
2025-10-02 15:14:24.098155 | 
2025-10-02 15:14:24.098248 | TASK [add-fileserver : Create SSH private key from secret]
2025-10-02 15:14:25.450033 | localhost | changed
2025-10-02 15:14:25.455308 | 
2025-10-02 15:14:25.455379 | TASK [add-fileserver : Add fileserver ssh key]
2025-10-02 15:14:26.394094 | localhost | Identity added: /var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/tmp/ansible.9dp_qdaf (/var/lib/zuul/builds/1d44bb237e0f432c90a9a014aa6654f6/work/tmp/ansible.9dp_qdaf)
2025-10-02 15:14:26.394297 | localhost | ok: Runtime: 0:00:00.010955
2025-10-02 15:14:26.398649 | 
2025-10-02 15:14:26.398719 | TASK [add-fileserver : Remove SSH private key from disk]
2025-10-02 15:14:26.955350 | localhost | ok: Runtime: 0:00:00.015209
2025-10-02 15:14:26.960934 | 
2025-10-02 15:14:26.961018 | TASK [add-fileserver : Add fileserver to inventory]
2025-10-02 15:14:27.085784 | localhost | changed
2025-10-02 15:14:27.090271 | 
2025-10-02 15:14:27.090348 | TASK [add-fileserver : Add fileserver server to known hosts]
2025-10-02 15:14:28.195300 | localhost | changed
2025-10-02 15:14:28.284320 | 
2025-10-02 15:14:28.284406 | PLAY [localhost]
2025-10-02 15:14:28.336622 | 
2025-10-02 15:14:28.336767 | TASK [Generate bulk log download script]
2025-10-02 15:14:28.411369 | localhost | ok
2025-10-02 15:14:28.536669 | 
2025-10-02 15:14:28.536775 | TASK [local-log-download : Check API endpoint is defined]
2025-10-02 15:14:28.604810 | localhost | ok: All assertions passed
2025-10-02 15:14:28.610172 | 
2025-10-02 15:14:28.611754 | TASK [local-log-download : Create download script]
2025-10-02 15:14:29.776013 | localhost -> localhost | changed
2025-10-02 15:14:29.785068 | 
2025-10-02 15:14:29.785159 | TASK [Register quick-download link]
2025-10-02 15:14:29.838508 | localhost | ok
2025-10-02 15:14:29.871397 | 
2025-10-02 15:14:29.871492 | PLAY [logserver.rdoproject.org]
2025-10-02 15:14:29.887459 | 
2025-10-02 15:14:29.887531 | TASK [Set zuul-log-path fact]
2025-10-02 15:14:29.936787 | logserver.rdoproject.org | ok
2025-10-02 15:14:29.950878 | 
2025-10-02 15:14:29.950976 | TASK [set-zuul-log-path-fact : Set log path for a build]
2025-10-02 15:14:29.997632 | logserver.rdoproject.org | ok
2025-10-02 15:14:30.004942 | 
2025-10-02 15:14:30.005074 | TASK [upload-logs : Create log directories]
2025-10-02 15:14:31.824938 | logserver.rdoproject.org | changed
2025-10-02 15:14:31.832163 | 
2025-10-02 15:14:31.832242 | TASK [upload-logs : Ensure logs are readable before uploading]
2025-10-02 15:14:32.598772 | logserver.rdoproject.org -> localhost | ok: Runtime: 0:00:00.065872
2025-10-02 15:14:32.604391 | 
2025-10-02 15:14:32.604494 | TASK [upload-logs : Upload logs to log server]
2025-10-02 15:14:34.770060 | logserver.rdoproject.org | Output suppressed because no_log was given
2025-10-02 15:14:34.773629 | 
2025-10-02 15:14:34.773695 | LOOP [upload-logs : Compress console log and json output]
2025-10-02 15:14:34.872180 | logserver.rdoproject.org | skipping: Conditional result was False
2025-10-02 15:14:34.872880 | logserver.rdoproject.org | skipping: Conditional result was False
2025-10-02 15:14:34.883069 | 
2025-10-02 15:14:34.883141 | LOOP [upload-logs : Upload compressed console log and json output]
2025-10-02 15:14:35.011072 | logserver.rdoproject.org | skipping: Conditional result was False
2025-10-02 15:14:35.011310 | 
2025-10-02 15:14:35.021423 | logserver.rdoproject.org | skipping: Conditional result was False
2025-10-02 15:14:35.030213 | 
2025-10-02 15:14:35.030296 | LOOP [upload-logs : Upload console log and json output]