I0730 21:07:24.119336       1 cephcsi.go:191] Driver version: v3.11.0 and Git version: bc24b5eca87626d690a29effa9d7420cc0154a7a
I0730 21:07:24.119458       1 cephcsi.go:223] Starting driver type: rbd with name: rbd.csi.ceph.com
I0730 21:07:24.119469       1 driver.go:95] Enabling controller service capability: CREATE_DELETE_VOLUME
I0730 21:07:24.119472       1 driver.go:95] Enabling controller service capability: CREATE_DELETE_SNAPSHOT
I0730 21:07:24.119475       1 driver.go:95] Enabling controller service capability: CLONE_VOLUME
I0730 21:07:24.119478       1 driver.go:95] Enabling controller service capability: EXPAND_VOLUME
I0730 21:07:24.119482       1 driver.go:108] Enabling volume access mode: SINGLE_NODE_WRITER
I0730 21:07:24.119485       1 driver.go:108] Enabling volume access mode: MULTI_NODE_MULTI_WRITER
I0730 21:07:24.119488       1 driver.go:108] Enabling volume access mode: SINGLE_NODE_SINGLE_WRITER
I0730 21:07:24.119490       1 driver.go:108] Enabling volume access mode: SINGLE_NODE_MULTI_WRITER
I0730 21:07:24.119731       1 server.go:117] Listening for connections on address: &net.UnixAddr{Name:"//csi/csi-provisioner.sock", Net:"unix"}
I0730 21:07:24.119751       1 server.go:114] listening for CSI-Addons requests on address: &net.UnixAddr{Name:"/csi/csi-addons.sock", Net:"unix"}
I0730 21:07:33.354473       1 utils.go:198] ID: 1 GRPC call: /csi.v1.Identity/Probe
I0730 21:07:33.356257       1 utils.go:199] ID: 1 GRPC request: {}
I0730 21:07:33.356346       1 utils.go:205] ID: 1 GRPC response: {}
I0730 21:07:33.358665       1 utils.go:198] ID: 2 GRPC call: /csi.v1.Identity/GetPluginInfo
I0730 21:07:33.358763       1 utils.go:199] ID: 2 GRPC request: {}
I0730 21:07:33.358788       1 identityserver-default.go:40] ID: 2 Using default GetPluginInfo
I0730 21:07:33.358897       1 utils.go:205] ID: 2 GRPC response: {"name":"rbd.csi.ceph.com","vendor_version":"v3.11.0"}
I0730 21:07:33.360152       1 utils.go:198] ID: 3 GRPC call: /csi.v1.Identity/Probe
I0730 21:07:33.360171       1 utils.go:199] ID: 3 GRPC request: {}
I0730 21:07:33.360182       1 utils.go:205] ID: 3 GRPC response: {}
I0730 21:07:33.360544       1 utils.go:198] ID: 4 GRPC call: /csi.v1.Identity/GetPluginCapabilities
I0730 21:07:33.360591       1 utils.go:199] ID: 4 GRPC request: {}
I0730 21:07:33.360706       1 utils.go:205] ID: 4 GRPC response: {"capabilities":[{"Type":{"Service":{"type":1}}},{"Type":{"VolumeExpansion":{"type":1}}},{"Type":{"Service":{"type":2}}}]}
I0730 21:07:33.361325       1 utils.go:198] ID: 5 GRPC call: /csi.v1.Controller/ControllerGetCapabilities
I0730 21:07:33.361363       1 utils.go:199] ID: 5 GRPC request: {}
I0730 21:07:33.361374       1 controllerserver-default.go:42] ID: 5 Using default ControllerGetCapabilities
I0730 21:07:33.361469       1 utils.go:205] ID: 5 GRPC response: {"capabilities":[{"Type":{"Rpc":{"type":1}}},{"Type":{"Rpc":{"type":5}}},{"Type":{"Rpc":{"type":7}}},{"Type":{"Rpc":{"type":9}}}]}
I0730 21:07:37.406856       1 utils.go:198] ID: 6 GRPC call: /csi.v1.Identity/Probe
I0730 21:07:37.406908       1 utils.go:199] ID: 6 GRPC request: {}
I0730 21:07:37.406925       1 utils.go:205] ID: 6 GRPC response: {}
I0730 21:07:37.409503       1 utils.go:198] ID: 7 GRPC call: /csi.v1.Identity/GetPluginInfo
I0730 21:07:37.409546       1 utils.go:199] ID: 7 GRPC request: {}
I0730 21:07:37.409557       1 identityserver-default.go:40] ID: 7 Using default GetPluginInfo
I0730 21:07:37.409587       1 utils.go:205] ID: 7 GRPC response: {"name":"rbd.csi.ceph.com","vendor_version":"v3.11.0"}
I0730 21:07:37.414306       1 utils.go:198] ID: 8 GRPC call: /csi.v1.Identity/Probe
I0730 21:07:37.414422       1 utils.go:199] ID: 8 GRPC request: {}
I0730 21:07:37.414449       1 utils.go:205] ID: 8 GRPC response: {}
I0730 21:07:37.415021       1 utils.go:198] ID: 9 GRPC call: /csi.v1.Identity/GetPluginCapabilities
I0730 21:07:37.415052       1 utils.go:199] ID: 9 GRPC request: {}
I0730 21:07:37.415166       1 utils.go:205] ID: 9 GRPC response: {"capabilities":[{"Type":{"Service":{"type":1}}},{"Type":{"VolumeExpansion":{"type":1}}},{"Type":{"Service":{"type":2}}}]}
I0730 21:07:37.415950       1 utils.go:198] ID: 10 GRPC call: /csi.v1.Controller/ControllerGetCapabilities
I0730 21:07:37.416126       1 utils.go:199] ID: 10 GRPC request: {}
I0730 21:07:37.416149       1 controllerserver-default.go:42] ID: 10 Using default ControllerGetCapabilities
I0730 21:07:37.416348       1 utils.go:205] ID: 10 GRPC response: {"capabilities":[{"Type":{"Rpc":{"type":1}}},{"Type":{"Rpc":{"type":5}}},{"Type":{"Rpc":{"type":7}}},{"Type":{"Rpc":{"type":9}}}]}
I0730 21:07:37.417151       1 utils.go:198] ID: 11 GRPC call: /csi.v1.Controller/ControllerGetCapabilities
I0730 21:07:37.417186       1 utils.go:199] ID: 11 GRPC request: {}
I0730 21:07:37.417198       1 controllerserver-default.go:42] ID: 11 Using default ControllerGetCapabilities
I0730 21:07:37.417305       1 utils.go:205] ID: 11 GRPC response: {"capabilities":[{"Type":{"Rpc":{"type":1}}},{"Type":{"Rpc":{"type":5}}},{"Type":{"Rpc":{"type":7}}},{"Type":{"Rpc":{"type":9}}}]}
I0730 21:07:37.417713       1 utils.go:198] ID: 12 GRPC call: /csi.v1.Controller/ControllerGetCapabilities
I0730 21:07:37.417735       1 utils.go:199] ID: 12 GRPC request: {}
I0730 21:07:37.417742       1 controllerserver-default.go:42] ID: 12 Using default ControllerGetCapabilities
I0730 21:07:37.417849       1 utils.go:205] ID: 12 GRPC response: {"capabilities":[{"Type":{"Rpc":{"type":1}}},{"Type":{"Rpc":{"type":5}}},{"Type":{"Rpc":{"type":7}}},{"Type":{"Rpc":{"type":9}}}]}
I0730 21:07:41.859902       1 utils.go:198] ID: 13 GRPC call: /csi.v1.Identity/GetPluginInfo
I0730 21:07:41.859946       1 utils.go:199] ID: 13 GRPC request: {}
I0730 21:07:41.859956       1 identityserver-default.go:40] ID: 13 Using default GetPluginInfo
I0730 21:07:41.859990       1 utils.go:205] ID: 13 GRPC response: {"name":"rbd.csi.ceph.com","vendor_version":"v3.11.0"}
I0730 21:07:41.863864       1 utils.go:198] ID: 14 GRPC call: /csi.v1.Identity/Probe
I0730 21:07:41.863890       1 utils.go:199] ID: 14 GRPC request: {}
I0730 21:07:41.863910       1 utils.go:205] ID: 14 GRPC response: {}
I0730 21:07:41.864336       1 utils.go:198] ID: 15 GRPC call: /csi.v1.Controller/ControllerGetCapabilities
I0730 21:07:41.864358       1 utils.go:199] ID: 15 GRPC request: {}
I0730 21:07:41.864367       1 controllerserver-default.go:42] ID: 15 Using default ControllerGetCapabilities
I0730 21:07:41.864466       1 utils.go:205] ID: 15 GRPC response: {"capabilities":[{"Type":{"Rpc":{"type":1}}},{"Type":{"Rpc":{"type":5}}},{"Type":{"Rpc":{"type":7}}},{"Type":{"Rpc":{"type":9}}}]}
I0730 21:07:43.656344       1 utils.go:198] ID: 16 GRPC call: /csi.v1.Identity/Probe
I0730 21:07:43.656381       1 utils.go:199] ID: 16 GRPC request: {}
I0730 21:07:43.656395       1 utils.go:205] ID: 16 GRPC response: {}
I0730 21:07:43.658496       1 utils.go:198] ID: 17 GRPC call: /csi.v1.Identity/GetPluginInfo
I0730 21:07:43.658518       1 utils.go:199] ID: 17 GRPC request: {}
I0730 21:07:43.658525       1 identityserver-default.go:40] ID: 17 Using default GetPluginInfo
I0730 21:07:43.658545       1 utils.go:205] ID: 17 GRPC response: {"name":"rbd.csi.ceph.com","vendor_version":"v3.11.0"}
I0730 21:07:43.661501       1 utils.go:198] ID: 18 GRPC call: /csi.v1.Identity/Probe
I0730 21:07:43.661606       1 utils.go:199] ID: 18 GRPC request: {}
I0730 21:07:43.661629       1 utils.go:205] ID: 18 GRPC response: {}
I0730 21:07:43.663210       1 utils.go:198] ID: 19 GRPC call: /csi.v1.Identity/GetPluginCapabilities
I0730 21:07:43.663263       1 utils.go:199] ID: 19 GRPC request: {}
I0730 21:07:43.663395       1 utils.go:205] ID: 19 GRPC response: {"capabilities":[{"Type":{"Service":{"type":1}}},{"Type":{"VolumeExpansion":{"type":1}}},{"Type":{"Service":{"type":2}}}]}
I0730 21:07:43.664298       1 utils.go:198] ID: 20 GRPC call: /csi.v1.Controller/ControllerGetCapabilities
I0730 21:07:43.664323       1 utils.go:199] ID: 20 GRPC request: {}
I0730 21:07:43.664331       1 controllerserver-default.go:42] ID: 20 Using default ControllerGetCapabilities
I0730 21:07:43.664443       1 utils.go:205] ID: 20 GRPC response: {"capabilities":[{"Type":{"Rpc":{"type":1}}},{"Type":{"Rpc":{"type":5}}},{"Type":{"Rpc":{"type":7}}},{"Type":{"Rpc":{"type":9}}}]}
I0730 21:08:25.884182       1 utils.go:198] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 GRPC call: /csi.v1.Controller/CreateVolume
I0730 21:08:25.884473       1 utils.go:199] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 GRPC request: {"capacity_range":{"required_bytes":171798691840},"name":"pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029","parameters":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","csi.storage.k8s.io/pv/name":"pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029","csi.storage.k8s.io/pvc/name":"datadir-percona-xtradb-pxc-0","csi.storage.k8s.io/pvc/namespace":"openstack","imageFeatures":"layering","pool":"kube"},"secrets":"***stripped***","volume_capabilities":[{"AccessType":{"Mount":{"fs_type":"ext4","mount_flags":["discard"]}},"access_mode":{"mode":1}}]}
I0730 21:08:25.884673       1 rbd_util.go:1315] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 setting disableInUseChecks: false image features: [layering] mounter: rbd
E0730 21:08:25.911746       1 omap.go:80] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 omap not found (pool="kube", namespace="", name="csi.volumes.default"): rados: ret=-2, No such file or directory
I0730 21:08:25.936522       1 omap.go:159] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 set omap keys (pool="kube", namespace="", name="csi.volumes.default"): map[csi.volume.pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029:1468d55b-0784-466a-9fb7-7273e6baf08d])
I0730 21:08:25.946039       1 omap.go:159] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 set omap keys (pool="kube", namespace="", name="csi.volume.1468d55b-0784-466a-9fb7-7273e6baf08d"): map[csi.imagename:csi-vol-1468d55b-0784-466a-9fb7-7273e6baf08d csi.volname:pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 csi.volume.owner:openstack])
I0730 21:08:25.946078       1 rbd_journal.go:491] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 generated Volume ID (0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-1468d55b-0784-466a-9fb7-7273e6baf08d) and image name (csi-vol-1468d55b-0784-466a-9fb7-7273e6baf08d) for request name (pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029)
I0730 21:08:25.946163       1 rbd_util.go:423] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 rbd: create kube/csi-vol-1468d55b-0784-466a-9fb7-7273e6baf08d size 163840M (features: [layering]) using mon 10.96.240.200
I0730 21:08:25.946225       1 rbd_util.go:1563] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 setting image options on kube/csi-vol-1468d55b-0784-466a-9fb7-7273e6baf08d
I0730 21:08:25.985457       1 controllerserver.go:763] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 created image kube/csi-vol-1468d55b-0784-466a-9fb7-7273e6baf08d backed for request name pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029
I0730 21:08:26.018454       1 omap.go:159] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 set omap keys (pool="kube", namespace="", name="csi.volume.1468d55b-0784-466a-9fb7-7273e6baf08d"): map[csi.imageid:37c6923f3d10])
I0730 21:08:26.142098       1 utils.go:205] ID: 21 Req-ID: pvc-ce70fa60-e483-4eb2-86c8-5a2093bef029 GRPC response: {"volume":{"capacity_bytes":171798691840,"volume_context":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","imageFeatures":"layering","imageName":"csi-vol-1468d55b-0784-466a-9fb7-7273e6baf08d","journalPool":"kube","pool":"kube"},"volume_id":"0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-1468d55b-0784-466a-9fb7-7273e6baf08d"}}
I0730 21:08:43.915588       1 utils.go:198] ID: 22 GRPC call: /csi.v1.Identity/Probe
I0730 21:08:43.915626       1 utils.go:199] ID: 22 GRPC request: {}
I0730 21:08:43.915639       1 utils.go:205] ID: 22 GRPC response: {}
I0730 21:09:43.867143       1 utils.go:198] ID: 23 GRPC call: /csi.v1.Identity/Probe
I0730 21:09:43.867251       1 utils.go:199] ID: 23 GRPC request: {}
I0730 21:09:43.867308       1 utils.go:205] ID: 23 GRPC response: {}
I0730 21:10:43.867668       1 utils.go:198] ID: 24 GRPC call: /csi.v1.Identity/Probe
I0730 21:10:43.867716       1 utils.go:199] ID: 24 GRPC request: {}
I0730 21:10:43.867738       1 utils.go:205] ID: 24 GRPC response: {}
I0730 21:11:43.877167       1 utils.go:198] ID: 25 GRPC call: /csi.v1.Identity/Probe
I0730 21:11:43.877234       1 utils.go:199] ID: 25 GRPC request: {}
I0730 21:11:43.877362       1 utils.go:205] ID: 25 GRPC response: {}
I0730 21:12:43.866000       1 utils.go:198] ID: 26 GRPC call: /csi.v1.Identity/Probe
I0730 21:12:43.866069       1 utils.go:199] ID: 26 GRPC request: {}
I0730 21:12:43.866092       1 utils.go:205] ID: 26 GRPC response: {}
I0730 21:13:43.887569       1 utils.go:198] ID: 27 GRPC call: /csi.v1.Identity/Probe
I0730 21:13:43.887642       1 utils.go:199] ID: 27 GRPC request: {}
I0730 21:13:43.887707       1 utils.go:205] ID: 27 GRPC response: {}
I0730 21:14:43.867274       1 utils.go:198] ID: 28 GRPC call: /csi.v1.Identity/Probe
I0730 21:14:43.867402       1 utils.go:199] ID: 28 GRPC request: {}
I0730 21:14:43.867429       1 utils.go:205] ID: 28 GRPC response: {}
I0730 21:15:43.897746       1 utils.go:198] ID: 29 GRPC call: /csi.v1.Identity/Probe
I0730 21:15:43.897822       1 utils.go:199] ID: 29 GRPC request: {}
I0730 21:15:43.897888       1 utils.go:205] ID: 29 GRPC response: {}
I0730 21:16:43.866123       1 utils.go:198] ID: 30 GRPC call: /csi.v1.Identity/Probe
I0730 21:16:43.866167       1 utils.go:199] ID: 30 GRPC request: {}
I0730 21:16:43.866189       1 utils.go:205] ID: 30 GRPC response: {}
I0730 21:17:43.908690       1 utils.go:198] ID: 31 GRPC call: /csi.v1.Identity/Probe
I0730 21:17:43.908755       1 utils.go:199] ID: 31 GRPC request: {}
I0730 21:17:43.908780       1 utils.go:205] ID: 31 GRPC response: {}
I0730 21:18:43.865974       1 utils.go:198] ID: 32 GRPC call: /csi.v1.Identity/Probe
I0730 21:18:43.866025       1 utils.go:199] ID: 32 GRPC request: {}
I0730 21:18:43.866049       1 utils.go:205] ID: 32 GRPC response: {}
I0730 21:18:58.417892       1 utils.go:198] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 GRPC call: /csi.v1.Controller/CreateVolume
I0730 21:18:58.418161       1 utils.go:199] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 GRPC request: {"capacity_range":{"required_bytes":10737418240},"name":"pvc-becb8cc0-c0fa-4463-be23-868599d2f417","parameters":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","csi.storage.k8s.io/pv/name":"pvc-becb8cc0-c0fa-4463-be23-868599d2f417","csi.storage.k8s.io/pvc/name":"persistence-rabbitmq-keystone-server-0","csi.storage.k8s.io/pvc/namespace":"openstack","imageFeatures":"layering","pool":"kube"},"secrets":"***stripped***","volume_capabilities":[{"AccessType":{"Mount":{"fs_type":"ext4","mount_flags":["discard"]}},"access_mode":{"mode":1}}]}
I0730 21:18:58.418381       1 rbd_util.go:1315] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 setting disableInUseChecks: false image features: [layering] mounter: rbd
I0730 21:18:58.419946       1 omap.go:89] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 got omap values: (pool="kube", namespace="", name="csi.volumes.default"): map[]
I0730 21:18:58.437659       1 omap.go:159] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 set omap keys (pool="kube", namespace="", name="csi.volumes.default"): map[csi.volume.pvc-becb8cc0-c0fa-4463-be23-868599d2f417:f6bec36b-76e0-4f23-8291-e58f94e6636b])
I0730 21:18:58.446330       1 omap.go:159] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 set omap keys (pool="kube", namespace="", name="csi.volume.f6bec36b-76e0-4f23-8291-e58f94e6636b"): map[csi.imagename:csi-vol-f6bec36b-76e0-4f23-8291-e58f94e6636b csi.volname:pvc-becb8cc0-c0fa-4463-be23-868599d2f417 csi.volume.owner:openstack])
I0730 21:18:58.446481       1 rbd_journal.go:491] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 generated Volume ID (0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-f6bec36b-76e0-4f23-8291-e58f94e6636b) and image name (csi-vol-f6bec36b-76e0-4f23-8291-e58f94e6636b) for request name (pvc-becb8cc0-c0fa-4463-be23-868599d2f417)
I0730 21:18:58.446618       1 rbd_util.go:423] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 rbd: create kube/csi-vol-f6bec36b-76e0-4f23-8291-e58f94e6636b size 10240M (features: [layering]) using mon 10.96.240.200
I0730 21:18:58.446709       1 rbd_util.go:1563] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 setting image options on kube/csi-vol-f6bec36b-76e0-4f23-8291-e58f94e6636b
I0730 21:18:58.484051       1 controllerserver.go:763] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 created image kube/csi-vol-f6bec36b-76e0-4f23-8291-e58f94e6636b backed for request name pvc-becb8cc0-c0fa-4463-be23-868599d2f417
I0730 21:18:58.517116       1 omap.go:159] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 set omap keys (pool="kube", namespace="", name="csi.volume.f6bec36b-76e0-4f23-8291-e58f94e6636b"): map[csi.imageid:37c6449aa02a])
I0730 21:18:58.624012       1 utils.go:205] ID: 33 Req-ID: pvc-becb8cc0-c0fa-4463-be23-868599d2f417 GRPC response: {"volume":{"capacity_bytes":10737418240,"volume_context":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","imageFeatures":"layering","imageName":"csi-vol-f6bec36b-76e0-4f23-8291-e58f94e6636b","journalPool":"kube","pool":"kube"},"volume_id":"0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-f6bec36b-76e0-4f23-8291-e58f94e6636b"}}
I0730 21:19:43.917388       1 utils.go:198] ID: 34 GRPC call: /csi.v1.Identity/Probe
I0730 21:19:43.917470       1 utils.go:199] ID: 34 GRPC request: {}
I0730 21:19:43.917501       1 utils.go:205] ID: 34 GRPC response: {}
I0730 21:20:43.866026       1 utils.go:198] ID: 35 GRPC call: /csi.v1.Identity/Probe
I0730 21:20:43.866080       1 utils.go:199] ID: 35 GRPC request: {}
I0730 21:20:43.866100       1 utils.go:205] ID: 35 GRPC response: {}
I0730 21:21:43.923404       1 utils.go:198] ID: 36 GRPC call: /csi.v1.Identity/Probe
I0730 21:21:43.923452       1 utils.go:199] ID: 36 GRPC request: {}
I0730 21:21:43.923468       1 utils.go:205] ID: 36 GRPC response: {}
I0730 21:22:43.866400       1 utils.go:198] ID: 37 GRPC call: /csi.v1.Identity/Probe
I0730 21:22:43.866472       1 utils.go:199] ID: 37 GRPC request: {}
I0730 21:22:43.866488       1 utils.go:205] ID: 37 GRPC response: {}
I0730 21:23:06.748239       1 utils.go:198] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb GRPC call: /csi.v1.Controller/CreateVolume
I0730 21:23:06.748481       1 utils.go:199] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb GRPC request: {"capacity_range":{"required_bytes":10737418240},"name":"pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb","parameters":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","csi.storage.k8s.io/pv/name":"pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb","csi.storage.k8s.io/pvc/name":"persistence-rabbitmq-glance-server-0","csi.storage.k8s.io/pvc/namespace":"openstack","imageFeatures":"layering","pool":"kube"},"secrets":"***stripped***","volume_capabilities":[{"AccessType":{"Mount":{"fs_type":"ext4","mount_flags":["discard"]}},"access_mode":{"mode":1}}]}
I0730 21:23:06.748727       1 rbd_util.go:1315] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb setting disableInUseChecks: false image features: [layering] mounter: rbd
I0730 21:23:06.751857       1 omap.go:89] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb got omap values: (pool="kube", namespace="", name="csi.volumes.default"): map[]
I0730 21:23:06.766297       1 omap.go:159] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb set omap keys (pool="kube", namespace="", name="csi.volumes.default"): map[csi.volume.pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb:8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8])
I0730 21:23:06.774812       1 omap.go:159] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb set omap keys (pool="kube", namespace="", name="csi.volume.8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8"): map[csi.imagename:csi-vol-8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8 csi.volname:pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb csi.volume.owner:openstack])
I0730 21:23:06.774864       1 rbd_journal.go:491] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb generated Volume ID (0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8) and image name (csi-vol-8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8) for request name (pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb)
I0730 21:23:06.774975       1 rbd_util.go:423] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb rbd: create kube/csi-vol-8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8 size 10240M (features: [layering]) using mon 10.96.240.200
I0730 21:23:06.775032       1 rbd_util.go:1563] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb setting image options on kube/csi-vol-8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8
I0730 21:23:06.807744       1 controllerserver.go:763] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb created image kube/csi-vol-8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8 backed for request name pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb
I0730 21:23:06.843419       1 omap.go:159] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb set omap keys (pool="kube", namespace="", name="csi.volume.8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8"): map[csi.imageid:37c683c495c4])
I0730 21:23:06.952835       1 utils.go:205] ID: 38 Req-ID: pvc-5172527f-c3d8-4d12-b38d-4e97152b04cb GRPC response: {"volume":{"capacity_bytes":10737418240,"volume_context":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","imageFeatures":"layering","imageName":"csi-vol-8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8","journalPool":"kube","pool":"kube"},"volume_id":"0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-8da4ebb3-b42c-41b8-8afc-2c9c2a218fe8"}}
I0730 21:23:43.865894       1 utils.go:198] ID: 39 GRPC call: /csi.v1.Identity/Probe
I0730 21:23:43.865961       1 utils.go:199] ID: 39 GRPC request: {}
I0730 21:23:43.865992       1 utils.go:205] ID: 39 GRPC response: {}
I0730 21:24:43.867478       1 utils.go:198] ID: 40 GRPC call: /csi.v1.Identity/Probe
I0730 21:24:43.867550       1 utils.go:199] ID: 40 GRPC request: {}
I0730 21:24:43.867575       1 utils.go:205] ID: 40 GRPC response: {}
I0730 21:25:43.866189       1 utils.go:198] ID: 41 GRPC call: /csi.v1.Identity/Probe
I0730 21:25:43.866240       1 utils.go:199] ID: 41 GRPC request: {}
I0730 21:25:43.866258       1 utils.go:205] ID: 41 GRPC response: {}
I0730 21:26:43.876484       1 utils.go:198] ID: 42 GRPC call: /csi.v1.Identity/Probe
I0730 21:26:43.876523       1 utils.go:199] ID: 42 GRPC request: {}
I0730 21:26:43.876540       1 utils.go:205] ID: 42 GRPC response: {}
I0730 21:27:43.867251       1 utils.go:198] ID: 43 GRPC call: /csi.v1.Identity/Probe
I0730 21:27:43.867292       1 utils.go:199] ID: 43 GRPC request: {}
I0730 21:27:43.867308       1 utils.go:205] ID: 43 GRPC response: {}
I0730 21:28:08.985699       1 utils.go:198] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 GRPC call: /csi.v1.Controller/CreateVolume
I0730 21:28:08.986207       1 utils.go:199] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 GRPC request: {"capacity_range":{"required_bytes":10737418240},"name":"pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80","parameters":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","csi.storage.k8s.io/pv/name":"pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80","csi.storage.k8s.io/pvc/name":"persistence-rabbitmq-cinder-server-0","csi.storage.k8s.io/pvc/namespace":"openstack","imageFeatures":"layering","pool":"kube"},"secrets":"***stripped***","volume_capabilities":[{"AccessType":{"Mount":{"fs_type":"ext4","mount_flags":["discard"]}},"access_mode":{"mode":1}}]}
I0730 21:28:08.986638       1 rbd_util.go:1315] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 setting disableInUseChecks: false image features: [layering] mounter: rbd
I0730 21:28:08.989808       1 omap.go:89] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 got omap values: (pool="kube", namespace="", name="csi.volumes.default"): map[]
I0730 21:28:09.000850       1 omap.go:159] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 set omap keys (pool="kube", namespace="", name="csi.volumes.default"): map[csi.volume.pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80:2063b034-a6af-4c46-a95c-52e123233532])
I0730 21:28:09.006703       1 omap.go:159] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 set omap keys (pool="kube", namespace="", name="csi.volume.2063b034-a6af-4c46-a95c-52e123233532"): map[csi.imagename:csi-vol-2063b034-a6af-4c46-a95c-52e123233532 csi.volname:pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 csi.volume.owner:openstack])
I0730 21:28:09.006757       1 rbd_journal.go:491] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 generated Volume ID (0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-2063b034-a6af-4c46-a95c-52e123233532) and image name (csi-vol-2063b034-a6af-4c46-a95c-52e123233532) for request name (pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80)
I0730 21:28:09.006839       1 rbd_util.go:423] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 rbd: create kube/csi-vol-2063b034-a6af-4c46-a95c-52e123233532 size 10240M (features: [layering]) using mon 10.96.240.200
I0730 21:28:09.006885       1 rbd_util.go:1563] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 setting image options on kube/csi-vol-2063b034-a6af-4c46-a95c-52e123233532
I0730 21:28:09.041356       1 controllerserver.go:763] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 created image kube/csi-vol-2063b034-a6af-4c46-a95c-52e123233532 backed for request name pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80
I0730 21:28:09.072605       1 omap.go:159] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 set omap keys (pool="kube", namespace="", name="csi.volume.2063b034-a6af-4c46-a95c-52e123233532"): map[csi.imageid:37c6904ffea6])
I0730 21:28:09.185113       1 utils.go:205] ID: 44 Req-ID: pvc-bdfe65a1-5d4c-4268-9a95-53a3b0c83c80 GRPC response: {"volume":{"capacity_bytes":10737418240,"volume_context":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","imageFeatures":"layering","imageName":"csi-vol-2063b034-a6af-4c46-a95c-52e123233532","journalPool":"kube","pool":"kube"},"volume_id":"0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-2063b034-a6af-4c46-a95c-52e123233532"}}
I0730 21:28:43.887541       1 utils.go:198] ID: 45 GRPC call: /csi.v1.Identity/Probe
I0730 21:28:43.887704       1 utils.go:199] ID: 45 GRPC request: {}
I0730 21:28:43.887732       1 utils.go:205] ID: 45 GRPC response: {}
I0730 21:29:43.866185       1 utils.go:198] ID: 46 GRPC call: /csi.v1.Identity/Probe
I0730 21:29:43.866255       1 utils.go:199] ID: 46 GRPC request: {}
I0730 21:29:43.866284       1 utils.go:205] ID: 46 GRPC response: {}
I0730 21:30:43.899372       1 utils.go:198] ID: 47 GRPC call: /csi.v1.Identity/Probe
I0730 21:30:43.899426       1 utils.go:199] ID: 47 GRPC request: {}
I0730 21:30:43.899451       1 utils.go:205] ID: 47 GRPC response: {}
I0730 21:31:43.919793       1 utils.go:198] ID: 48 GRPC call: /csi.v1.Identity/Probe
I0730 21:31:43.919833       1 utils.go:199] ID: 48 GRPC request: {}
I0730 21:31:43.919848       1 utils.go:205] ID: 48 GRPC response: {}
I0730 21:32:43.909041       1 utils.go:198] ID: 49 GRPC call: /csi.v1.Identity/Probe
I0730 21:32:43.909928       1 utils.go:199] ID: 49 GRPC request: {}
I0730 21:32:43.910065       1 utils.go:205] ID: 49 GRPC response: {}
I0730 21:33:43.921680       1 utils.go:198] ID: 50 GRPC call: /csi.v1.Identity/Probe
I0730 21:33:43.921736       1 utils.go:199] ID: 50 GRPC request: {}
I0730 21:33:43.921758       1 utils.go:205] ID: 50 GRPC response: {}
I0730 21:34:43.919930       1 utils.go:198] ID: 51 GRPC call: /csi.v1.Identity/Probe
I0730 21:34:43.920023       1 utils.go:199] ID: 51 GRPC request: {}
I0730 21:34:43.920056       1 utils.go:205] ID: 51 GRPC response: {}
I0730 21:35:43.919761       1 utils.go:198] ID: 52 GRPC call: /csi.v1.Identity/Probe
I0730 21:35:43.919805       1 utils.go:199] ID: 52 GRPC request: {}
I0730 21:35:43.919821       1 utils.go:205] ID: 52 GRPC response: {}
I0730 21:35:51.490788       1 utils.go:198] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df GRPC call: /csi.v1.Controller/CreateVolume
I0730 21:35:51.491029       1 utils.go:199] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df GRPC request: {"capacity_range":{"required_bytes":10737418240},"name":"pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df","parameters":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","csi.storage.k8s.io/pv/name":"pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df","csi.storage.k8s.io/pvc/name":"persistence-rabbitmq-nova-server-0","csi.storage.k8s.io/pvc/namespace":"openstack","imageFeatures":"layering","pool":"kube"},"secrets":"***stripped***","volume_capabilities":[{"AccessType":{"Mount":{"fs_type":"ext4","mount_flags":["discard"]}},"access_mode":{"mode":1}}]}
I0730 21:35:51.491237       1 rbd_util.go:1315] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df setting disableInUseChecks: false image features: [layering] mounter: rbd
I0730 21:35:51.494582       1 omap.go:89] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df got omap values: (pool="kube", namespace="", name="csi.volumes.default"): map[]
I0730 21:35:51.510075       1 omap.go:159] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df set omap keys (pool="kube", namespace="", name="csi.volumes.default"): map[csi.volume.pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df:8aac57e6-3332-4eff-b296-b232b7aabac0])
I0730 21:35:51.516978       1 omap.go:159] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df set omap keys (pool="kube", namespace="", name="csi.volume.8aac57e6-3332-4eff-b296-b232b7aabac0"): map[csi.imagename:csi-vol-8aac57e6-3332-4eff-b296-b232b7aabac0 csi.volname:pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df csi.volume.owner:openstack])
I0730 21:35:51.517027       1 rbd_journal.go:491] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df generated Volume ID (0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-8aac57e6-3332-4eff-b296-b232b7aabac0) and image name (csi-vol-8aac57e6-3332-4eff-b296-b232b7aabac0) for request name (pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df)
I0730 21:35:51.517305       1 rbd_util.go:423] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df rbd: create kube/csi-vol-8aac57e6-3332-4eff-b296-b232b7aabac0 size 10240M (features: [layering]) using mon 10.96.240.200
I0730 21:35:51.517367       1 rbd_util.go:1563] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df setting image options on kube/csi-vol-8aac57e6-3332-4eff-b296-b232b7aabac0
I0730 21:35:51.551636       1 controllerserver.go:763] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df created image kube/csi-vol-8aac57e6-3332-4eff-b296-b232b7aabac0 backed for request name pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df
I0730 21:35:51.585642       1 omap.go:159] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df set omap keys (pool="kube", namespace="", name="csi.volume.8aac57e6-3332-4eff-b296-b232b7aabac0"): map[csi.imageid:37c6c246645c])
I0730 21:35:51.672535       1 utils.go:205] ID: 53 Req-ID: pvc-3bd7977b-1171-4dfe-a6b5-e1112b3d82df GRPC response: {"volume":{"capacity_bytes":10737418240,"volume_context":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","imageFeatures":"layering","imageName":"csi-vol-8aac57e6-3332-4eff-b296-b232b7aabac0","journalPool":"kube","pool":"kube"},"volume_id":"0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-8aac57e6-3332-4eff-b296-b232b7aabac0"}}
I0730 21:36:43.919248       1 utils.go:198] ID: 54 GRPC call: /csi.v1.Identity/Probe
I0730 21:36:43.919331       1 utils.go:199] ID: 54 GRPC request: {}
I0730 21:36:43.919359       1 utils.go:205] ID: 54 GRPC response: {}
I0730 21:37:43.866728       1 utils.go:198] ID: 55 GRPC call: /csi.v1.Identity/Probe
I0730 21:37:43.866792       1 utils.go:199] ID: 55 GRPC request: {}
I0730 21:37:43.866813       1 utils.go:205] ID: 55 GRPC response: {}
I0730 21:38:43.867226       1 utils.go:198] ID: 56 GRPC call: /csi.v1.Identity/Probe
I0730 21:38:43.867310       1 utils.go:199] ID: 56 GRPC request: {}
I0730 21:38:43.867341       1 utils.go:205] ID: 56 GRPC response: {}
I0730 21:39:43.872405       1 utils.go:198] ID: 57 GRPC call: /csi.v1.Identity/Probe
I0730 21:39:43.872468       1 utils.go:199] ID: 57 GRPC request: {}
I0730 21:39:43.872507       1 utils.go:205] ID: 57 GRPC response: {}
I0730 21:40:43.866534       1 utils.go:198] ID: 58 GRPC call: /csi.v1.Identity/Probe
I0730 21:40:43.866601       1 utils.go:199] ID: 58 GRPC request: {}
I0730 21:40:43.866623       1 utils.go:205] ID: 58 GRPC response: {}
I0730 21:41:43.877098       1 utils.go:198] ID: 59 GRPC call: /csi.v1.Identity/Probe
I0730 21:41:43.877144       1 utils.go:199] ID: 59 GRPC request: {}
I0730 21:41:43.877160       1 utils.go:205] ID: 59 GRPC response: {}
I0730 21:42:43.918989       1 utils.go:198] ID: 60 GRPC call: /csi.v1.Identity/Probe
I0730 21:42:43.919036       1 utils.go:199] ID: 60 GRPC request: {}
I0730 21:42:43.919053       1 utils.go:205] ID: 60 GRPC response: {}
I0730 21:42:50.386613       1 utils.go:198] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 GRPC call: /csi.v1.Controller/CreateVolume
I0730 21:42:50.386866       1 utils.go:199] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 GRPC request: {"capacity_range":{"required_bytes":10737418240},"name":"pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270","parameters":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","csi.storage.k8s.io/pv/name":"pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270","csi.storage.k8s.io/pvc/name":"persistence-rabbitmq-neutron-server-0","csi.storage.k8s.io/pvc/namespace":"openstack","imageFeatures":"layering","pool":"kube"},"secrets":"***stripped***","volume_capabilities":[{"AccessType":{"Mount":{"fs_type":"ext4","mount_flags":["discard"]}},"access_mode":{"mode":1}}]}
I0730 21:42:50.387056       1 rbd_util.go:1315] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 setting disableInUseChecks: false image features: [layering] mounter: rbd
I0730 21:42:50.389228       1 omap.go:89] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 got omap values: (pool="kube", namespace="", name="csi.volumes.default"): map[]
I0730 21:42:50.404217       1 omap.go:159] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 set omap keys (pool="kube", namespace="", name="csi.volumes.default"): map[csi.volume.pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270:1289a5e5-2f1e-4cc9-8e25-64749349bec9])
I0730 21:42:50.412345       1 omap.go:159] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 set omap keys (pool="kube", namespace="", name="csi.volume.1289a5e5-2f1e-4cc9-8e25-64749349bec9"): map[csi.imagename:csi-vol-1289a5e5-2f1e-4cc9-8e25-64749349bec9 csi.volname:pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 csi.volume.owner:openstack])
I0730 21:42:50.412377       1 rbd_journal.go:491] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 generated Volume ID (0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-1289a5e5-2f1e-4cc9-8e25-64749349bec9) and image name (csi-vol-1289a5e5-2f1e-4cc9-8e25-64749349bec9) for request name (pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270)
I0730 21:42:50.412474       1 rbd_util.go:423] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 rbd: create kube/csi-vol-1289a5e5-2f1e-4cc9-8e25-64749349bec9 size 10240M (features: [layering]) using mon 10.96.240.200
I0730 21:42:50.412533       1 rbd_util.go:1563] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 setting image options on kube/csi-vol-1289a5e5-2f1e-4cc9-8e25-64749349bec9
I0730 21:42:50.440198       1 controllerserver.go:763] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 created image kube/csi-vol-1289a5e5-2f1e-4cc9-8e25-64749349bec9 backed for request name pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270
I0730 21:42:50.482193       1 omap.go:159] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 set omap keys (pool="kube", namespace="", name="csi.volume.1289a5e5-2f1e-4cc9-8e25-64749349bec9"): map[csi.imageid:37c644f57cc9])
I0730 21:42:50.612580       1 utils.go:205] ID: 61 Req-ID: pvc-b67747a7-03c8-46d4-b69a-3a87bd12a270 GRPC response: {"volume":{"capacity_bytes":10737418240,"volume_context":{"clusterID":"4837cbf8-4f90-4300-b3f6-726c9b9f89b4","imageFeatures":"layering","imageName":"csi-vol-1289a5e5-2f1e-4cc9-8e25-64749349bec9","journalPool":"kube","pool":"kube"},"volume_id":"0001-0024-4837cbf8-4f90-4300-b3f6-726c9b9f89b4-0000000000000002-1289a5e5-2f1e-4cc9-8e25-64749349bec9"}}
I0730 21:43:43.889305       1 utils.go:198] ID: 62 GRPC call: /csi.v1.Identity/Probe
I0730 21:43:43.889387       1 utils.go:199] ID: 62 GRPC request: {}
I0730 21:43:43.889407       1 utils.go:205] ID: 62 GRPC response: {}
I0730 21:44:43.919017       1 utils.go:198] ID: 63 GRPC call: /csi.v1.Identity/Probe
I0730 21:44:43.919084       1 utils.go:199] ID: 63 GRPC request: {}
I0730 21:44:43.919110       1 utils.go:205] ID: 63 GRPC response: {}
I0730 21:45:43.898654       1 utils.go:198] ID: 64 GRPC call: /csi.v1.Identity/Probe
I0730 21:45:43.898707       1 utils.go:199] ID: 64 GRPC request: {}
I0730 21:45:43.898731       1 utils.go:205] ID: 64 GRPC response: {}
I0730 21:46:43.866223       1 utils.go:198] ID: 65 GRPC call: /csi.v1.Identity/Probe
I0730 21:46:43.866272       1 utils.go:199] ID: 65 GRPC request: {}
I0730 21:46:43.866289       1 utils.go:205] ID: 65 GRPC response: {}
I0730 21:47:43.907407       1 utils.go:198] ID: 66 GRPC call: /csi.v1.Identity/Probe
I0730 21:47:43.907601       1 utils.go:199] ID: 66 GRPC request: {}
I0730 21:47:43.907644       1 utils.go:205] ID: 66 GRPC response: {}
I0730 21:48:43.866476       1 utils.go:198] ID: 67 GRPC call: /csi.v1.Identity/Probe
I0730 21:48:43.866516       1 utils.go:199] ID: 67 GRPC request: {}
I0730 21:48:43.866531       1 utils.go:205] ID: 67 GRPC response: {}
I0730 21:49:43.919185       1 utils.go:198] ID: 68 GRPC call: /csi.v1.Identity/Probe
I0730 21:49:43.919346       1 utils.go:199] ID: 68 GRPC request: {}
I0730 21:49:43.919388       1 utils.go:205] ID: 68 GRPC response: {}
I0730 21:50:43.866174       1 utils.go:198] ID: 69 GRPC call: /csi.v1.Identity/Probe
I0730 21:50:43.866243       1 utils.go:199] ID: 69 GRPC request: {}
I0730 21:50:43.866273       1 utils.go:205] ID: 69 GRPC response: {}
I0730 21:51:43.923163       1 utils.go:198] ID: 70 GRPC call: /csi.v1.Identity/Probe
I0730 21:51:43.923232       1 utils.go:199] ID: 70 GRPC request: {}
I0730 21:51:43.923272       1 utils.go:205] ID: 70 GRPC response: {}
I0730 21:52:43.866924       1 utils.go:198] ID: 71 GRPC call: /csi.v1.Identity/Probe
I0730 21:52:43.866979       1 utils.go:199] ID: 71 GRPC request: {}
I0730 21:52:43.867000       1 utils.go:205] ID: 71 GRPC response: {}
I0730 21:53:43.866896       1 utils.go:198] ID: 72 GRPC call: /csi.v1.Identity/Probe
I0730 21:53:43.866957       1 utils.go:199] ID: 72 GRPC request: {}
I0730 21:53:43.866980       1 utils.go:205] ID: 72 GRPC response: {}
I0730 21:54:43.877246       1 utils.go:198] ID: 73 GRPC call: /csi.v1.Identity/Probe
I0730 21:54:43.877299       1 utils.go:199] ID: 73 GRPC request: {}
I0730 21:54:43.877319       1 utils.go:205] ID: 73 GRPC response: {}
I0730 21:55:43.866060       1 utils.go:198] ID: 74 GRPC call: /csi.v1.Identity/Probe
I0730 21:55:43.866109       1 utils.go:199] ID: 74 GRPC request: {}
I0730 21:55:43.866130       1 utils.go:205] ID: 74 GRPC response: {}
I0730 21:56:43.888927       1 utils.go:198] ID: 75 GRPC call: /csi.v1.Identity/Probe
I0730 21:56:43.889054       1 utils.go:199] ID: 75 GRPC request: {}
I0730 21:56:43.889094       1 utils.go:205] ID: 75 GRPC response: {}
I0730 21:57:43.865930       1 utils.go:198] ID: 76 GRPC call: /csi.v1.Identity/Probe
I0730 21:57:43.865982       1 utils.go:199] ID: 76 GRPC request: {}
I0730 21:57:43.866004       1 utils.go:205] ID: 76 GRPC response: {}
I0730 21:58:43.896641       1 utils.go:198] ID: 77 GRPC call: /csi.v1.Identity/Probe
I0730 21:58:43.896680       1 utils.go:199] ID: 77 GRPC request: {}
I0730 21:58:43.896696       1 utils.go:205] ID: 77 GRPC response: {}
I0730 21:59:43.866912       1 utils.go:198] ID: 78 GRPC call: /csi.v1.Identity/Probe
I0730 21:59:43.866992       1 utils.go:199] ID: 78 GRPC request: {}
I0730 21:59:43.867019       1 utils.go:205] ID: 78 GRPC response: {}
I0730 22:00:43.908808       1 utils.go:198] ID: 79 GRPC call: /csi.v1.Identity/Probe
I0730 22:00:43.908879       1 utils.go:199] ID: 79 GRPC request: {}
I0730 22:00:43.908907       1 utils.go:205] ID: 79 GRPC response: {}
I0730 22:01:43.918988       1 utils.go:198] ID: 80 GRPC call: /csi.v1.Identity/Probe
I0730 22:01:43.919059       1 utils.go:199] ID: 80 GRPC request: {}
I0730 22:01:43.919110       1 utils.go:205] ID: 80 GRPC response: {}