{"level":"warn","ts":"2026-06-16T22:59:12.647511Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-16T22:59:12.647614Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.242:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://199.204.45.242:2380","--initial-cluster=instance=https://199.204.45.242:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.242:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.242:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]} {"level":"warn","ts":"2026-06-16T22:59:12.647727Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-06-16T22:59:12.647745Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.242:2380"]} {"level":"info","ts":"2026-06-16T22:59:12.647767Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-06-16T22:59:12.648638Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.242:2379"]} {"level":"info","ts":"2026-06-16T22:59:12.648751Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://199.204.45.242:2380"],"listen-peer-urls":["https://199.204.45.242:2380"],"advertise-client-urls":["https://199.204.45.242:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.242:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.242:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"} {"level":"info","ts":"2026-06-16T22:59:12.650993Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"1.993305ms"} {"level":"info","ts":"2026-06-16T22:59:12.657283Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"b844c110b9783e73","cluster-id":"49dc9693ccd466a9"} {"level":"info","ts":"2026-06-16T22:59:12.657352Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 switched to configuration voters=()"} {"level":"info","ts":"2026-06-16T22:59:12.657374Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 became follower at term 0"} {"level":"info","ts":"2026-06-16T22:59:12.657386Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft b844c110b9783e73 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-06-16T22:59:12.657398Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 became follower at term 1"} {"level":"info","ts":"2026-06-16T22:59:12.657435Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 switched to configuration voters=(13277949878970367603)"} {"level":"warn","ts":"2026-06-16T22:59:12.666072Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-06-16T22:59:12.667327Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-06-16T22:59:12.668307Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} {"level":"info","ts":"2026-06-16T22:59:12.670439Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"b844c110b9783e73","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-06-16T22:59:12.670578Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"b844c110b9783e73","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-06-16T22:59:12.670786Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"} {"level":"info","ts":"2026-06-16T22:59:12.670837Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"} {"level":"info","ts":"2026-06-16T22:59:12.670846Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"} {"level":"info","ts":"2026-06-16T22:59:12.672711Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 switched to configuration voters=(13277949878970367603)"} {"level":"info","ts":"2026-06-16T22:59:12.67286Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"49dc9693ccd466a9","local-member-id":"b844c110b9783e73","added-peer-id":"b844c110b9783e73","added-peer-peer-urls":["https://199.204.45.242:2380"]} {"level":"info","ts":"2026-06-16T22:59:12.675407Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]} {"level":"info","ts":"2026-06-16T22:59:12.675595Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"b844c110b9783e73","initial-advertise-peer-urls":["https://199.204.45.242:2380"],"listen-peer-urls":["https://199.204.45.242:2380"],"advertise-client-urls":["https://199.204.45.242:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.242:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-06-16T22:59:12.67562Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-06-16T22:59:12.675727Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.242:2380"} {"level":"info","ts":"2026-06-16T22:59:12.675738Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.242:2380"} {"level":"info","ts":"2026-06-16T22:59:13.058204Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 is starting a new election at term 1"} {"level":"info","ts":"2026-06-16T22:59:13.058298Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 became pre-candidate at term 1"} {"level":"info","ts":"2026-06-16T22:59:13.058336Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 received MsgPreVoteResp from b844c110b9783e73 at term 1"} {"level":"info","ts":"2026-06-16T22:59:13.058365Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 became candidate at term 2"} {"level":"info","ts":"2026-06-16T22:59:13.058382Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 received MsgVoteResp from b844c110b9783e73 at term 2"} {"level":"info","ts":"2026-06-16T22:59:13.058404Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"b844c110b9783e73 became leader at term 2"} {"level":"info","ts":"2026-06-16T22:59:13.058425Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: b844c110b9783e73 elected leader b844c110b9783e73 at term 2"} {"level":"info","ts":"2026-06-16T22:59:13.059352Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-06-16T22:59:13.060101Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"b844c110b9783e73","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.242:2379]}","request-path":"/0/members/b844c110b9783e73/attributes","cluster-id":"49dc9693ccd466a9","publish-timeout":"7s"} {"level":"info","ts":"2026-06-16T22:59:13.060109Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-16T22:59:13.060155Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-06-16T22:59:13.060535Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"49dc9693ccd466a9","local-member-id":"b844c110b9783e73","cluster-version":"3.5"} {"level":"info","ts":"2026-06-16T22:59:13.060607Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-06-16T22:59:13.06067Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-06-16T22:59:13.060683Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-06-16T22:59:13.060702Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-06-16T22:59:13.062346Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-06-16T22:59:13.064149Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.242:2379"} {"level":"warn","ts":"2026-06-16T22:59:23.513155Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4500115080289227884,"retry-timeout":"500ms"} {"level":"info","ts":"2026-06-16T22:59:23.77251Z","caller":"traceutil/trace.go:171","msg":"trace[1830022045] transaction","detail":"{read_only:false; response_revision:387; number_of_response:1; }","duration":"802.595486ms","start":"2026-06-16T22:59:22.969892Z","end":"2026-06-16T22:59:23.772487Z","steps":["trace[1830022045] 'process raft request' (duration: 802.476182ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:23.772539Z","caller":"traceutil/trace.go:171","msg":"trace[1772410264] linearizableReadLoop","detail":"{readStateIndex:399; appliedIndex:399; }","duration":"759.927284ms","start":"2026-06-16T22:59:23.012576Z","end":"2026-06-16T22:59:23.772503Z","steps":["trace[1772410264] 'read index received' (duration: 759.911934ms)","trace[1772410264] 'applied index is now lower than readState.Index' (duration: 12.89µs)"],"step_count":2} {"level":"warn","ts":"2026-06-16T22:59:23.772842Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"760.247294ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-06-16T22:59:23.772908Z","caller":"traceutil/trace.go:171","msg":"trace[219011204] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:387; }","duration":"760.389289ms","start":"2026-06-16T22:59:23.012507Z","end":"2026-06-16T22:59:23.772896Z","steps":["trace[219011204] 'agreement among raft nodes before linearized reading' (duration: 760.155741ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:23.77296Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:22.969866Z","time spent":"802.709088ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":464,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T22:59:23.772947Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:23.012485Z","time spent":"760.452981ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":528,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-06-16T22:59:23.773237Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"122.606491ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T22:59:23.773406Z","caller":"traceutil/trace.go:171","msg":"trace[758684194] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:387; }","duration":"122.825278ms","start":"2026-06-16T22:59:23.650552Z","end":"2026-06-16T22:59:23.773377Z","steps":["trace[758684194] 'agreement among raft nodes before linearized reading' (duration: 122.56127ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:24.300144Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"384.376572ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-16T22:59:24.300364Z","caller":"traceutil/trace.go:171","msg":"trace[626036299] linearizableReadLoop","detail":"{readStateIndex:401; appliedIndex:399; }","duration":"481.336816ms","start":"2026-06-16T22:59:23.819006Z","end":"2026-06-16T22:59:24.300343Z","steps":["trace[626036299] 'read index received' (duration: 96.464827ms)","trace[626036299] 'applied index is now lower than readState.Index' (duration: 384.870789ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T22:59:24.30046Z","caller":"traceutil/trace.go:171","msg":"trace[1518676314] transaction","detail":"{read_only:false; response_revision:389; number_of_response:1; }","duration":"509.982299ms","start":"2026-06-16T22:59:23.790446Z","end":"2026-06-16T22:59:24.300428Z","steps":["trace[1518676314] 'process raft request' (duration: 509.829265ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:24.300533Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"481.524242ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-06-16T22:59:24.300569Z","caller":"traceutil/trace.go:171","msg":"trace[1594709796] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:389; }","duration":"481.592935ms","start":"2026-06-16T22:59:23.818962Z","end":"2026-06-16T22:59:24.300555Z","steps":["trace[1594709796] 'agreement among raft nodes before linearized reading' (duration: 481.44321ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:24.300616Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:23.818946Z","time spent":"481.660256ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-06-16T22:59:24.300646Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:23.790421Z","time spent":"510.121454ms","remote":"127.0.0.1:50928","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5321,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T22:59:24.300651Z","caller":"traceutil/trace.go:171","msg":"trace[2073815343] transaction","detail":"{read_only:false; response_revision:388; number_of_response:1; }","duration":"523.590643ms","start":"2026-06-16T22:59:23.776931Z","end":"2026-06-16T22:59:24.300522Z","steps":["trace[2073815343] 'process raft request' (duration: 138.523949ms)","trace[2073815343] 'compare' (duration: 383.805004ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T22:59:24.300936Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:23.776914Z","time spent":"523.885133ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":490,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T22:59:24.75379Z","caller":"traceutil/trace.go:171","msg":"trace[1079389323] linearizableReadLoop","detail":"{readStateIndex:402; appliedIndex:401; }","duration":"435.579256ms","start":"2026-06-16T22:59:24.318177Z","end":"2026-06-16T22:59:24.753757Z","steps":["trace[1079389323] 'read index received' (duration: 361.485102ms)","trace[1079389323] 'applied index is now lower than readState.Index' (duration: 74.093174ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T22:59:24.753929Z","caller":"traceutil/trace.go:171","msg":"trace[1300366334] transaction","detail":"{read_only:false; response_revision:390; number_of_response:1; }","duration":"438.918533ms","start":"2026-06-16T22:59:24.314994Z","end":"2026-06-16T22:59:24.753912Z","steps":["trace[1300366334] 'process raft request' (duration: 364.737506ms)","trace[1300366334] 'compare' (duration: 73.559117ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T22:59:24.754039Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"222.816678ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/etcd-instance\" ","response":"range_response_count:1 size:5336"} {"level":"info","ts":"2026-06-16T22:59:24.754118Z","caller":"traceutil/trace.go:171","msg":"trace[2143020020] range","detail":"{range_begin:/registry/pods/kube-system/etcd-instance; range_end:; response_count:1; response_revision:390; }","duration":"222.933532ms","start":"2026-06-16T22:59:24.531162Z","end":"2026-06-16T22:59:24.754095Z","steps":["trace[2143020020] 'agreement among raft nodes before linearized reading' (duration: 222.805738ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:24.754183Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:24.314975Z","time spent":"439.090058ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T22:59:24.754352Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"436.180606ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-06-16T22:59:24.754396Z","caller":"traceutil/trace.go:171","msg":"trace[1581431193] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:390; }","duration":"437.916691ms","start":"2026-06-16T22:59:24.316469Z","end":"2026-06-16T22:59:24.754386Z","steps":["trace[1581431193] 'agreement among raft nodes before linearized reading' (duration: 437.841559ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:24.754433Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:24.316462Z","time spent":"437.961582ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-06-16T22:59:50.832415Z","caller":"traceutil/trace.go:171","msg":"trace[1984919732] transaction","detail":"{read_only:false; number_of_response:1; response_revision:536; }","duration":"294.886118ms","start":"2026-06-16T22:59:50.537502Z","end":"2026-06-16T22:59:50.832388Z","steps":["trace[1984919732] 'process raft request' (duration: 216.707084ms)","trace[1984919732] 'compare' (duration: 78.115082ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T22:59:50.835132Z","caller":"traceutil/trace.go:171","msg":"trace[1353235299] transaction","detail":"{read_only:false; response_revision:537; number_of_response:1; }","duration":"297.527512ms","start":"2026-06-16T22:59:50.53757Z","end":"2026-06-16T22:59:50.835098Z","steps":["trace[1353235299] 'process raft request' (duration: 297.270413ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.835219Z","caller":"traceutil/trace.go:171","msg":"trace[989932589] transaction","detail":"{read_only:false; response_revision:538; number_of_response:1; }","duration":"289.582209ms","start":"2026-06-16T22:59:50.545622Z","end":"2026-06-16T22:59:50.835204Z","steps":["trace[989932589] 'process raft request' (duration: 289.402893ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.835616Z","caller":"traceutil/trace.go:171","msg":"trace[1726448014] transaction","detail":"{read_only:false; response_revision:539; number_of_response:1; }","duration":"286.661846ms","start":"2026-06-16T22:59:50.548944Z","end":"2026-06-16T22:59:50.835606Z","steps":["trace[1726448014] 'process raft request' (duration: 286.126379ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.835693Z","caller":"traceutil/trace.go:171","msg":"trace[1817867245] transaction","detail":"{read_only:false; response_revision:540; number_of_response:1; }","duration":"280.268831ms","start":"2026-06-16T22:59:50.555417Z","end":"2026-06-16T22:59:50.835686Z","steps":["trace[1817867245] 'process raft request' (duration: 280.139097ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.835853Z","caller":"traceutil/trace.go:171","msg":"trace[1337324955] transaction","detail":"{read_only:false; response_revision:541; number_of_response:1; }","duration":"275.070535ms","start":"2026-06-16T22:59:50.560771Z","end":"2026-06-16T22:59:50.835841Z","steps":["trace[1337324955] 'process raft request' (duration: 274.856158ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.840308Z","caller":"traceutil/trace.go:171","msg":"trace[1475270658] transaction","detail":"{read_only:false; response_revision:542; number_of_response:1; }","duration":"276.235303ms","start":"2026-06-16T22:59:50.564036Z","end":"2026-06-16T22:59:50.840271Z","steps":["trace[1475270658] 'process raft request' (duration: 273.192745ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.840509Z","caller":"traceutil/trace.go:171","msg":"trace[1741217659] transaction","detail":"{read_only:false; response_revision:548; number_of_response:1; }","duration":"139.248952ms","start":"2026-06-16T22:59:50.701194Z","end":"2026-06-16T22:59:50.840443Z","steps":["trace[1741217659] 'process raft request' (duration: 137.327671ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.840699Z","caller":"traceutil/trace.go:171","msg":"trace[245312156] transaction","detail":"{read_only:false; response_revision:546; number_of_response:1; }","duration":"256.597826ms","start":"2026-06-16T22:59:50.584053Z","end":"2026-06-16T22:59:50.84065Z","steps":["trace[245312156] 'process raft request' (duration: 253.92265ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.840897Z","caller":"traceutil/trace.go:171","msg":"trace[2044366828] transaction","detail":"{read_only:false; response_revision:547; number_of_response:1; }","duration":"252.92985ms","start":"2026-06-16T22:59:50.587905Z","end":"2026-06-16T22:59:50.840835Z","steps":["trace[2044366828] 'process raft request' (duration: 250.189622ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.840912Z","caller":"traceutil/trace.go:171","msg":"trace[716706712] transaction","detail":"{read_only:false; response_revision:545; number_of_response:1; }","duration":"259.566941ms","start":"2026-06-16T22:59:50.581193Z","end":"2026-06-16T22:59:50.84076Z","steps":["trace[716706712] 'process raft request' (duration: 256.681979ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.840984Z","caller":"traceutil/trace.go:171","msg":"trace[1741629728] transaction","detail":"{read_only:false; response_revision:544; number_of_response:1; }","duration":"268.278699ms","start":"2026-06-16T22:59:50.572664Z","end":"2026-06-16T22:59:50.840943Z","steps":["trace[1741629728] 'process raft request' (duration: 265.120108ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:50.841834Z","caller":"traceutil/trace.go:171","msg":"trace[898523762] transaction","detail":"{read_only:false; response_revision:543; number_of_response:1; }","duration":"274.534208ms","start":"2026-06-16T22:59:50.564083Z","end":"2026-06-16T22:59:50.838617Z","steps":["trace[898523762] 'process raft request' (duration: 273.254577ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:51.058241Z","caller":"traceutil/trace.go:171","msg":"trace[1778436145] transaction","detail":"{read_only:false; response_revision:556; number_of_response:1; }","duration":"160.511151ms","start":"2026-06-16T22:59:50.897706Z","end":"2026-06-16T22:59:51.058217Z","steps":["trace[1778436145] 'process raft request' (duration: 160.358736ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:51.058248Z","caller":"traceutil/trace.go:171","msg":"trace[1642639774] transaction","detail":"{read_only:false; response_revision:555; number_of_response:1; }","duration":"170.451517ms","start":"2026-06-16T22:59:50.887754Z","end":"2026-06-16T22:59:51.058206Z","steps":["trace[1642639774] 'process raft request' (duration: 166.250303ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:51.058397Z","caller":"traceutil/trace.go:171","msg":"trace[738474102] linearizableReadLoop","detail":"{readStateIndex:578; appliedIndex:574; }","duration":"121.019061ms","start":"2026-06-16T22:59:50.937359Z","end":"2026-06-16T22:59:51.058379Z","steps":["trace[738474102] 'read index received' (duration: 116.683802ms)","trace[738474102] 'applied index is now lower than readState.Index' (duration: 4.334559ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T22:59:51.058464Z","caller":"traceutil/trace.go:171","msg":"trace[524049799] transaction","detail":"{read_only:false; response_revision:559; number_of_response:1; }","duration":"116.402343ms","start":"2026-06-16T22:59:50.942055Z","end":"2026-06-16T22:59:51.058457Z","steps":["trace[524049799] 'process raft request' (duration: 116.184646ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:51.058496Z","caller":"traceutil/trace.go:171","msg":"trace[1356100758] transaction","detail":"{read_only:false; response_revision:560; number_of_response:1; }","duration":"107.656324ms","start":"2026-06-16T22:59:50.950828Z","end":"2026-06-16T22:59:51.058484Z","steps":["trace[1356100758] 'process raft request' (duration: 107.459668ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:51.058524Z","caller":"traceutil/trace.go:171","msg":"trace[2080264409] transaction","detail":"{read_only:false; response_revision:558; number_of_response:1; }","duration":"153.027782ms","start":"2026-06-16T22:59:50.90549Z","end":"2026-06-16T22:59:51.058518Z","steps":["trace[2080264409] 'process raft request' (duration: 152.713642ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:51.058505Z","caller":"traceutil/trace.go:171","msg":"trace[175900335] transaction","detail":"{read_only:false; response_revision:557; number_of_response:1; }","duration":"160.709347ms","start":"2026-06-16T22:59:50.897764Z","end":"2026-06-16T22:59:51.058474Z","steps":["trace[175900335] 'process raft request' (duration: 160.398097ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:51.058633Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"121.261259ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-16T22:59:51.058636Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.677871ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-06-16T22:59:51.058658Z","caller":"traceutil/trace.go:171","msg":"trace[2059859811] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:560; }","duration":"121.323591ms","start":"2026-06-16T22:59:50.937327Z","end":"2026-06-16T22:59:51.058651Z","steps":["trace[2059859811] 'agreement among raft nodes before linearized reading' (duration: 121.256738ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:51.058662Z","caller":"traceutil/trace.go:171","msg":"trace[1909179770] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:560; }","duration":"115.725352ms","start":"2026-06-16T22:59:50.942929Z","end":"2026-06-16T22:59:51.058655Z","steps":["trace[1909179770] 'agreement among raft nodes before linearized reading' (duration: 115.648409ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:51.058823Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.186204ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-06-16T22:59:51.058867Z","caller":"traceutil/trace.go:171","msg":"trace[390862535] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:560; }","duration":"115.248887ms","start":"2026-06-16T22:59:50.943603Z","end":"2026-06-16T22:59:51.058852Z","steps":["trace[390862535] 'agreement among raft nodes before linearized reading' (duration: 115.120193ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:51.372643Z","caller":"traceutil/trace.go:171","msg":"trace[465915182] transaction","detail":"{read_only:false; response_revision:583; number_of_response:1; }","duration":"116.416324ms","start":"2026-06-16T22:59:51.256203Z","end":"2026-06-16T22:59:51.372619Z","steps":["trace[465915182] 'process raft request' (duration: 116.133835ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:51.379947Z","caller":"traceutil/trace.go:171","msg":"trace[1999955260] transaction","detail":"{read_only:false; response_revision:582; number_of_response:1; }","duration":"152.013159ms","start":"2026-06-16T22:59:51.22788Z","end":"2026-06-16T22:59:51.379893Z","steps":["trace[1999955260] 'process raft request' (duration: 125.439912ms)","trace[1999955260] 'compare' (duration: 18.758038ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T22:59:56.986652Z","caller":"traceutil/trace.go:171","msg":"trace[476821394] transaction","detail":"{read_only:false; response_revision:628; number_of_response:1; }","duration":"142.786426ms","start":"2026-06-16T22:59:56.843838Z","end":"2026-06-16T22:59:56.986624Z","steps":["trace[476821394] 'process raft request' (duration: 127.965913ms)","trace[476821394] 'compare' (duration: 14.610246ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T22:59:57.290324Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"196.486908ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-06-16T22:59:57.290423Z","caller":"traceutil/trace.go:171","msg":"trace[2084102955] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:628; }","duration":"196.625573ms","start":"2026-06-16T22:59:57.093776Z","end":"2026-06-16T22:59:57.290401Z","steps":["trace[2084102955] 'range keys from in-memory index tree' (duration: 196.294192ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:57.290515Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.72765ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-06-16T22:59:57.29065Z","caller":"traceutil/trace.go:171","msg":"trace[305288623] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:628; }","duration":"182.983687ms","start":"2026-06-16T22:59:57.107645Z","end":"2026-06-16T22:59:57.290629Z","steps":["trace[305288623] 'range keys from in-memory index tree' (duration: 182.605805ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:57.400144Z","caller":"traceutil/trace.go:171","msg":"trace[818605377] transaction","detail":"{read_only:false; response_revision:629; number_of_response:1; }","duration":"104.725531ms","start":"2026-06-16T22:59:57.2954Z","end":"2026-06-16T22:59:57.400126Z","steps":["trace[818605377] 'process raft request' (duration: 104.608038ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:58.035545Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4500115080289228414,"retry-timeout":"500ms"} {"level":"info","ts":"2026-06-16T22:59:58.125573Z","caller":"traceutil/trace.go:171","msg":"trace[1967439480] transaction","detail":"{read_only:false; response_revision:630; number_of_response:1; }","duration":"829.265096ms","start":"2026-06-16T22:59:57.296272Z","end":"2026-06-16T22:59:58.125537Z","steps":["trace[1967439480] 'process raft request' (duration: 828.987777ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:58.125736Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:57.296257Z","time spent":"829.40505ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":418,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T22:59:58.127853Z","caller":"traceutil/trace.go:171","msg":"trace[716813020] transaction","detail":"{read_only:false; response_revision:631; number_of_response:1; }","duration":"740.163804ms","start":"2026-06-16T22:59:57.387675Z","end":"2026-06-16T22:59:58.127839Z","steps":["trace[716813020] 'process raft request' (duration: 738.458319ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:58.127942Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"593.011729ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T22:59:58.127835Z","caller":"traceutil/trace.go:171","msg":"trace[1048879723] linearizableReadLoop","detail":"{readStateIndex:653; appliedIndex:651; }","duration":"592.900015ms","start":"2026-06-16T22:59:57.53491Z","end":"2026-06-16T22:59:58.12781Z","steps":["trace[1048879723] 'read index received' (duration: 590.333193ms)","trace[1048879723] 'applied index is now lower than readState.Index' (duration: 2.565452ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T22:59:58.127994Z","caller":"traceutil/trace.go:171","msg":"trace[1939752513] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:631; }","duration":"593.117462ms","start":"2026-06-16T22:59:57.534865Z","end":"2026-06-16T22:59:58.127983Z","steps":["trace[1939752513] 'agreement among raft nodes before linearized reading' (duration: 593.025009ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:58.12804Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:57.534845Z","time spent":"593.187455ms","remote":"127.0.0.1:50740","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-06-16T22:59:58.128178Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:57.387646Z","time spent":"740.257727ms","remote":"127.0.0.1:50826","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036165,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T22:59:58.128262Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"201.571471ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-06-16T22:59:58.128308Z","caller":"traceutil/trace.go:171","msg":"trace[1689816318] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:631; }","duration":"201.664493ms","start":"2026-06-16T22:59:57.92663Z","end":"2026-06-16T22:59:58.128294Z","steps":["trace[1689816318] 'agreement among raft nodes before linearized reading' (duration: 201.453316ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:58.477238Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.399294ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-06-16T22:59:58.47744Z","caller":"traceutil/trace.go:171","msg":"trace[653551858] transaction","detail":"{read_only:false; response_revision:633; number_of_response:1; }","duration":"285.83624ms","start":"2026-06-16T22:59:58.191583Z","end":"2026-06-16T22:59:58.477419Z","steps":["trace[653551858] 'process raft request' (duration: 32.180707ms)","trace[653551858] 'compare' (duration: 253.208038ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T22:59:59.431799Z","caller":"traceutil/trace.go:171","msg":"trace[1362514878] transaction","detail":"{read_only:false; response_revision:634; number_of_response:1; }","duration":"871.355128ms","start":"2026-06-16T22:59:58.560414Z","end":"2026-06-16T22:59:59.431769Z","steps":["trace[1362514878] 'process raft request' (duration: 871.203523ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:59.431968Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:58.560397Z","time spent":"871.484252ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T22:59:59.445044Z","caller":"traceutil/trace.go:171","msg":"trace[279375189] transaction","detail":"{read_only:false; response_revision:635; number_of_response:1; }","duration":"582.041919ms","start":"2026-06-16T22:59:58.862975Z","end":"2026-06-16T22:59:59.445017Z","steps":["trace[279375189] 'process raft request' (duration: 581.78157ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T22:59:59.445509Z","caller":"traceutil/trace.go:171","msg":"trace[2083868285] transaction","detail":"{read_only:false; response_revision:636; number_of_response:1; }","duration":"568.504707ms","start":"2026-06-16T22:59:58.876971Z","end":"2026-06-16T22:59:59.445476Z","steps":["trace[2083868285] 'process raft request' (duration: 568.011291ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T22:59:59.445717Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:58.876946Z","time spent":"568.667742ms","remote":"127.0.0.1:50826","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036197,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T22:59:59.445729Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T22:59:58.862953Z","time spent":"582.640798ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:00:01.013837Z","caller":"traceutil/trace.go:171","msg":"trace[851709784] transaction","detail":"{read_only:false; response_revision:656; number_of_response:1; }","duration":"255.671687ms","start":"2026-06-16T23:00:00.75811Z","end":"2026-06-16T23:00:01.013782Z","steps":["trace[851709784] 'process raft request' (duration: 210.864977ms)","trace[851709784] 'compare' (duration: 44.551562ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T23:00:03.9Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.562723ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T23:00:03.900132Z","caller":"traceutil/trace.go:171","msg":"trace[1625497618] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:715; }","duration":"113.712808ms","start":"2026-06-16T23:00:03.786401Z","end":"2026-06-16T23:00:03.900113Z","steps":["trace[1625497618] 'range keys from in-memory index tree' (duration: 113.546272ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:00:14.388935Z","caller":"traceutil/trace.go:171","msg":"trace[1806468001] linearizableReadLoop","detail":"{readStateIndex:828; appliedIndex:827; }","duration":"191.646964ms","start":"2026-06-16T23:00:14.197264Z","end":"2026-06-16T23:00:14.388911Z","steps":["trace[1806468001] 'read index received' (duration: 191.5117ms)","trace[1806468001] 'applied index is now lower than readState.Index' (duration: 134.284µs)"],"step_count":2} {"level":"info","ts":"2026-06-16T23:00:14.388992Z","caller":"traceutil/trace.go:171","msg":"trace[287221413] transaction","detail":"{read_only:false; response_revision:802; number_of_response:1; }","duration":"661.814443ms","start":"2026-06-16T23:00:13.72714Z","end":"2026-06-16T23:00:14.388955Z","steps":["trace[287221413] 'process raft request' (duration: 661.635318ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:00:14.389154Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:00:13.727121Z","time spent":"661.947688ms","remote":"127.0.0.1:50928","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4028,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T23:00:14.389191Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"191.891972ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"} {"level":"info","ts":"2026-06-16T23:00:14.389269Z","caller":"traceutil/trace.go:171","msg":"trace[2043154680] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:802; }","duration":"192.040437ms","start":"2026-06-16T23:00:14.197212Z","end":"2026-06-16T23:00:14.389253Z","steps":["trace[2043154680] 'agreement among raft nodes before linearized reading' (duration: 191.82782ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:00:14.389167Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"181.599353ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"} {"level":"info","ts":"2026-06-16T23:00:14.389316Z","caller":"traceutil/trace.go:171","msg":"trace[1767426439] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:802; }","duration":"181.796359ms","start":"2026-06-16T23:00:14.207509Z","end":"2026-06-16T23:00:14.389305Z","steps":["trace[1767426439] 'agreement among raft nodes before linearized reading' (duration: 181.555452ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:00:49.187762Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"238.975581ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-16T23:00:49.18787Z","caller":"traceutil/trace.go:171","msg":"trace[516060126] transaction","detail":"{read_only:false; response_revision:1015; number_of_response:1; }","duration":"616.687758ms","start":"2026-06-16T23:00:48.57116Z","end":"2026-06-16T23:00:49.187848Z","steps":["trace[516060126] 'process raft request' (duration: 377.552352ms)","trace[516060126] 'compare' (duration: 238.808506ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T23:00:49.187938Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:00:48.571152Z","time spent":"616.756651ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":419,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T23:00:49.755061Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"238.891839ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-16T23:00:49.75515Z","caller":"traceutil/trace.go:171","msg":"trace[220452673] linearizableReadLoop","detail":"{readStateIndex:1052; appliedIndex:1051; }","duration":"456.15006ms","start":"2026-06-16T23:00:49.298985Z","end":"2026-06-16T23:00:49.755135Z","steps":["trace[220452673] 'read index received' (duration: 217.033204ms)","trace[220452673] 'applied index is now lower than readState.Index' (duration: 239.115956ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T23:00:49.755321Z","caller":"traceutil/trace.go:171","msg":"trace[584576081] transaction","detail":"{read_only:false; response_revision:1016; number_of_response:1; }","duration":"545.351383ms","start":"2026-06-16T23:00:49.209946Z","end":"2026-06-16T23:00:49.755297Z","steps":["trace[584576081] 'process raft request' (duration: 306.138665ms)","trace[584576081] 'compare' (duration: 238.812126ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T23:00:49.755364Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"220.007269ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-06-16T23:00:49.755415Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"111.321916ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"warn","ts":"2026-06-16T23:00:49.755422Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:00:49.209927Z","time spent":"545.447137ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":533,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T23:00:49.755361Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"456.357357ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-06-16T23:00:49.755455Z","caller":"traceutil/trace.go:171","msg":"trace[1999221257] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1016; }","duration":"111.397319ms","start":"2026-06-16T23:00:49.644048Z","end":"2026-06-16T23:00:49.755445Z","steps":["trace[1999221257] 'agreement among raft nodes before linearized reading' (duration: 111.270445ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:00:49.755463Z","caller":"traceutil/trace.go:171","msg":"trace[1748869558] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1016; }","duration":"456.47585ms","start":"2026-06-16T23:00:49.298978Z","end":"2026-06-16T23:00:49.755454Z","steps":["trace[1748869558] 'agreement among raft nodes before linearized reading' (duration: 456.247993ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:00:49.755498Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:00:49.298957Z","time spent":"456.531832ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-06-16T23:00:49.755427Z","caller":"traceutil/trace.go:171","msg":"trace[314028050] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1016; }","duration":"220.114272ms","start":"2026-06-16T23:00:49.535299Z","end":"2026-06-16T23:00:49.755413Z","steps":["trace[314028050] 'agreement among raft nodes before linearized reading' (duration: 220.012319ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:01:10.877628Z","caller":"traceutil/trace.go:171","msg":"trace[1586795293] transaction","detail":"{read_only:false; response_revision:1086; number_of_response:1; }","duration":"145.940076ms","start":"2026-06-16T23:01:10.73167Z","end":"2026-06-16T23:01:10.87761Z","steps":["trace[1586795293] 'process raft request' (duration: 145.823572ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:11.332545Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"396.00497ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T23:01:11.332615Z","caller":"traceutil/trace.go:171","msg":"trace[743557606] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1086; }","duration":"396.080852ms","start":"2026-06-16T23:01:10.936518Z","end":"2026-06-16T23:01:11.332599Z","steps":["trace[743557606] 'range keys from in-memory index tree' (duration: 395.912856ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:11.33265Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:10.936461Z","time spent":"396.181405ms","remote":"127.0.0.1:50740","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":28,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-06-16T23:01:11.333117Z","caller":"traceutil/trace.go:171","msg":"trace[888616770] linearizableReadLoop","detail":"{readStateIndex:1127; appliedIndex:1126; }","duration":"153.816316ms","start":"2026-06-16T23:01:11.179286Z","end":"2026-06-16T23:01:11.333103Z","steps":["trace[888616770] 'read index received' (duration: 80.703173ms)","trace[888616770] 'applied index is now lower than readState.Index' (duration: 73.112223ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T23:01:11.333245Z","caller":"traceutil/trace.go:171","msg":"trace[1951463046] transaction","detail":"{read_only:false; response_revision:1087; number_of_response:1; }","duration":"389.956747ms","start":"2026-06-16T23:01:10.943273Z","end":"2026-06-16T23:01:11.33323Z","steps":["trace[1951463046] 'process raft request' (duration: 316.722181ms)","trace[1951463046] 'compare' (duration: 72.917796ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T23:01:11.333338Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:10.943248Z","time spent":"390.03429ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":521,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T23:01:11.333374Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.061293ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/\" range_end:\"/registry/namespaces0\" count_only:true ","response":"range_response_count:0 size:7"} {"level":"info","ts":"2026-06-16T23:01:11.333437Z","caller":"traceutil/trace.go:171","msg":"trace[1070617493] range","detail":"{range_begin:/registry/namespaces/; range_end:/registry/namespaces0; response_count:0; response_revision:1087; }","duration":"154.180778ms","start":"2026-06-16T23:01:11.179241Z","end":"2026-06-16T23:01:11.333422Z","steps":["trace[1070617493] 'agreement among raft nodes before linearized reading' (duration: 154.040214ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:12.343077Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4500115080289229409,"retry-timeout":"500ms"} {"level":"info","ts":"2026-06-16T23:01:12.345003Z","caller":"traceutil/trace.go:171","msg":"trace[498302338] linearizableReadLoop","detail":"{readStateIndex:1130; appliedIndex:1129; }","duration":"502.670278ms","start":"2026-06-16T23:01:11.842304Z","end":"2026-06-16T23:01:12.344975Z","steps":["trace[498302338] 'read index received' (duration: 502.464372ms)","trace[498302338] 'applied index is now lower than readState.Index' (duration: 205.186µs)"],"step_count":2} {"level":"info","ts":"2026-06-16T23:01:12.345069Z","caller":"traceutil/trace.go:171","msg":"trace[1865259319] transaction","detail":"{read_only:false; response_revision:1089; number_of_response:1; }","duration":"517.608942ms","start":"2026-06-16T23:01:11.827439Z","end":"2026-06-16T23:01:12.345048Z","steps":["trace[1865259319] 'process raft request' (duration: 517.385535ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:12.3452Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"502.894855ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"} {"level":"info","ts":"2026-06-16T23:01:12.345233Z","caller":"traceutil/trace.go:171","msg":"trace[28086066] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1089; }","duration":"502.977307ms","start":"2026-06-16T23:01:11.842246Z","end":"2026-06-16T23:01:12.345224Z","steps":["trace[28086066] 'agreement among raft nodes before linearized reading' (duration: 502.817632ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:12.34524Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:11.827411Z","time spent":"517.720366ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T23:01:12.345263Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:11.842225Z","time spent":"503.030379ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":461,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-06-16T23:01:12.34528Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"489.763017ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"} {"level":"info","ts":"2026-06-16T23:01:12.345334Z","caller":"traceutil/trace.go:171","msg":"trace[1086675885] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1089; }","duration":"489.84597ms","start":"2026-06-16T23:01:11.855474Z","end":"2026-06-16T23:01:12.34532Z","steps":["trace[1086675885] 'agreement among raft nodes before linearized reading' (duration: 489.717336ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:12.345349Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"497.355629ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"} {"level":"warn","ts":"2026-06-16T23:01:12.345376Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:11.855463Z","time spent":"489.900932ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":515,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-06-16T23:01:12.345407Z","caller":"traceutil/trace.go:171","msg":"trace[1216472288] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1089; }","duration":"497.435531ms","start":"2026-06-16T23:01:11.847958Z","end":"2026-06-16T23:01:12.345393Z","steps":["trace[1216472288] 'agreement among raft nodes before linearized reading' (duration: 497.167803ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:12.345466Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:11.847948Z","time spent":"497.509233ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":529,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "} {"level":"warn","ts":"2026-06-16T23:01:12.681119Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"189.105897ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-16T23:01:12.68147Z","caller":"traceutil/trace.go:171","msg":"trace[1693191256] linearizableReadLoop","detail":"{readStateIndex:1133; appliedIndex:1130; }","duration":"145.764691ms","start":"2026-06-16T23:01:12.535688Z","end":"2026-06-16T23:01:12.681453Z","steps":["trace[1693191256] 'read index received' (duration: 143.080085ms)","trace[1693191256] 'applied index is now lower than readState.Index' (duration: 2.683576ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T23:01:12.681467Z","caller":"traceutil/trace.go:171","msg":"trace[326227485] transaction","detail":"{read_only:false; response_revision:1090; number_of_response:1; }","duration":"332.539363ms","start":"2026-06-16T23:01:12.348899Z","end":"2026-06-16T23:01:12.681438Z","steps":["trace[326227485] 'process raft request' (duration: 142.968791ms)","trace[326227485] 'compare' (duration: 188.964033ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T23:01:12.681547Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"145.862613ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T23:01:12.681524Z","caller":"traceutil/trace.go:171","msg":"trace[248439501] transaction","detail":"{read_only:false; response_revision:1091; number_of_response:1; }","duration":"331.16633ms","start":"2026-06-16T23:01:12.350302Z","end":"2026-06-16T23:01:12.681468Z","steps":["trace[248439501] 'process raft request' (duration: 331.023606ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:01:12.681581Z","caller":"traceutil/trace.go:171","msg":"trace[1381355230] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1092; }","duration":"145.935025ms","start":"2026-06-16T23:01:12.535636Z","end":"2026-06-16T23:01:12.681571Z","steps":["trace[1381355230] 'agreement among raft nodes before linearized reading' (duration: 145.879324ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:12.681605Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:12.348824Z","time spent":"332.706079ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T23:01:12.681673Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:12.350279Z","time spent":"331.316095ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:01:12.68174Z","caller":"traceutil/trace.go:171","msg":"trace[865840216] transaction","detail":"{read_only:false; response_revision:1092; number_of_response:1; }","duration":"330.476227ms","start":"2026-06-16T23:01:12.351253Z","end":"2026-06-16T23:01:12.68173Z","steps":["trace[865840216] 'process raft request' (duration: 330.161147ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:12.681801Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:12.351236Z","time spent":"330.5318ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:01:13.485287Z","caller":"traceutil/trace.go:171","msg":"trace[180336300] transaction","detail":"{read_only:false; response_revision:1094; number_of_response:1; }","duration":"127.690156ms","start":"2026-06-16T23:01:13.35757Z","end":"2026-06-16T23:01:13.48526Z","steps":["trace[180336300] 'process raft request' (duration: 127.530041ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:01:27.629551Z","caller":"traceutil/trace.go:171","msg":"trace[862916508] transaction","detail":"{read_only:false; response_revision:1192; number_of_response:1; }","duration":"276.807163ms","start":"2026-06-16T23:01:27.352721Z","end":"2026-06-16T23:01:27.629528Z","steps":["trace[862916508] 'process raft request' (duration: 276.319037ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:01:28.787674Z","caller":"traceutil/trace.go:171","msg":"trace[755697677] linearizableReadLoop","detail":"{readStateIndex:1240; appliedIndex:1239; }","duration":"253.132241ms","start":"2026-06-16T23:01:28.53452Z","end":"2026-06-16T23:01:28.787653Z","steps":["trace[755697677] 'read index received' (duration: 252.965845ms)","trace[755697677] 'applied index is now lower than readState.Index' (duration: 165.586µs)"],"step_count":2} {"level":"info","ts":"2026-06-16T23:01:28.787792Z","caller":"traceutil/trace.go:171","msg":"trace[29003457] transaction","detail":"{read_only:false; response_revision:1194; number_of_response:1; }","duration":"393.744508ms","start":"2026-06-16T23:01:28.394037Z","end":"2026-06-16T23:01:28.787782Z","steps":["trace[29003457] 'process raft request' (duration: 393.50584ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:28.787961Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:28.394018Z","time spent":"393.876461ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T23:01:28.788043Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.521163ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T23:01:28.788073Z","caller":"traceutil/trace.go:171","msg":"trace[772954292] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1194; }","duration":"253.585375ms","start":"2026-06-16T23:01:28.534481Z","end":"2026-06-16T23:01:28.788066Z","steps":["trace[772954292] 'agreement among raft nodes before linearized reading' (duration: 253.548114ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:01:29.282617Z","caller":"traceutil/trace.go:171","msg":"trace[1913131365] transaction","detail":"{read_only:false; response_revision:1195; number_of_response:1; }","duration":"490.307475ms","start":"2026-06-16T23:01:28.792277Z","end":"2026-06-16T23:01:29.282585Z","steps":["trace[1913131365] 'process raft request' (duration: 488.919731ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:29.282785Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:28.792261Z","time spent":"490.43699ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:01:29.284188Z","caller":"traceutil/trace.go:171","msg":"trace[130470967] transaction","detail":"{read_only:false; response_revision:1196; number_of_response:1; }","duration":"491.666268ms","start":"2026-06-16T23:01:28.7925Z","end":"2026-06-16T23:01:29.284166Z","steps":["trace[130470967] 'process raft request' (duration: 491.525494ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:29.284307Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:28.792468Z","time spent":"491.770861ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:01:29.284291Z","caller":"traceutil/trace.go:171","msg":"trace[2021400374] linearizableReadLoop","detail":"{readStateIndex:1243; appliedIndex:1240; }","duration":"295.817126ms","start":"2026-06-16T23:01:28.988451Z","end":"2026-06-16T23:01:29.284268Z","steps":["trace[2021400374] 'read index received' (duration: 292.758149ms)","trace[2021400374] 'applied index is now lower than readState.Index' (duration: 3.057307ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T23:01:29.284385Z","caller":"traceutil/trace.go:171","msg":"trace[1983098528] transaction","detail":"{read_only:false; response_revision:1197; number_of_response:1; }","duration":"491.777421ms","start":"2026-06-16T23:01:28.79259Z","end":"2026-06-16T23:01:29.284367Z","steps":["trace[1983098528] 'process raft request' (duration: 491.544404ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:29.284449Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"295.996443ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"} {"level":"info","ts":"2026-06-16T23:01:29.284481Z","caller":"traceutil/trace.go:171","msg":"trace[1863651961] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:1197; }","duration":"296.055525ms","start":"2026-06-16T23:01:28.988414Z","end":"2026-06-16T23:01:29.28447Z","steps":["trace[1863651961] 'agreement among raft nodes before linearized reading' (duration: 295.936691ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:29.284478Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:28.792578Z","time spent":"491.838434ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-06-16T23:01:47.422821Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"395.059957ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-06-16T23:01:47.422979Z","caller":"traceutil/trace.go:171","msg":"trace[501435979] transaction","detail":"{read_only:false; response_revision:1272; number_of_response:1; }","duration":"665.088997ms","start":"2026-06-16T23:01:46.757879Z","end":"2026-06-16T23:01:47.422968Z","steps":["trace[501435979] 'process raft request' (duration: 269.830353ms)","trace[501435979] 'compare' (duration: 394.895792ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T23:01:47.423011Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:46.75786Z","time spent":"665.136218ms","remote":"127.0.0.1:50764","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":120,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:01:47.423185Z","caller":"traceutil/trace.go:171","msg":"trace[1883773204] transaction","detail":"{read_only:false; response_revision:1273; number_of_response:1; }","duration":"582.897341ms","start":"2026-06-16T23:01:46.840282Z","end":"2026-06-16T23:01:47.42318Z","steps":["trace[1883773204] 'process raft request' (duration: 582.601901ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:47.423212Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:46.840237Z","time spent":"582.958913ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":534,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:01:47.572932Z","caller":"traceutil/trace.go:171","msg":"trace[890281524] transaction","detail":"{read_only:false; response_revision:1275; number_of_response:1; }","duration":"141.416535ms","start":"2026-06-16T23:01:47.431484Z","end":"2026-06-16T23:01:47.572901Z","steps":["trace[890281524] 'process raft request' (duration: 98.717995ms)","trace[890281524] 'compare' (duration: 42.371409ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T23:01:47.573255Z","caller":"traceutil/trace.go:171","msg":"trace[316855678] transaction","detail":"{read_only:false; response_revision:1276; number_of_response:1; }","duration":"141.27564ms","start":"2026-06-16T23:01:47.431952Z","end":"2026-06-16T23:01:47.573227Z","steps":["trace[316855678] 'process raft request' (duration: 141.135306ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:01:47.573469Z","caller":"traceutil/trace.go:171","msg":"trace[1733461860] linearizableReadLoop","detail":"{readStateIndex:1325; appliedIndex:1323; }","duration":"141.716904ms","start":"2026-06-16T23:01:47.431726Z","end":"2026-06-16T23:01:47.573443Z","steps":["trace[1733461860] 'read index received' (duration: 20.752275ms)","trace[1733461860] 'applied index is now lower than readState.Index' (duration: 120.963349ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T23:01:47.573724Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"141.974762ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/\" range_end:\"/registry/masterleases0\" ","response":"range_response_count:1 size:135"} {"level":"info","ts":"2026-06-16T23:01:47.573794Z","caller":"traceutil/trace.go:171","msg":"trace[955451977] range","detail":"{range_begin:/registry/masterleases/; range_end:/registry/masterleases0; response_count:1; response_revision:1277; }","duration":"142.065306ms","start":"2026-06-16T23:01:47.43171Z","end":"2026-06-16T23:01:47.573775Z","steps":["trace[955451977] 'agreement among raft nodes before linearized reading' (duration: 141.89698ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:01:47.574003Z","caller":"traceutil/trace.go:171","msg":"trace[1259591022] transaction","detail":"{read_only:false; response_revision:1277; number_of_response:1; }","duration":"141.764876ms","start":"2026-06-16T23:01:47.432227Z","end":"2026-06-16T23:01:47.573992Z","steps":["trace[1259591022] 'process raft request' (duration: 140.935479ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:01:48.487073Z","caller":"traceutil/trace.go:171","msg":"trace[781653837] transaction","detail":"{read_only:false; response_revision:1285; number_of_response:1; }","duration":"376.428811ms","start":"2026-06-16T23:01:48.110621Z","end":"2026-06-16T23:01:48.48705Z","steps":["trace[781653837] 'process raft request' (duration: 376.283606ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:48.487212Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:48.110599Z","time spent":"376.543885ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":457,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:01:48.77168Z","caller":"traceutil/trace.go:171","msg":"trace[908072955] transaction","detail":"{read_only:false; response_revision:1286; number_of_response:1; }","duration":"572.067214ms","start":"2026-06-16T23:01:48.199592Z","end":"2026-06-16T23:01:48.771659Z","steps":["trace[908072955] 'process raft request' (duration: 552.159336ms)","trace[908072955] 'compare' (duration: 19.595328ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T23:01:48.771792Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:48.199576Z","time spent":"572.160787ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":672,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:01:50.199161Z","caller":"traceutil/trace.go:171","msg":"trace[1461882339] linearizableReadLoop","detail":"{readStateIndex:1341; appliedIndex:1339; }","duration":"440.848056ms","start":"2026-06-16T23:01:49.758295Z","end":"2026-06-16T23:01:50.199143Z","steps":["trace[1461882339] 'read index received' (duration: 440.681771ms)","trace[1461882339] 'applied index is now lower than readState.Index' (duration: 165.675µs)"],"step_count":2} {"level":"warn","ts":"2026-06-16T23:01:50.199393Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"441.018692ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-06-16T23:01:50.199428Z","caller":"traceutil/trace.go:171","msg":"trace[2063026331] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1291; }","duration":"441.176657ms","start":"2026-06-16T23:01:49.758241Z","end":"2026-06-16T23:01:50.199418Z","steps":["trace[2063026331] 'agreement among raft nodes before linearized reading' (duration: 440.97252ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:50.199457Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:49.758221Z","time spent":"441.228299ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"info","ts":"2026-06-16T23:01:50.199721Z","caller":"traceutil/trace.go:171","msg":"trace[1287526658] transaction","detail":"{read_only:false; response_revision:1290; number_of_response:1; }","duration":"586.103014ms","start":"2026-06-16T23:01:49.6136Z","end":"2026-06-16T23:01:50.199703Z","steps":["trace[1287526658] 'process raft request' (duration: 585.422892ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:50.199788Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:49.613573Z","time spent":"586.171336ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":423,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:01:50.19988Z","caller":"traceutil/trace.go:171","msg":"trace[278747566] transaction","detail":"{read_only:false; response_revision:1291; number_of_response:1; }","duration":"585.755522ms","start":"2026-06-16T23:01:49.614117Z","end":"2026-06-16T23:01:50.199872Z","steps":["trace[278747566] 'process raft request' (duration: 585.000498ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:50.199914Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:49.614097Z","time spent":"585.797154ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":477,"response count":0,"response size":39,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-06-16T23:01:50.399335Z","caller":"traceutil/trace.go:171","msg":"trace[1930788851] transaction","detail":"{read_only:false; response_revision:1292; number_of_response:1; }","duration":"195.253911ms","start":"2026-06-16T23:01:50.204055Z","end":"2026-06-16T23:01:50.399309Z","steps":["trace[1930788851] 'process raft request' (duration: 124.976937ms)","trace[1930788851] 'compare' (duration: 70.15391ms)"],"step_count":2} {"level":"warn","ts":"2026-06-16T23:01:58.838239Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"607.918424ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"} {"level":"info","ts":"2026-06-16T23:01:58.838298Z","caller":"traceutil/trace.go:171","msg":"trace[894417935] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1353; }","duration":"608.004357ms","start":"2026-06-16T23:01:58.230276Z","end":"2026-06-16T23:01:58.838281Z","steps":["trace[894417935] 'range keys from in-memory index tree' (duration: 607.740488ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:58.838325Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"354.608271ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"warn","ts":"2026-06-16T23:01:58.838409Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"603.057778ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"} {"level":"info","ts":"2026-06-16T23:01:58.838471Z","caller":"traceutil/trace.go:171","msg":"trace[787169151] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1353; }","duration":"603.179592ms","start":"2026-06-16T23:01:58.235273Z","end":"2026-06-16T23:01:58.838453Z","steps":["trace[787169151] 'range keys from in-memory index tree' (duration: 602.904793ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:58.838505Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:58.235253Z","time spent":"603.245474ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"warn","ts":"2026-06-16T23:01:58.838504Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"337.881965ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" ","response":"range_response_count:1 size:473"} {"level":"info","ts":"2026-06-16T23:01:58.838558Z","caller":"traceutil/trace.go:171","msg":"trace[1998949674] range","detail":"{range_begin:/registry/leases/kube-system/rbd-csi-ceph-com; range_end:; response_count:1; response_revision:1353; }","duration":"337.977417ms","start":"2026-06-16T23:01:58.500571Z","end":"2026-06-16T23:01:58.838549Z","steps":["trace[1998949674] 'range keys from in-memory index tree' (duration: 337.756931ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:58.838593Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:58.500548Z","time spent":"338.035339ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":1,"response size":496,"request content":"key:\"/registry/leases/kube-system/rbd-csi-ceph-com\" "} {"level":"warn","ts":"2026-06-16T23:01:58.838339Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:58.230255Z","time spent":"608.073638ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":60,"response count":1,"response size":514,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" "} {"level":"info","ts":"2026-06-16T23:01:58.838402Z","caller":"traceutil/trace.go:171","msg":"trace[1892021116] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:1353; }","duration":"354.726035ms","start":"2026-06-16T23:01:58.483655Z","end":"2026-06-16T23:01:58.838382Z","steps":["trace[1892021116] 'range keys from in-memory index tree' (duration: 354.402364ms)"],"step_count":1} {"level":"warn","ts":"2026-06-16T23:01:58.838725Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-06-16T23:01:58.483636Z","time spent":"355.081966ms","remote":"127.0.0.1:51004","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":457,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-06-16T23:01:58.838222Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.514187ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/horizontalpodautoscalers/\" range_end:\"/registry/horizontalpodautoscalers0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-06-16T23:01:58.83877Z","caller":"traceutil/trace.go:171","msg":"trace[1036068667] range","detail":"{range_begin:/registry/horizontalpodautoscalers/; range_end:/registry/horizontalpodautoscalers0; response_count:0; response_revision:1353; }","duration":"127.103396ms","start":"2026-06-16T23:01:58.711647Z","end":"2026-06-16T23:01:58.83875Z","steps":["trace[1036068667] 'count revisions from in-memory index tree' (duration: 126.444444ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:05:50.105283Z","caller":"traceutil/trace.go:171","msg":"trace[1953953733] transaction","detail":"{read_only:false; response_revision:2444; number_of_response:1; }","duration":"130.097587ms","start":"2026-06-16T23:05:49.975159Z","end":"2026-06-16T23:05:50.105257Z","steps":["trace[1953953733] 'process raft request' (duration: 129.994994ms)"],"step_count":1} {"level":"info","ts":"2026-06-16T23:05:50.105323Z","caller":"traceutil/trace.go:171","msg":"trace[1689506396] transaction","detail":"{read_only:false; response_revision:2443; number_of_response:1; }","duration":"130.141088ms","start":"2026-06-16T23:05:49.975158Z","end":"2026-06-16T23:05:50.105299Z","steps":["trace[1689506396] 'process raft request' (duration: 31.501354ms)","trace[1689506396] 'compare' (duration: 98.363486ms)"],"step_count":2} {"level":"info","ts":"2026-06-16T23:05:50.105593Z","caller":"traceutil/trace.go:171","msg":"trace[812804482] transaction","detail":"{read_only:false; response_revision:2445; number_of_response:1; }","duration":"130.426458ms","start":"2026-06-16T23:05:49.975157Z","end":"2026-06-16T23:05:50.105584Z","steps":["trace[812804482] 'process raft request' (duration: 130.064276ms)"],"step_count":1}