2026-05-05 03:15:29.192184 | Job console starting
2026-05-05 03:15:29.201768 | Updating git repos
2026-05-05 03:15:29.244512 | Cloning repos into workspace
2026-05-05 03:15:29.347567 | Restoring repo states
2026-05-05 03:15:29.370565 | Merging changes
2026-05-05 03:15:29.370589 | Checking out repos
2026-05-05 03:15:29.460344 | Preparing playbooks
2026-05-05 03:15:30.816189 | Running Ansible setup
2026-05-05 03:15:36.753424 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main]
2026-05-05 03:15:38.240141 | 
2026-05-05 03:15:38.240282 | PLAY [Base pre]
2026-05-05 03:15:38.300166 | 
2026-05-05 03:15:38.300293 | TASK [Setup log path fact]
2026-05-05 03:15:38.345678 | debian-bookworm | ok
2026-05-05 03:15:38.368481 | 
2026-05-05 03:15:38.368616 | TASK [set-zuul-log-path-fact : Set log path for a build]
2026-05-05 03:15:38.432714 | debian-bookworm | ok
2026-05-05 03:15:38.440649 | 
2026-05-05 03:15:38.440751 | TASK [emit-job-header : Print job information]
2026-05-05 03:15:38.505283 | # Job Information
2026-05-05 03:15:38.505427 | Ansible Version: 2.16.14
2026-05-05 03:15:38.505457 | Job: python-black
2026-05-05 03:15:38.505485 | Pipeline: periodic-daily
2026-05-05 03:15:38.505504 | Executor: 521e9411259a
2026-05-05 03:15:38.505522 | Triggered by: https://github.com/osism/cinder-driver-dm-clone
2026-05-05 03:15:38.505541 | Event ID: f1a8c591d0fb4d9aaaa050d4e25bac49
2026-05-05 03:15:38.509489 | 
2026-05-05 03:15:38.509572 | LOOP [emit-job-header : Print node information]
2026-05-05 03:15:38.896858 | debian-bookworm | ok:
2026-05-05 03:15:38.897062 | debian-bookworm | # Node Information
2026-05-05 03:15:38.897098 | debian-bookworm | Inventory Hostname: debian-bookworm
2026-05-05 03:15:38.897125 | debian-bookworm | Hostname: debian
2026-05-05 03:15:38.897147 | debian-bookworm | Username: zuul
2026-05-05 03:15:38.897168 | debian-bookworm | Distro: Debian 12.13
2026-05-05 03:15:38.897192 | debian-bookworm | Provider: regiocloud-a
2026-05-05 03:15:38.897214 | debian-bookworm | Region:
2026-05-05 03:15:38.897236 | debian-bookworm | Label: debian-bookworm
2026-05-05 03:15:38.897255 | debian-bookworm | Product Name: OpenStack Nova
2026-05-05 03:15:38.897275 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe17:9a7e
2026-05-05 03:15:38.913768 | 
2026-05-05 03:15:38.913911 | TASK [log-inventory : Ensure Zuul Ansible directory exists]
2026-05-05 03:15:40.137128 | debian-bookworm -> localhost | changed
2026-05-05 03:15:40.172490 | 
2026-05-05 03:15:40.173086 | TASK [log-inventory : Copy ansible inventory to logs dir]
2026-05-05 03:15:42.576029 | debian-bookworm -> localhost | changed
2026-05-05 03:15:42.591250 | 
2026-05-05 03:15:42.591369 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build]
2026-05-05 03:15:43.202641 | debian-bookworm -> localhost | ok
2026-05-05 03:15:43.208987 | 
2026-05-05 03:15:43.209100 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID]
2026-05-05 03:15:43.232732 | debian-bookworm | ok
2026-05-05 03:15:43.250611 | debian-bookworm | included: /var/lib/zuul/builds/b0e0bf81413c40fe9772ecb67af88ef1/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml
2026-05-05 03:15:43.260185 | 
2026-05-05 03:15:43.260284 | TASK [add-build-sshkey : Create Temp SSH key]
2026-05-05 03:15:45.724775 | debian-bookworm -> localhost | Generating public/private rsa key pair.
2026-05-05 03:15:45.724998 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/b0e0bf81413c40fe9772ecb67af88ef1/work/b0e0bf81413c40fe9772ecb67af88ef1_id_rsa
2026-05-05 03:15:45.725037 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/b0e0bf81413c40fe9772ecb67af88ef1/work/b0e0bf81413c40fe9772ecb67af88ef1_id_rsa.pub
2026-05-05 03:15:45.725062 | debian-bookworm -> localhost | The key fingerprint is:
2026-05-05 03:15:45.725085 | debian-bookworm -> localhost | SHA256:q0wi1nrnaDJ9y1y07ZANQPyOoKJMxrIxltNA7Wh5swE zuul-build-sshkey
2026-05-05 03:15:45.725107 | debian-bookworm -> localhost | The key's randomart image is:
2026-05-05 03:15:45.725139 | debian-bookworm -> localhost | +---[RSA 3072]----+
2026-05-05 03:15:45.725161 | debian-bookworm -> localhost | |  .  ..          |
2026-05-05 03:15:45.725182 | debian-bookworm -> localhost | | E . ..          |
2026-05-05 03:15:45.725201 | debian-bookworm -> localhost | |. =   ..         |
2026-05-05 03:15:45.725220 | debian-bookworm -> localhost | | = =.  ..        |
2026-05-05 03:15:45.725240 | debian-bookworm -> localhost | |o =.+. oS        |
2026-05-05 03:15:45.725266 | debian-bookworm -> localhost | |=B.+  ...B       |
2026-05-05 03:15:45.725286 | debian-bookworm -> localhost | |B=+.o . * o      |
2026-05-05 03:15:45.725306 | debian-bookworm -> localhost | |oooo+Boo o       |
2026-05-05 03:15:45.725326 | debian-bookworm -> localhost | |  .=.+B.  .      |
2026-05-05 03:15:45.725345 | debian-bookworm -> localhost | +----[SHA256]-----+
2026-05-05 03:15:45.725395 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.519246
2026-05-05 03:15:45.732957 | 
2026-05-05 03:15:45.733061 | TASK [add-build-sshkey : Remote setup ssh keys (linux)]
2026-05-05 03:15:45.771338 | debian-bookworm | ok
2026-05-05 03:15:45.787099 | debian-bookworm | included: /var/lib/zuul/builds/b0e0bf81413c40fe9772ecb67af88ef1/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml
2026-05-05 03:15:45.796098 | 
2026-05-05 03:15:45.796198 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey]
2026-05-05 03:15:45.819109 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:15:45.824952 | 
2026-05-05 03:15:45.825054 | TASK [add-build-sshkey : Enable access via build key on all nodes]
2026-05-05 03:15:46.702274 | debian-bookworm | changed
2026-05-05 03:15:46.715688 | 
2026-05-05 03:15:46.715801 | TASK [add-build-sshkey : Make sure user has a .ssh]
2026-05-05 03:15:47.019862 | debian-bookworm | ok
2026-05-05 03:15:47.026644 | 
2026-05-05 03:15:47.026751 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes]
2026-05-05 03:15:47.764644 | debian-bookworm | changed
2026-05-05 03:15:47.774941 | 
2026-05-05 03:15:47.775058 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes]
2026-05-05 03:15:48.535868 | debian-bookworm | changed
2026-05-05 03:15:48.555028 | 
2026-05-05 03:15:48.555476 | TASK [add-build-sshkey : Remote setup ssh keys (windows)]
2026-05-05 03:15:48.594470 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:15:48.601330 | 
2026-05-05 03:15:48.601436 | TASK [remove-zuul-sshkey : Remove master key from local agent]
2026-05-05 03:15:49.656296 | debian-bookworm -> localhost | changed
2026-05-05 03:15:49.666599 | 
2026-05-05 03:15:49.666699 | TASK [add-build-sshkey : Add back temp key]
2026-05-05 03:15:50.022816 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/b0e0bf81413c40fe9772ecb67af88ef1/work/b0e0bf81413c40fe9772ecb67af88ef1_id_rsa (zuul-build-sshkey)
2026-05-05 03:15:50.023058 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.008524
2026-05-05 03:15:50.030576 | 
2026-05-05 03:15:50.030680 | TASK [add-build-sshkey : Verify we can still SSH to all nodes]
2026-05-05 03:15:50.503736 | debian-bookworm | ok
2026-05-05 03:15:50.508700 | 
2026-05-05 03:15:50.508809 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)]
2026-05-05 03:15:50.562106 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:15:50.572298 | 
2026-05-05 03:15:50.572407 | TASK [start-zuul-console : Start zuul_console daemon.]
2026-05-05 03:15:51.160358 | debian-bookworm | ok
2026-05-05 03:15:51.174731 | 
2026-05-05 03:15:51.174896 | TASK [validate-host : Define zuul_info_dir fact]
2026-05-05 03:15:51.240518 | debian-bookworm | ok
2026-05-05 03:15:51.247772 | 
2026-05-05 03:15:51.247905 | TASK [validate-host : Ensure Zuul Ansible directory exists]
2026-05-05 03:15:51.719420 | debian-bookworm -> localhost | ok
2026-05-05 03:15:51.725129 | 
2026-05-05 03:15:51.725228 | TASK [validate-host : Collect information about the host]
2026-05-05 03:15:52.932838 | debian-bookworm | ok
2026-05-05 03:15:52.959651 | 
2026-05-05 03:15:52.959802 | TASK [validate-host : Sanitize hostname]
2026-05-05 03:15:53.230484 | debian-bookworm | ok
2026-05-05 03:15:53.311026 | 
2026-05-05 03:15:53.311137 | TASK [validate-host : Write out all ansible variables/facts known for each host]
2026-05-05 03:15:54.199308 | debian-bookworm -> localhost | changed
2026-05-05 03:15:54.211726 | 
2026-05-05 03:15:54.211841 | TASK [validate-host : Collect information about zuul worker]
2026-05-05 03:15:54.763433 | debian-bookworm | ok
2026-05-05 03:15:54.772152 | 
2026-05-05 03:15:54.772260 | TASK [validate-host : Write out all zuul information for each host]
2026-05-05 03:15:55.464715 | debian-bookworm -> localhost | changed
2026-05-05 03:15:55.473695 | 
2026-05-05 03:15:55.473796 | TASK [prepare-workspace-log : Start zuul_console daemon.]
2026-05-05 03:15:55.722213 | debian-bookworm | ok
2026-05-05 03:15:55.726566 | 
2026-05-05 03:15:55.726640 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.]
2026-05-05 03:15:56.477259 | debian-bookworm | changed:
2026-05-05 03:15:56.477425 | debian-bookworm | cd+++++++++ src/
2026-05-05 03:15:56.477458 | debian-bookworm | cd+++++++++ src/github.com/
2026-05-05 03:15:56.477482 | debian-bookworm | cd+++++++++ src/github.com/osism/
2026-05-05 03:15:56.477503 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/
2026-05-05 03:15:56.477523 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.flake8
2026-05-05 03:15:56.477542 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.zuul.yaml
2026-05-05 03:15:56.477561 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/LICENSE
2026-05-05 03:15:56.477580 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/README.md
2026-05-05 03:15:56.477598 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/
2026-05-05 03:15:56.477616 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/HEAD
2026-05-05 03:15:56.477634 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/ORIG_HEAD
2026-05-05 03:15:56.477651 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/config
2026-05-05 03:15:56.477669 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/config.worktree
2026-05-05 03:15:56.477688 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/description
2026-05-05 03:15:56.477707 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/index
2026-05-05 03:15:56.477726 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/packed-refs
2026-05-05 03:15:56.477744 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/branches/
2026-05-05 03:15:56.477762 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/
2026-05-05 03:15:56.477780 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/applypatch-msg.sample
2026-05-05 03:15:56.477799 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/commit-msg.sample
2026-05-05 03:15:56.477817 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/fsmonitor-watchman.sample
2026-05-05 03:15:56.477835 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/post-update.sample
2026-05-05 03:15:56.477852 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-applypatch.sample
2026-05-05 03:15:56.477882 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-commit.sample
2026-05-05 03:15:56.477902 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-merge-commit.sample
2026-05-05 03:15:56.477920 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-push.sample
2026-05-05 03:15:56.477946 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-rebase.sample
2026-05-05 03:15:56.477966 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-receive.sample
2026-05-05 03:15:56.477983 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/prepare-commit-msg.sample
2026-05-05 03:15:56.478001 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/push-to-checkout.sample
2026-05-05 03:15:56.478018 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/update.sample
2026-05-05 03:15:56.478036 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/info/
2026-05-05 03:15:56.478054 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/info/exclude
2026-05-05 03:15:56.478071 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/
2026-05-05 03:15:56.478088 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/HEAD
2026-05-05 03:15:56.478105 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/
2026-05-05 03:15:56.478122 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/heads/
2026-05-05 03:15:56.478140 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/heads/main
2026-05-05 03:15:56.478157 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/remotes/
2026-05-05 03:15:56.478174 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/remotes/origin/
2026-05-05 03:15:56.478191 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/remotes/origin/HEAD
2026-05-05 03:15:56.478209 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/
2026-05-05 03:15:56.478226 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/14/
2026-05-05 03:15:56.478243 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/14/e2c2920ba926041df3295b3280def4c83c4039
2026-05-05 03:15:56.478263 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/20/
2026-05-05 03:15:56.478280 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/20/459297831c4ce0d7ea29ed8c9114ba146a8527
2026-05-05 03:15:56.478298 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/53/
2026-05-05 03:15:56.478315 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/53/39a1f80707e8577fc545424370aeb556127e44
2026-05-05 03:15:56.478334 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/80/
2026-05-05 03:15:56.478352 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/80/08e23220f1962907e5e2f9f2d15728a2a19980
2026-05-05 03:15:56.478370 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/95/
2026-05-05 03:15:56.478387 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/95/ecda1bd613e629b0ab9f19ddf304ab5f994d60
2026-05-05 03:15:56.478404 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/b2/
2026-05-05 03:15:56.478422 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/b2/5fb3f40bf64cf874cf6e30b8dd8325d3f72992
2026-05-05 03:15:56.478439 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/b7/
2026-05-05 03:15:56.478457 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/b7/3d086ae32b25aaf6ab01121e7c74a51a08211e
2026-05-05 03:15:56.478474 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/ca/
2026-05-05 03:15:56.478494 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/ca/955504dc1be4f034729e036aac7fd53d85d0e2
2026-05-05 03:15:56.478512 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/f1/
2026-05-05 03:15:56.478529 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/f1/a71bda7721ff0db72982e936c2ab41ce720042
2026-05-05 03:15:56.478547 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/info/
2026-05-05 03:15:56.478564 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/pack/
2026-05-05 03:15:56.478581 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/pack/pack-fa180ec00da9f01d74bd13ec6c07652e2e797814.idx
2026-05-05 03:15:56.478599 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/pack/pack-fa180ec00da9f01d74bd13ec6c07652e2e797814.pack
2026-05-05 03:15:56.478616 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/refs/
2026-05-05 03:15:56.478633 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/
2026-05-05 03:15:56.478651 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/
2026-05-05 03:15:56.478669 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/drivers/
2026-05-05 03:15:56.478687 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/drivers/dmclone/
2026-05-05 03:15:56.478704 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/drivers/dmclone/__init__.py
2026-05-05 03:15:56.478722 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/drivers/dmclone/dmsetup.py
2026-05-05 03:15:56.478740 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/drivers/dmclone/driver.py
2026-05-05 03:15:56.489608 | 
2026-05-05 03:15:56.489718 | LOOP [ensure-output-dirs-present : Ensure Zuul output directories exist]
2026-05-05 03:15:56.796305 | debian-bookworm | changed: "logs"
2026-05-05 03:15:56.796526 | debian-bookworm | ok: All items complete
2026-05-05 03:15:56.796557 | 
2026-05-05 03:15:57.003788 | debian-bookworm | changed: "artifacts"
2026-05-05 03:15:57.244127 | debian-bookworm | changed: "docs"
2026-05-05 03:15:57.257397 | 
2026-05-05 03:15:57.257518 | TASK [ensure-hostname-resolves-locally : Ensure hostname resolves locally]
2026-05-05 03:15:57.540808 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known
2026-05-05 03:15:57.782299 | debian-bookworm | ok: Runtime: 0:00:00.049324
2026-05-05 03:15:57.790696 | 
2026-05-05 03:15:57.790796 | TASK [diagnose-first-sudo : Ensure log directory exists]
2026-05-05 03:15:58.042033 | debian-bookworm | ok
2026-05-05 03:15:58.047009 | 
2026-05-05 03:15:58.047102 | TASK [diagnose-first-sudo : Probe first sudo invocation under strace]
2026-05-05 03:15:58.580197 | debian-bookworm | ok: Runtime: 0:00:00.054115
2026-05-05 03:15:58.585220 | 
2026-05-05 03:15:58.585320 | TASK [diagnose-first-sudo : Snapshot DNS / PAM / logind state (no become)]
2026-05-05 03:15:59.134520 | debian-bookworm | ok: Runtime: 0:00:00.062219
2026-05-05 03:15:59.140662 | 
2026-05-05 03:15:59.140746 | PLAY RECAP
2026-05-05 03:15:59.140796 | debian-bookworm | ok: 31 changed: 14 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0
2026-05-05 03:15:59.140820 | 
2026-05-05 03:15:59.247550 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main]
2026-05-05 03:15:59.248460 | RUN START: [untrusted : github.com/osism/zuul-jobs/playbooks/python-black/run.yml@main]
2026-05-05 03:16:00.049203 | 
2026-05-05 03:16:00.049400 | PLAY [Install Black and format code]
2026-05-05 03:16:00.066508 | 
2026-05-05 03:16:00.066670 | LOOP [Install python]
2026-05-05 03:16:00.099543 | debian-bookworm | ok: "ensure-python"
2026-05-05 03:16:00.110667 | debian-bookworm | ok: "ensure-pip"
2026-05-05 03:16:00.165569 | 
2026-05-05 03:16:00.165782 | TASK [ensure-python : Validate python_version value]
2026-05-05 03:16:00.190369 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:00.198095 | 
2026-05-05 03:16:00.198251 | TASK [ensure-python : Install specified version of python interpreter and development files (DEB)]
2026-05-05 03:16:00.222259 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:00.228706 | 
2026-05-05 03:16:00.228875 | TASK [ensure-python : Pull in venv package]
2026-05-05 03:16:00.263092 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:00.270482 | 
2026-05-05 03:16:00.270629 | TASK [ensure-python : Set default RPM package name]
2026-05-05 03:16:00.294994 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:00.301249 | 
2026-05-05 03:16:00.301391 | TASK [ensure-python : Set RPM package name for CentOS/RHEL 9/10]
2026-05-05 03:16:00.325463 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:00.333732 | 
2026-05-05 03:16:00.333941 | TASK [ensure-python : Install RPM package]
2026-05-05 03:16:00.358137 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:00.365393 | 
2026-05-05 03:16:00.365542 | TASK [ensure-python : Install python using pyenv]
2026-05-05 03:16:00.380142 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:00.386851 | 
2026-05-05 03:16:00.387003 | TASK [ensure-python : Activate python using stow]
2026-05-05 03:16:00.432687 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:00.460654 | 
2026-05-05 03:16:00.460818 | TASK [ensure-pip : Check if pip is installed]
2026-05-05 03:16:01.498029 | debian-bookworm | ok: Runtime: 0:00:00.009594
2026-05-05 03:16:01.505152 | 
2026-05-05 03:16:01.505334 | LOOP [ensure-pip : Install pip from packages]
2026-05-05 03:16:01.560795 | debian-bookworm | ok: "/var/lib/zuul/builds/b0e0bf81413c40fe9772ecb67af88ef1/untrusted/project_2/github.com/osism/openinfra-zuul-jobs/roles/ensure-pip/tasks/Debian.yaml"
2026-05-05 03:16:01.561134 | debian-bookworm | ok: All items complete
2026-05-05 03:16:01.561191 | 
2026-05-05 03:16:01.581969 | debian-bookworm | included: /var/lib/zuul/builds/b0e0bf81413c40fe9772ecb67af88ef1/untrusted/project_2/github.com/osism/openinfra-zuul-jobs/roles/ensure-pip/tasks/Debian.yaml
2026-05-05 03:16:01.603931 | 
2026-05-05 03:16:01.604195 | TASK [ensure-pip : Update package lists]
2026-05-05 03:16:06.149056 | debian-bookworm | changed
2026-05-05 03:16:06.159230 | 
2026-05-05 03:16:06.159364 | TASK [ensure-pip : Install Python 3 pip]
2026-05-05 03:16:11.198912 | debian-bookworm | changed
2026-05-05 03:16:11.209642 | 
2026-05-05 03:16:11.209937 | TASK [ensure-pip : Install Python 2 pip]
2026-05-05 03:16:11.260163 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:11.271591 | 
2026-05-05 03:16:11.271799 | TASK [ensure-pip : Ensure setuptools]
2026-05-05 03:16:11.307203 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:11.322179 | 
2026-05-05 03:16:11.322367 | TASK [ensure-pip : Check for ensurepip module]
2026-05-05 03:16:11.696947 | debian-bookworm | usage: python -m ensurepip [-h] [--version] [-v] [-U] [--user] [--root ROOT]
2026-05-05 03:16:11.697175 | debian-bookworm |                            [--altinstall] [--default-pip]
2026-05-05 03:16:11.697201 | debian-bookworm |
2026-05-05 03:16:11.697218 | debian-bookworm | options:
2026-05-05 03:16:11.697237 | debian-bookworm |   -h, --help     show this help message and exit
2026-05-05 03:16:11.697258 | debian-bookworm |   --version      Show the version of pip that is bundled with this Python.
2026-05-05 03:16:11.697273 | debian-bookworm |   -v, --verbose  Give more output. Option is additive, and can be used up to 3
2026-05-05 03:16:11.697353 | debian-bookworm |                  times.
2026-05-05 03:16:11.697382 | debian-bookworm |   -U, --upgrade  Upgrade pip and dependencies, even if already installed.
2026-05-05 03:16:11.697398 | debian-bookworm |   --user         Install using the user scheme.
2026-05-05 03:16:11.697411 | debian-bookworm |   --root ROOT    Install everything relative to this alternate root directory.
2026-05-05 03:16:11.697424 | debian-bookworm |   --altinstall   Make an alternate install, installing only the X.Y versioned
2026-05-05 03:16:11.697436 | debian-bookworm |                  scripts (Default: pipX, pipX.Y, easy_install-X.Y).
2026-05-05 03:16:11.697447 | debian-bookworm |   --default-pip  Make a default pip install, installing the unqualified pip
2026-05-05 03:16:11.697459 | debian-bookworm |                  and easy_install in addition to the versioned scripts.
2026-05-05 03:16:11.857403 | debian-bookworm | ok: Runtime: 0:00:00.077692
2026-05-05 03:16:11.867444 | 
2026-05-05 03:16:11.867611 | TASK [ensure-pip : Ensure python3-venv]
2026-05-05 03:16:11.894561 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:11.908661 | 
2026-05-05 03:16:11.908843 | TASK [ensure-pip : Install pip from source]
2026-05-05 03:16:11.944271 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:11.956048 | 
2026-05-05 03:16:11.956242 | TASK [ensure-pip : Probe for venv python full path]
2026-05-05 03:16:12.253457 | debian-bookworm | /usr/bin/python3
2026-05-05 03:16:12.495111 | debian-bookworm | ok: Runtime: 0:00:00.009213
2026-05-05 03:16:12.507654 | 
2026-05-05 03:16:12.507895 | TASK [ensure-pip : Set host default]
2026-05-05 03:16:12.588012 | debian-bookworm | ok
2026-05-05 03:16:12.595759 | 
2026-05-05 03:16:12.595978 | TASK [ensure-pip : Set ensure_pip_virtualenv_command]
2026-05-05 03:16:12.669920 | debian-bookworm | ok
2026-05-05 03:16:12.745213 | 
2026-05-05 03:16:12.745418 | TASK [python-black : Install black]
2026-05-05 03:16:20.240416 | debian-bookworm | changed
2026-05-05 03:16:20.247505 | 
2026-05-05 03:16:20.247669 | TASK [python-black : Format code with Black if there is nothing to exclude]
2026-05-05 03:16:21.081598 | debian-bookworm | All done! ✨ 🍰 ✨
2026-05-05 03:16:21.081835 | debian-bookworm | 3 files would be left unchanged.
2026-05-05 03:16:21.308367 | debian-bookworm | ok: Runtime: 0:00:00.471644
2026-05-05 03:16:21.319929 | 
2026-05-05 03:16:21.320102 | TASK [python-black : Format code with Black if there is an exclusion]
2026-05-05 03:16:21.866268 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:21.877452 | 
2026-05-05 03:16:21.877598 | PLAY RECAP
2026-05-05 03:16:21.877663 | debian-bookworm | ok: 10 changed: 6 unreachable: 0 failed: 0 skipped: 13 rescued: 0 ignored: 0
2026-05-05 03:16:21.877688 | 
2026-05-05 03:16:22.151269 | RUN END RESULT_NORMAL: [untrusted : github.com/osism/zuul-jobs/playbooks/python-black/run.yml@main]
2026-05-05 03:16:22.152244 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-fetch.yaml@main]
2026-05-05 03:16:23.343830 | 
2026-05-05 03:16:23.344070 | PLAY [Base post-fetch]
2026-05-05 03:16:23.360721 | 
2026-05-05 03:16:23.360946 | TASK [fetch-output : Set log path for multiple nodes]
2026-05-05 03:16:23.447884 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:23.454024 | 
2026-05-05 03:16:23.454209 | TASK [fetch-output : Set log path for single node]
2026-05-05 03:16:23.524447 | debian-bookworm | ok
2026-05-05 03:16:23.535570 | 
2026-05-05 03:16:23.535722 | LOOP [fetch-output : Ensure local output dirs]
2026-05-05 03:16:24.409422 | debian-bookworm -> localhost | ok: "/var/lib/zuul/builds/b0e0bf81413c40fe9772ecb67af88ef1/work/logs"
2026-05-05 03:16:25.156594 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/b0e0bf81413c40fe9772ecb67af88ef1/work/artifacts"
2026-05-05 03:16:25.568373 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/b0e0bf81413c40fe9772ecb67af88ef1/work/docs"
2026-05-05 03:16:25.599575 | 
2026-05-05 03:16:25.599743 | LOOP [fetch-output : Collect logs, artifacts and docs]
2026-05-05 03:16:26.982152 | debian-bookworm | changed:
2026-05-05 03:16:26.982487 | debian-bookworm | .d..t...... ./
2026-05-05 03:16:26.982529 | debian-bookworm | >f+++++++++ sudo-debug.txt
2026-05-05 03:16:26.982559 | debian-bookworm | >f+++++++++ sudo-strace.log
2026-05-05 03:16:26.982586 | debian-bookworm | >f+++++++++ sudo-strace.log.time
2026-05-05 03:16:26.982631 | debian-bookworm | changed: All items complete
2026-05-05 03:16:26.982660 | 
2026-05-05 03:16:28.009556 | debian-bookworm | changed: .d..t...... ./
2026-05-05 03:16:28.922165 | debian-bookworm | changed: .d..t...... ./
2026-05-05 03:16:28.937823 | 
2026-05-05 03:16:28.937986 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir]
2026-05-05 03:16:28.991507 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:29.001500 | debian-bookworm | skipping: Conditional result was False
2026-05-05 03:16:29.029320 | 
2026-05-05 03:16:29.029430 | PLAY RECAP
2026-05-05 03:16:29.029497 | debian-bookworm | ok: 3 changed: 2 unreachable: 0 failed: 0 skipped: 2 rescued: 0 ignored: 0
2026-05-05 03:16:29.029526 | 
2026-05-05 03:16:29.257624 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post-fetch.yaml@main]
2026-05-05 03:16:29.258314 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main]
2026-05-05 03:16:30.177277 | 
2026-05-05 03:16:30.177424 | PLAY [Base post]
2026-05-05 03:16:30.191483 | 
2026-05-05 03:16:30.191617 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes]
2026-05-05 03:16:30.809634 | debian-bookworm | changed
2026-05-05 03:16:30.818411 | 
2026-05-05 03:16:30.818540 | PLAY RECAP
2026-05-05 03:16:30.818600 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-05-05 03:16:30.818662 | 
2026-05-05 03:16:30.940155 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main]
2026-05-05 03:16:30.940897 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main]
2026-05-05 03:16:31.905108 | 
2026-05-05 03:16:31.905250 | PLAY [Base post-logs]
2026-05-05 03:16:31.919186 | 
2026-05-05 03:16:31.919318 | TASK [generate-zuul-manifest : Generate Zuul manifest]
2026-05-05 03:16:32.439066 | localhost | changed
2026-05-05 03:16:32.455370 | 
2026-05-05 03:16:32.455520 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul]
2026-05-05 03:16:32.534356 | localhost | ok
2026-05-05 03:16:32.537463 | 
2026-05-05 03:16:32.537554 | TASK [Set zuul-log-path fact]
2026-05-05 03:16:32.562568 | localhost | ok
2026-05-05 03:16:32.570142 | 
2026-05-05 03:16:32.571351 | TASK [set-zuul-log-path-fact : Set log path for a build]
2026-05-05 03:16:32.606743 | localhost | ok
2026-05-05 03:16:32.609907 | 
2026-05-05 03:16:32.610012 | TASK [upload-logs : Create log directories]
2026-05-05 03:16:33.408024 | localhost | changed
2026-05-05 03:16:33.411047 | 
2026-05-05 03:16:33.411169 | TASK [upload-logs : Ensure logs are readable before uploading]
2026-05-05 03:16:34.445329 | localhost -> localhost | ok: Runtime: 0:00:00.023600
2026-05-05 03:16:34.451854 | 
2026-05-05 03:16:34.452004 | TASK [upload-logs : Upload logs to log server]
2026-05-05 03:16:35.608287 | localhost | Output suppressed because no_log was given
2026-05-05 03:16:35.612985 | 
2026-05-05 03:16:35.613168 | LOOP [upload-logs : Compress console log and json output]
2026-05-05 03:16:35.736455 | localhost | skipping: Conditional result was False
2026-05-05 03:16:35.771560 | localhost | skipping: Conditional result was False
2026-05-05 03:16:35.776625 | 
2026-05-05 03:16:35.776774 | LOOP [upload-logs : Upload compressed console log and json output]
2026-05-05 03:16:35.957000 | localhost | skipping: Conditional result was False
2026-05-05 03:16:35.959186 | 
2026-05-05 03:16:35.970175 | localhost | skipping: Conditional result was False
2026-05-05 03:16:35.980380 | 
2026-05-05 03:16:35.980527 | LOOP [upload-logs : Upload console log and json output]