I0722 22:15:25.657906       1 main.go:93] Version : v1.3.0
I0722 22:15:25.657973       1 feature_gate.go:245] feature gates: &{map[]}
I0722 22:15:25.659567       1 connection.go:154] Connecting to unix:///csi/csi-provisioner.sock
I0722 22:15:30.217910       1 common.go:111] Probing CSI driver for readiness
I0722 22:15:30.217948       1 connection.go:183] GRPC call: /csi.v1.Identity/Probe
I0722 22:15:30.217955       1 connection.go:184] GRPC request: {}
I0722 22:15:30.225082       1 connection.go:186] GRPC response: {}
I0722 22:15:30.225200       1 connection.go:187] GRPC error: <nil>
I0722 22:15:30.225219       1 connection.go:183] GRPC call: /csi.v1.Identity/GetPluginInfo
I0722 22:15:30.225225       1 connection.go:184] GRPC request: {}
I0722 22:15:30.226345       1 connection.go:186] GRPC response: {"name":"rbd.csi.ceph.com","vendor_version":"v3.5.1"}
I0722 22:15:30.226461       1 connection.go:187] GRPC error: <nil>
I0722 22:15:30.226476       1 main.go:141] CSI driver name: "rbd.csi.ceph.com"
I0722 22:15:30.226492       1 connection.go:183] GRPC call: /csi.v1.Identity/GetPluginCapabilities
I0722 22:15:30.226497       1 connection.go:184] GRPC request: {}
I0722 22:15:30.227828       1 connection.go:186] GRPC response: {"capabilities":[{"Type":{"Service":{"type":1}}},{"Type":{"VolumeExpansion":{"type":1}}},{"Type":{"Service":{"type":2}}}]}
I0722 22:15:30.227992       1 connection.go:187] GRPC error: <nil>
I0722 22:15:30.228003       1 connection.go:183] GRPC call: /csi.v1.Controller/ControllerGetCapabilities
I0722 22:15:30.228008       1 connection.go:184] GRPC request: {}
I0722 22:15:30.229416       1 connection.go:186] GRPC response: {"capabilities":[{"Type":{"Rpc":{"type":1}}},{"Type":{"Rpc":{"type":5}}},{"Type":{"Rpc":{"type":7}}},{"Type":{"Rpc":{"type":9}}}]}
I0722 22:15:30.229538       1 connection.go:187] GRPC error: <nil>
I0722 22:15:30.229550       1 connection.go:183] GRPC call: /csi.v1.Controller/ControllerGetCapabilities
I0722 22:15:30.229553       1 connection.go:184] GRPC request: {}
I0722 22:15:30.230123       1 connection.go:186] GRPC response: {"capabilities":[{"Type":{"Rpc":{"type":1}}},{"Type":{"Rpc":{"type":5}}},{"Type":{"Rpc":{"type":7}}},{"Type":{"Rpc":{"type":9}}}]}
I0722 22:15:30.230222       1 connection.go:187] GRPC error: <nil>
I0722 22:15:30.231484       1 leaderelection.go:248] attempting to acquire leader lease kube-system/external-resizer-rbd-csi-ceph-com...
I0722 22:15:30.246784       1 leaderelection.go:258] successfully acquired lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:15:30.247041       1 leader_election.go:205] became leader, starting
I0722 22:15:30.247079       1 controller.go:251] Starting external resizer rbd.csi.ceph.com
I0722 22:15:30.247166       1 leader_election.go:212] new leader detected, current leader: ceph-csi-rbd-provisioner-6f6497f79c-spbws
I0722 22:15:30.248096       1 reflector.go:219] Starting reflector *v1.PersistentVolumeClaim (10m0s) from k8s.io/client-go/informers/factory.go:134
I0722 22:15:30.248122       1 reflector.go:255] Listing and watching *v1.PersistentVolumeClaim from k8s.io/client-go/informers/factory.go:134
I0722 22:15:30.248530       1 reflector.go:219] Starting reflector *v1.PersistentVolume (10m0s) from k8s.io/client-go/informers/factory.go:134
I0722 22:15:30.248570       1 reflector.go:255] Listing and watching *v1.PersistentVolume from k8s.io/client-go/informers/factory.go:134
I0722 22:15:30.257931       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:15:30.347382       1 shared_informer.go:270] caches populated
I0722 22:15:35.270094       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:15:40.283580       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:15:45.297634       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:15:50.306588       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:15:55.319598       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:00.329287       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:05.339698       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:10.350240       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:15.362571       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:20.375141       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:25.387034       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:30.394167       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:35.407878       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:40.416372       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:45.425810       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:50.435273       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:16:55.448302       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:00.458306       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:05.469879       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:10.479079       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:15.494277       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:20.509034       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:25.522422       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:30.531949       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:35.541729       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:40.551333       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:45.562129       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:50.572724       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:17:55.585954       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:00.599758       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:05.614290       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:10.624259       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:15.635141       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:20.643990       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:25.660362       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:30.670150       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:35.677938       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:40.684982       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:45.693924       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:50.703221       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:18:55.712602       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:00.723691       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:05.732872       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:10.741808       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:15.752971       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:20.762415       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:25.775539       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:30.784283       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:35.795340       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:40.805304       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:45.814207       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:48.550643       1 controller.go:291] Started PVC processing "default/test-pvc"
W0722 22:19:48.550686       1 controller.go:318] PV "" bound to PVC default/test-pvc not found
I0722 22:19:48.719879       1 controller.go:291] Started PVC processing "default/test-pvc"
I0722 22:19:48.719904       1 controller.go:334] No need to resize PVC "default/test-pvc"
I0722 22:19:50.825747       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:19:55.834459       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:20:00.845790       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:20:05.857827       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:20:10.867101       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:20:15.877349       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:20:20.886482       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:20:25.894948       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:20:30.907104       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:20:35.915212       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0722 22:20:40.925256       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com