I0721 21:05:00.439997       1 main.go:93] Version : v1.3.0
I0721 21:05:00.440990       1 feature_gate.go:245] feature gates: &{map[]}
I0721 21:05:00.442755       1 connection.go:154] Connecting to unix:///csi/csi-provisioner.sock
I0721 21:05:06.342111       1 common.go:111] Probing CSI driver for readiness
I0721 21:05:06.342138       1 connection.go:183] GRPC call: /csi.v1.Identity/Probe
I0721 21:05:06.342145       1 connection.go:184] GRPC request: {}
I0721 21:05:06.350404       1 connection.go:186] GRPC response: {}
I0721 21:05:06.350515       1 connection.go:187] GRPC error: <nil>
I0721 21:05:06.350543       1 connection.go:183] GRPC call: /csi.v1.Identity/GetPluginInfo
I0721 21:05:06.350556       1 connection.go:184] GRPC request: {}
I0721 21:05:06.352156       1 connection.go:186] GRPC response: {"name":"rbd.csi.ceph.com","vendor_version":"v3.5.1"}
I0721 21:05:06.352299       1 connection.go:187] GRPC error: <nil>
I0721 21:05:06.352460       1 main.go:141] CSI driver name: "rbd.csi.ceph.com"
I0721 21:05:06.352496       1 connection.go:183] GRPC call: /csi.v1.Identity/GetPluginCapabilities
I0721 21:05:06.352692       1 connection.go:184] GRPC request: {}
I0721 21:05:06.353958       1 connection.go:186] GRPC response: {"capabilities":[{"Type":{"Service":{"type":1}}},{"Type":{"VolumeExpansion":{"type":1}}},{"Type":{"Service":{"type":2}}}]}
I0721 21:05:06.354131       1 connection.go:187] GRPC error: <nil>
I0721 21:05:06.354152       1 connection.go:183] GRPC call: /csi.v1.Controller/ControllerGetCapabilities
I0721 21:05:06.354165       1 connection.go:184] GRPC request: {}
I0721 21:05:06.355820       1 connection.go:186] GRPC response: {"capabilities":[{"Type":{"Rpc":{"type":1}}},{"Type":{"Rpc":{"type":5}}},{"Type":{"Rpc":{"type":7}}},{"Type":{"Rpc":{"type":9}}}]}
I0721 21:05:06.356005       1 connection.go:187] GRPC error: <nil>
I0721 21:05:06.356019       1 connection.go:183] GRPC call: /csi.v1.Controller/ControllerGetCapabilities
I0721 21:05:06.356024       1 connection.go:184] GRPC request: {}
I0721 21:05:06.357201       1 connection.go:186] GRPC response: {"capabilities":[{"Type":{"Rpc":{"type":1}}},{"Type":{"Rpc":{"type":5}}},{"Type":{"Rpc":{"type":7}}},{"Type":{"Rpc":{"type":9}}}]}
I0721 21:05:06.357368       1 connection.go:187] GRPC error: <nil>
I0721 21:05:06.358721       1 leaderelection.go:248] attempting to acquire leader lease kube-system/external-resizer-rbd-csi-ceph-com...
I0721 21:05:06.372769       1 leaderelection.go:258] successfully acquired lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:06.372848       1 leader_election.go:212] new leader detected, current leader: ceph-csi-rbd-provisioner-6f6497f79c-8wptm
I0721 21:05:06.372946       1 leader_election.go:205] became leader, starting
I0721 21:05:06.373000       1 controller.go:251] Starting external resizer rbd.csi.ceph.com
I0721 21:05:06.373177       1 reflector.go:219] Starting reflector *v1.PersistentVolume (10m0s) from k8s.io/client-go/informers/factory.go:134
I0721 21:05:06.373205       1 reflector.go:255] Listing and watching *v1.PersistentVolume from k8s.io/client-go/informers/factory.go:134
I0721 21:05:06.373319       1 reflector.go:219] Starting reflector *v1.PersistentVolumeClaim (10m0s) from k8s.io/client-go/informers/factory.go:134
I0721 21:05:06.373379       1 reflector.go:255] Listing and watching *v1.PersistentVolumeClaim from k8s.io/client-go/informers/factory.go:134
I0721 21:05:06.381660       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:06.473260       1 shared_informer.go:270] caches populated
I0721 21:05:11.393415       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:16.402865       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:21.414357       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:26.423083       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:31.434066       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:36.443479       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:41.455434       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:46.466009       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:51.476892       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:05:56.484201       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:01.493747       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:06.503214       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:11.513832       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:16.520026       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:21.529109       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:26.539712       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:31.550304       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:36.560517       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:41.570563       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:46.581453       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:51.593062       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:06:56.612517       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:01.623203       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:06.630587       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:11.642026       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:16.652775       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:21.665967       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:26.675319       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:31.684517       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:36.693464       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:41.703107       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:46.713417       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:51.726412       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:07:56.737862       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:01.746252       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:06.756782       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:11.765421       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:16.778029       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:21.787177       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:26.795870       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:31.807319       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:36.816486       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:41.827796       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:46.838797       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:51.847252       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:08:56.856541       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:01.868512       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:06.878831       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:11.892179       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:16.902603       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:21.912230       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:26.919055       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:27.188066       1 controller.go:291] Started PVC processing "default/test-pvc"
W0721 21:09:27.188102       1 controller.go:318] PV "" bound to PVC default/test-pvc not found
I0721 21:09:27.352871       1 controller.go:291] Started PVC processing "default/test-pvc"
I0721 21:09:27.352904       1 controller.go:334] No need to resize PVC "default/test-pvc"
I0721 21:09:31.930334       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:36.941124       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:41.949604       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:46.957686       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:51.964911       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:09:56.974776       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:10:01.991415       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:10:07.000436       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:10:12.011176       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com
I0721 21:10:17.020035       1 leaderelection.go:278] successfully renewed lease kube-system/external-resizer-rbd-csi-ceph-com