{"level":"warn","ts":"2026-03-20T00:44:43.317870Z","caller":"embed/config.go:1209","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"warn","ts":"2026-03-20T00:44:43.318044Z","caller":"etcdmain/config.go:270","msg":"--snapshot-count is deprecated in 3.6 and will be decommissioned in 3.7."} {"level":"info","ts":"2026-03-20T00:44:43.318057Z","caller":"etcdmain/etcd.go:64","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.52:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--feature-gates=InitialCorruptCheck=true","--initial-advertise-peer-urls=https://162.253.55.52:2380","--initial-cluster=controller=https://162.253.55.52:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.52:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.52:2380","--name=controller","--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","--watch-progress-notify-interval=5s"]} {"level":"info","ts":"2026-03-20T00:44:43.318123Z","caller":"etcdmain/etcd.go:124","msg":"Initialize and start etcd server","data-dir":"/var/lib/etcd","dir-type":"empty"} {"level":"warn","ts":"2026-03-20T00:44:43.318142Z","caller":"embed/config.go:1209","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-03-20T00:44:43.318150Z","caller":"embed/etcd.go:138","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.52:2380"]} {"level":"info","ts":"2026-03-20T00:44:43.318166Z","caller":"embed/etcd.go:544","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-03-20T00:44:43.318599Z","caller":"embed/etcd.go:146","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.52:2379"]} {"level":"info","ts":"2026-03-20T00:44:43.318690Z","caller":"embed/etcd.go:323","msg":"starting an etcd server","etcd-version":"3.6.4","git-sha":"5400cdc","go-version":"go1.23.11","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"controller","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://162.253.55.52:2380"],"listen-peer-urls":["https://162.253.55.52:2380"],"advertise-client-urls":["https://162.253.55.52:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.52:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"experimental-local-address":"","cors":["*"],"host-whitelist":["*"],"initial-cluster":"controller=https://162.253.55.52: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,"feature-gates":"InitialCorruptCheck=true","initial-corrupt-check":false,"corrupt-check-time-interval":"0s","compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","discovery-token":"","discovery-endpoints":"","discovery-dial-timeout":"2s","discovery-request-timeout":"5s","discovery-keepalive-time":"2s","discovery-keepalive-timeout":"6s","discovery-insecure-transport":true,"discovery-insecure-skip-tls-verify":false,"discovery-cert":"","discovery-key":"","discovery-cacert":"","discovery-user":"","downgrade-check-interval":"5s","max-learners":1,"v2-deprecation":"write-only"} {"level":"info","ts":"2026-03-20T00:44:43.319435Z","logger":"bbolt","caller":"backend/backend.go:203","msg":"Opening db file (/var/lib/etcd/member/snap/db) with mode -rw------- and with options: {Timeout: 0s, NoGrowSync: false, NoFreelistSync: true, PreLoadFreelist: false, FreelistType: hashmap, ReadOnly: false, MmapFlags: 8000, InitialMmapSize: 10737418240, PageSize: 0, NoSync: false, OpenFile: 0x0, Mlock: false, Logger: 0xc000692198}"} {"level":"info","ts":"2026-03-20T00:44:43.323976Z","logger":"bbolt","caller":"bbolt@v1.4.2/db.go:321","msg":"Opening bbolt db (/var/lib/etcd/member/snap/db) successfully"} {"level":"info","ts":"2026-03-20T00:44:43.324142Z","caller":"storage/backend.go:80","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.823037ms"} {"level":"info","ts":"2026-03-20T00:44:43.324216Z","caller":"etcdserver/bootstrap.go:220","msg":"restore consistentIndex","index":0} {"level":"info","ts":"2026-03-20T00:44:43.324243Z","caller":"etcdserver/bootstrap.go:94","msg":"bootstrapping cluster"} {"level":"info","ts":"2026-03-20T00:44:43.324312Z","caller":"etcdserver/bootstrap.go:101","msg":"bootstrapping storage"} {"level":"info","ts":"2026-03-20T00:44:43.334334Z","caller":"etcdserver/bootstrap.go:109","msg":"bootstrapping raft"} {"level":"info","ts":"2026-03-20T00:44:43.334440Z","caller":"etcdserver/bootstrap.go:499","msg":"starting local member","local-member-id":"b11e7fc5714be64b","cluster-id":"9349e4f32a52a90a"} {"level":"info","ts":"2026-03-20T00:44:43.334500Z","caller":"etcdserver/server.go:312","msg":"bootstrap successfully"} {"level":"info","ts":"2026-03-20T00:44:43.334568Z","logger":"raft","caller":"v3@v3.6.0/raft.go:1981","msg":"b11e7fc5714be64b switched to configuration voters=()"} {"level":"info","ts":"2026-03-20T00:44:43.334615Z","logger":"raft","caller":"v3@v3.6.0/raft.go:897","msg":"b11e7fc5714be64b became follower at term 0"} {"level":"info","ts":"2026-03-20T00:44:43.334629Z","logger":"raft","caller":"v3@v3.6.0/raft.go:493","msg":"newRaft b11e7fc5714be64b [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-03-20T00:44:43.334654Z","logger":"raft","caller":"v3@v3.6.0/raft.go:897","msg":"b11e7fc5714be64b became follower at term 1"} {"level":"info","ts":"2026-03-20T00:44:43.334686Z","logger":"raft","caller":"v3@v3.6.0/raft.go:1981","msg":"b11e7fc5714be64b switched to configuration voters=(12762778880000648779)"} {"level":"warn","ts":"2026-03-20T00:44:43.346516Z","caller":"auth/store.go:1135","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-03-20T00:44:43.349985Z","caller":"mvcc/kvstore.go:408","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-03-20T00:44:43.354472Z","caller":"storage/quota.go:93","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} {"level":"info","ts":"2026-03-20T00:44:43.355299Z","caller":"etcdserver/server.go:598","msg":"starting etcd server","local-member-id":"b11e7fc5714be64b","local-server-version":"3.6.4","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-03-20T00:44:43.355433Z","caller":"etcdserver/server.go:483","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"b11e7fc5714be64b","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-03-20T00:44:43.355512Z","caller":"fileutil/purge.go:49","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"} {"level":"info","ts":"2026-03-20T00:44:43.355549Z","caller":"fileutil/purge.go:49","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"} {"level":"info","ts":"2026-03-20T00:44:43.355559Z","caller":"fileutil/purge.go:49","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"} {"level":"info","ts":"2026-03-20T00:44:43.355819Z","caller":"embed/etcd.go:766","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-03-20T00:44:43.355952Z","caller":"embed/etcd.go:640","msg":"serving peer traffic","address":"162.253.55.52:2380"} {"level":"info","ts":"2026-03-20T00:44:43.356128Z","caller":"embed/etcd.go:611","msg":"cmux::serve","address":"162.253.55.52:2380"} {"level":"info","ts":"2026-03-20T00:44:43.356145Z","logger":"raft","caller":"v3@v3.6.0/raft.go:1981","msg":"b11e7fc5714be64b switched to configuration voters=(12762778880000648779)"} {"level":"info","ts":"2026-03-20T00:44:43.356392Z","caller":"membership/cluster.go:424","msg":"added member","cluster-id":"9349e4f32a52a90a","local-member-id":"b11e7fc5714be64b","added-peer-id":"b11e7fc5714be64b","added-peer-peer-urls":["https://162.253.55.52:2380"],"added-peer-is-learner":false} {"level":"info","ts":"2026-03-20T00:44:43.357206Z","caller":"embed/etcd.go:292","msg":"now serving peer/client/metrics","local-member-id":"b11e7fc5714be64b","initial-advertise-peer-urls":["https://162.253.55.52:2380"],"listen-peer-urls":["https://162.253.55.52:2380"],"advertise-client-urls":["https://162.253.55.52:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.52:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-03-20T00:44:43.357507Z","caller":"embed/etcd.go:890","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-03-20T00:44:44.035246Z","logger":"raft","caller":"v3@v3.6.0/raft.go:988","msg":"b11e7fc5714be64b is starting a new election at term 1"} {"level":"info","ts":"2026-03-20T00:44:44.035307Z","logger":"raft","caller":"v3@v3.6.0/raft.go:930","msg":"b11e7fc5714be64b became pre-candidate at term 1"} {"level":"info","ts":"2026-03-20T00:44:44.035394Z","logger":"raft","caller":"v3@v3.6.0/raft.go:1077","msg":"b11e7fc5714be64b received MsgPreVoteResp from b11e7fc5714be64b at term 1"} {"level":"info","ts":"2026-03-20T00:44:44.035428Z","logger":"raft","caller":"v3@v3.6.0/raft.go:1693","msg":"b11e7fc5714be64b has received 1 MsgPreVoteResp votes and 0 vote rejections"} {"level":"info","ts":"2026-03-20T00:44:44.035461Z","logger":"raft","caller":"v3@v3.6.0/raft.go:912","msg":"b11e7fc5714be64b became candidate at term 2"} {"level":"info","ts":"2026-03-20T00:44:44.086838Z","logger":"raft","caller":"v3@v3.6.0/raft.go:1077","msg":"b11e7fc5714be64b received MsgVoteResp from b11e7fc5714be64b at term 2"} {"level":"info","ts":"2026-03-20T00:44:44.086881Z","logger":"raft","caller":"v3@v3.6.0/raft.go:1693","msg":"b11e7fc5714be64b has received 1 MsgVoteResp votes and 0 vote rejections"} {"level":"info","ts":"2026-03-20T00:44:44.086907Z","logger":"raft","caller":"v3@v3.6.0/raft.go:970","msg":"b11e7fc5714be64b became leader at term 2"} {"level":"info","ts":"2026-03-20T00:44:44.086941Z","logger":"raft","caller":"v3@v3.6.0/node.go:370","msg":"raft.node: b11e7fc5714be64b elected leader b11e7fc5714be64b at term 2"} {"level":"info","ts":"2026-03-20T00:44:44.088206Z","caller":"etcdserver/server.go:1804","msg":"published local member to cluster through raft","local-member-id":"b11e7fc5714be64b","local-member-attributes":"{Name:controller ClientURLs:[https://162.253.55.52:2379]}","cluster-id":"9349e4f32a52a90a","publish-timeout":"7s"} {"level":"info","ts":"2026-03-20T00:44:44.088228Z","caller":"embed/serve.go:138","msg":"ready to serve client requests"} {"level":"info","ts":"2026-03-20T00:44:44.088306Z","caller":"etcdserver/server.go:2404","msg":"setting up initial cluster version using v3 API","cluster-version":"3.6"} {"level":"info","ts":"2026-03-20T00:44:44.089631Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-03-20T00:44:44.088376Z","caller":"embed/serve.go:138","msg":"ready to serve client requests"} {"level":"info","ts":"2026-03-20T00:44:44.089732Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-03-20T00:44:44.091625Z","caller":"v3rpc/health.go:63","msg":"grpc service status changed","service":"","status":"SERVING"} {"level":"warn","ts":"2026-03-20T00:44:44.092136Z","caller":"v3rpc/grpc.go:52","msg":"etcdserver: failed to register grpc metrics","error":"duplicate metrics collector registration attempted"} {"level":"info","ts":"2026-03-20T00:44:44.092426Z","caller":"v3rpc/health.go:63","msg":"grpc service status changed","service":"","status":"SERVING"} {"level":"info","ts":"2026-03-20T00:44:44.094327Z","caller":"membership/cluster.go:682","msg":"set initial cluster version","cluster-id":"9349e4f32a52a90a","local-member-id":"b11e7fc5714be64b","cluster-version":"3.6"} {"level":"info","ts":"2026-03-20T00:44:44.094510Z","caller":"api/capability.go:76","msg":"enabled capabilities for version","cluster-version":"3.6"} {"level":"info","ts":"2026-03-20T00:44:44.094571Z","caller":"etcdserver/server.go:2424","msg":"cluster version is updated","cluster-version":"3.6"} {"level":"info","ts":"2026-03-20T00:44:44.094669Z","caller":"version/monitor.go:116","msg":"cluster version differs from storage version.","cluster-version":"3.6.0","storage-version":"3.5.0"} {"level":"info","ts":"2026-03-20T00:44:44.094803Z","caller":"schema/migration.go:65","msg":"updated storage version","new-storage-version":"3.6.0"} {"level":"info","ts":"2026-03-20T00:44:44.100159Z","caller":"embed/serve.go:283","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.52:2379"} {"level":"info","ts":"2026-03-20T00:44:44.100703Z","caller":"embed/serve.go:283","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"warn","ts":"2026-03-20T00:44:44.101106Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33416","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.101103Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33414","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.115485Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33438","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.129879Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33490","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.146361Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33494","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.163319Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33506","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.172579Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33528","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.184004Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33530","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.195628Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33562","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.203816Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33588","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.213099Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33608","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.223186Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39138","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.233167Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39156","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.241033Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39166","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.251817Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39192","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.267551Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39204","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.272067Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39222","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.281310Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39228","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.290434Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39254","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.299994Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39272","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.310155Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39282","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.342283Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39318","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.354223Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39334","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.363884Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39352","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.374611Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39366","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.384948Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39394","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.396091Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39398","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.406092Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39424","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.422276Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39446","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.428689Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39454","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.437172Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39476","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.445325Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39492","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.467933Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39510","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.475066Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39542","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.482814Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39544","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.492655Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39560","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.499949Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39572","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.513899Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39592","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.525110Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39604","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.531856Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39612","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.541309Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39642","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.549417Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39660","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.559978Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39676","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.572756Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39700","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.582423Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39716","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.613994Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39736","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.623260Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39744","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.641948Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39766","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.650398Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39776","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.657611Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39800","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.676219Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39832","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.687449Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39848","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.696357Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39858","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.707628Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39890","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.729315Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39918","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.733532Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39926","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.743740Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39958","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.754819Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:39980","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:44:44.818131Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:40008","server-name":"","error":"EOF"} {"level":"info","ts":"2026-03-20T00:44:46.883669Z","caller":"traceutil/trace.go:172","msg":"trace[1753666756] transaction","detail":"{read_only:false; response_revision:119; number_of_response:1; }","duration":"309.379644ms","start":"2026-03-20T00:44:46.574257Z","end":"2026-03-20T00:44:46.883637Z","steps":["trace[1753666756] 'process raft request' (duration: 294.414803ms)","trace[1753666756] 'compare' (duration: 14.770899ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:46.884576Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:46.574233Z","time spent":"309.592325ms","remote":"127.0.0.1:39580","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":657,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-03-20T00:44:53.905871Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.548035805s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" limit:1 ","response":"range_response_count:1 size:351"} {"level":"info","ts":"2026-03-20T00:44:53.906025Z","caller":"traceutil/trace.go:172","msg":"trace[1688879749] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:303; }","duration":"1.548209626s","start":"2026-03-20T00:44:52.357796Z","end":"2026-03-20T00:44:53.906006Z","steps":["trace[1688879749] 'range keys from in-memory index tree' (duration: 1.547843584s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:53.906076Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:52.357763Z","time spent":"1.548302257s","remote":"127.0.0.1:33592","response type":"/etcdserverpb.KV/Range","request count":0,"request size":36,"response count":1,"response size":375,"request content":"key:\"/registry/namespaces/kube-system\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:44:53.906191Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"745.286842ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:44:53.906652Z","caller":"traceutil/trace.go:172","msg":"trace[10141258] linearizableReadLoop","detail":"{readStateIndex:319; appliedIndex:318; }","duration":"340.269358ms","start":"2026-03-20T00:44:53.566365Z","end":"2026-03-20T00:44:53.906635Z","steps":["trace[10141258] 'read index received' (duration: 37.24µs)","trace[10141258] 'applied index is now lower than readState.Index' (duration: 340.230758ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:44:53.906738Z","caller":"traceutil/trace.go:172","msg":"trace[1040530599] transaction","detail":"{read_only:false; response_revision:304; number_of_response:1; }","duration":"1.032483578s","start":"2026-03-20T00:44:52.874242Z","end":"2026-03-20T00:44:53.906726Z","steps":["trace[1040530599] 'process raft request' (duration: 286.190359ms)","trace[1040530599] 'compare' (duration: 745.17494ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:53.906831Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:52.874208Z","time spent":"1.032584169s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":493,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:44:53.907567Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"341.181616ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-03-20T00:44:53.907720Z","caller":"traceutil/trace.go:172","msg":"trace[1308938454] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:304; }","duration":"341.311597ms","start":"2026-03-20T00:44:53.566357Z","end":"2026-03-20T00:44:53.907668Z","steps":["trace[1308938454] 'agreement among raft nodes before linearized reading' (duration: 340.54768ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:53.907975Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:53.566332Z","time spent":"341.52549ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":1,"response size":464,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:44:54.407556Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748073,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:44:54.905730Z","caller":"wal/wal.go:845","msg":"slow fdatasync","took":"1.175644824s","expected-duration":"1s"} {"level":"info","ts":"2026-03-20T00:44:54.906150Z","caller":"traceutil/trace.go:172","msg":"trace[1461637328] linearizableReadLoop","detail":"{readStateIndex:319; appliedIndex:319; }","duration":"999.430037ms","start":"2026-03-20T00:44:53.906689Z","end":"2026-03-20T00:44:54.906119Z","steps":["trace[1461637328] 'read index received' (duration: 999.420157ms)","trace[1461637328] 'applied index is now lower than readState.Index' (duration: 8.36µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:55.971395Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"2.218435837s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-20T00:44:55.971501Z","caller":"traceutil/trace.go:172","msg":"trace[1663461350] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:304; }","duration":"2.218577218s","start":"2026-03-20T00:44:53.752901Z","end":"2026-03-20T00:44:55.971478Z","steps":["trace[1663461350] 'agreement among raft nodes before linearized reading' (duration: 1.15334682s)","trace[1663461350] 'range keys from in-memory index tree' (duration: 1.064956086s)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:55.971571Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:53.752881Z","time spent":"2.218678498s","remote":"127.0.0.1:39384","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-cp-lock\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:44:55.971662Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.065259078s","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:44:55.971976Z","caller":"traceutil/trace.go:172","msg":"trace[455704882] transaction","detail":"{read_only:false; response_revision:307; number_of_response:1; }","duration":"2.059032266s","start":"2026-03-20T00:44:53.912928Z","end":"2026-03-20T00:44:55.971960Z","steps":["trace[455704882] 'process raft request' (duration: 2.058978035s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:55.972088Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:53.912916Z","time spent":"2.059111176s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":425,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:44:55.972214Z","caller":"traceutil/trace.go:172","msg":"trace[1014039957] transaction","detail":"{read_only:false; response_revision:306; number_of_response:1; }","duration":"2.062056732s","start":"2026-03-20T00:44:53.910148Z","end":"2026-03-20T00:44:55.972205Z","steps":["trace[1014039957] 'process raft request' (duration: 2.061678149s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:55.972260Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:53.910127Z","time spent":"2.062114092s","remote":"127.0.0.1:39270","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":217,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:44:55.972205Z","caller":"traceutil/trace.go:172","msg":"trace[1991555489] linearizableReadLoop","detail":"{readStateIndex:320; appliedIndex:319; }","duration":"1.02953915s","start":"2026-03-20T00:44:54.942641Z","end":"2026-03-20T00:44:55.972180Z","steps":["trace[1991555489] 'read index received' (duration: 84.629038ms)","trace[1991555489] 'applied index is now lower than readState.Index' (duration: 944.908202ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:55.972482Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.029860233s","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:44:55.972517Z","caller":"traceutil/trace.go:172","msg":"trace[1044085459] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:307; }","duration":"1.029908333s","start":"2026-03-20T00:44:54.942597Z","end":"2026-03-20T00:44:55.972506Z","steps":["trace[1044085459] 'agreement among raft nodes before linearized reading' (duration: 1.029831703s)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:44:55.971962Z","caller":"traceutil/trace.go:172","msg":"trace[523354461] transaction","detail":"{read_only:false; response_revision:305; number_of_response:1; }","duration":"2.241996712s","start":"2026-03-20T00:44:53.729932Z","end":"2026-03-20T00:44:55.971929Z","steps":["trace[523354461] 'process raft request' (duration: 1.1763767s)","trace[523354461] 'compare' (duration: 1.064979786s)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:55.973936Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:53.729899Z","time spent":"2.243960228s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":466,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:44:56.468268Z","caller":"traceutil/trace.go:172","msg":"trace[1632599187] linearizableReadLoop","detail":"{readStateIndex:322; appliedIndex:322; }","duration":"492.707569ms","start":"2026-03-20T00:44:55.975531Z","end":"2026-03-20T00:44:56.468238Z","steps":["trace[1632599187] 'read index received' (duration: 492.682098ms)","trace[1632599187] 'applied index is now lower than readState.Index' (duration: 10.07µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:56.757879Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"782.348897ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:44:56.757959Z","caller":"traceutil/trace.go:172","msg":"trace[1239335614] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:307; }","duration":"782.443238ms","start":"2026-03-20T00:44:55.975497Z","end":"2026-03-20T00:44:56.757940Z","steps":["trace[1239335614] 'agreement among raft nodes before linearized reading' (duration: 492.87969ms)","trace[1239335614] 'range keys from in-memory index tree' (duration: 289.430727ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:56.758134Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"289.68902ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:44:56.758299Z","caller":"traceutil/trace.go:172","msg":"trace[671284867] transaction","detail":"{read_only:false; response_revision:308; number_of_response:1; }","duration":"1.161249534s","start":"2026-03-20T00:44:55.597015Z","end":"2026-03-20T00:44:56.758264Z","steps":["trace[671284867] 'process raft request' (duration: 871.342092ms)","trace[671284867] 'compare' (duration: 289.552359ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:44:56.758370Z","caller":"traceutil/trace.go:172","msg":"trace[850756762] linearizableReadLoop","detail":"{readStateIndex:323; appliedIndex:322; }","duration":"290.003572ms","start":"2026-03-20T00:44:56.468341Z","end":"2026-03-20T00:44:56.758345Z","steps":["trace[850756762] 'read index received' (duration: 289.056435ms)","trace[850756762] 'applied index is now lower than readState.Index' (duration: 945.757µs)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:44:56.758414Z","caller":"traceutil/trace.go:172","msg":"trace[1523415598] transaction","detail":"{read_only:false; response_revision:310; number_of_response:1; }","duration":"780.999506ms","start":"2026-03-20T00:44:55.977398Z","end":"2026-03-20T00:44:56.758397Z","steps":["trace[1523415598] 'process raft request' (duration: 780.946005ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:56.758488Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:55.977385Z","time spent":"781.071976ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":421,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:44:56.758516Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:55.596986Z","time spent":"1.161400335s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":675,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:44:56.758580Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"781.932124ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/certificate-controller\" limit:1 ","response":"range_response_count:1 size:209"} {"level":"info","ts":"2026-03-20T00:44:56.758614Z","caller":"traceutil/trace.go:172","msg":"trace[31772424] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/certificate-controller; range_end:; response_count:1; response_revision:310; }","duration":"781.984584ms","start":"2026-03-20T00:44:55.976621Z","end":"2026-03-20T00:44:56.758605Z","steps":["trace[31772424] 'agreement among raft nodes before linearized reading' (duration: 781.809703ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:56.758648Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:55.976606Z","time spent":"782.033455ms","remote":"127.0.0.1:39270","response type":"/etcdserverpb.KV/Range","request count":0,"request size":64,"response count":1,"response size":233,"request content":"key:\"/registry/serviceaccounts/kube-system/certificate-controller\" limit:1 "} {"level":"info","ts":"2026-03-20T00:44:56.758698Z","caller":"traceutil/trace.go:172","msg":"trace[975240514] transaction","detail":"{read_only:false; response_revision:309; number_of_response:1; }","duration":"845.502776ms","start":"2026-03-20T00:44:55.913178Z","end":"2026-03-20T00:44:56.758681Z","steps":["trace[975240514] 'process raft request' (duration: 845.053002ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:56.758762Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:55.913148Z","time spent":"845.583007ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":493,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:44:56.759179Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"782.5059ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/etcd-controller\" limit:1 ","response":"range_response_count:1 size:5944"} {"level":"info","ts":"2026-03-20T00:44:56.759208Z","caller":"traceutil/trace.go:172","msg":"trace[1520723509] range","detail":"{range_begin:/registry/pods/kube-system/etcd-controller; range_end:; response_count:1; response_revision:310; }","duration":"782.539ms","start":"2026-03-20T00:44:55.976662Z","end":"2026-03-20T00:44:56.759201Z","steps":["trace[1520723509] 'agreement among raft nodes before linearized reading' (duration: 782.059165ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:56.759453Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:55.976641Z","time spent":"782.58405ms","remote":"127.0.0.1:39242","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":5968,"request content":"key:\"/registry/pods/kube-system/etcd-controller\" limit:1 "} {"level":"info","ts":"2026-03-20T00:44:56.960351Z","caller":"traceutil/trace.go:172","msg":"trace[565784162] linearizableReadLoop","detail":"{readStateIndex:326; appliedIndex:326; }","duration":"131.804124ms","start":"2026-03-20T00:44:56.828523Z","end":"2026-03-20T00:44:56.960327Z","steps":["trace[565784162] 'read index received' (duration: 131.796854ms)","trace[565784162] 'applied index is now lower than readState.Index' (duration: 6.1µs)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:44:56.960891Z","caller":"traceutil/trace.go:172","msg":"trace[39970125] transaction","detail":"{read_only:false; response_revision:312; number_of_response:1; }","duration":"190.982366ms","start":"2026-03-20T00:44:56.769890Z","end":"2026-03-20T00:44:56.960872Z","steps":["trace[39970125] 'process raft request' (duration: 190.552761ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:56.960943Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"132.36389ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/namespace-controller\" limit:1 ","response":"range_response_count:1 size:205"} {"level":"info","ts":"2026-03-20T00:44:56.961105Z","caller":"traceutil/trace.go:172","msg":"trace[1437487196] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/namespace-controller; range_end:; response_count:1; response_revision:311; }","duration":"132.511251ms","start":"2026-03-20T00:44:56.828518Z","end":"2026-03-20T00:44:56.961029Z","steps":["trace[1437487196] 'agreement among raft nodes before linearized reading' (duration: 131.902615ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:44:57.124453Z","caller":"traceutil/trace.go:172","msg":"trace[1629133020] linearizableReadLoop","detail":"{readStateIndex:327; appliedIndex:327; }","duration":"148.830488ms","start":"2026-03-20T00:44:56.975600Z","end":"2026-03-20T00:44:57.124430Z","steps":["trace[1629133020] 'read index received' (duration: 148.823608ms)","trace[1629133020] 'applied index is now lower than readState.Index' (duration: 5.7µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:57.124578Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"148.971459ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:44:57.124599Z","caller":"traceutil/trace.go:172","msg":"trace[1541911471] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:312; }","duration":"149.010279ms","start":"2026-03-20T00:44:56.975582Z","end":"2026-03-20T00:44:57.124592Z","steps":["trace[1541911471] 'agreement among raft nodes before linearized reading' (duration: 148.945099ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:44:57.124607Z","caller":"traceutil/trace.go:172","msg":"trace[421380940] transaction","detail":"{read_only:false; response_revision:313; number_of_response:1; }","duration":"149.506573ms","start":"2026-03-20T00:44:56.975081Z","end":"2026-03-20T00:44:57.124587Z","steps":["trace[421380940] 'process raft request' (duration: 149.386212ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:57.124739Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"147.023832ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/service-account-controller\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:44:57.124868Z","caller":"traceutil/trace.go:172","msg":"trace[726655897] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/service-account-controller; range_end:; response_count:0; response_revision:313; }","duration":"147.158883ms","start":"2026-03-20T00:44:56.977677Z","end":"2026-03-20T00:44:57.124836Z","steps":["trace[726655897] 'agreement among raft nodes before linearized reading' (duration: 146.930012ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:57.391218Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"134.712768ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:44:57.391339Z","caller":"traceutil/trace.go:172","msg":"trace[1291534901] transaction","detail":"{read_only:false; response_revision:314; number_of_response:1; }","duration":"258.878658ms","start":"2026-03-20T00:44:57.132437Z","end":"2026-03-20T00:44:57.391315Z","steps":["trace[1291534901] 'process raft request' (duration: 124.013059ms)","trace[1291534901] 'compare' (duration: 134.564247ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:44:57.554242Z","caller":"traceutil/trace.go:172","msg":"trace[803396333] transaction","detail":"{read_only:false; response_revision:316; number_of_response:1; }","duration":"104.663977ms","start":"2026-03-20T00:44:57.449554Z","end":"2026-03-20T00:44:57.554218Z","steps":["trace[803396333] 'process raft request' (duration: 104.201003ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:44:57.868178Z","caller":"traceutil/trace.go:172","msg":"trace[1518184144] linearizableReadLoop","detail":"{readStateIndex:332; appliedIndex:332; }","duration":"277.422143ms","start":"2026-03-20T00:44:57.590724Z","end":"2026-03-20T00:44:57.868146Z","steps":["trace[1518184144] 'read index received' (duration: 277.413853ms)","trace[1518184144] 'applied index is now lower than readState.Index' (duration: 6.51µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:57.945200Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"354.450028ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" limit:1 ","response":"range_response_count:1 size:351"} {"level":"info","ts":"2026-03-20T00:44:57.945289Z","caller":"traceutil/trace.go:172","msg":"trace[1328447027] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:1; response_revision:316; }","duration":"354.549879ms","start":"2026-03-20T00:44:57.590715Z","end":"2026-03-20T00:44:57.945265Z","steps":["trace[1328447027] 'agreement among raft nodes before linearized reading' (duration: 277.542915ms)","trace[1328447027] 'range keys from in-memory index tree' (duration: 76.775082ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:44:57.945311Z","caller":"traceutil/trace.go:172","msg":"trace[1373391325] transaction","detail":"{read_only:false; response_revision:317; number_of_response:1; }","duration":"355.766848ms","start":"2026-03-20T00:44:57.589522Z","end":"2026-03-20T00:44:57.945289Z","steps":["trace[1373391325] 'process raft request' (duration: 278.696514ms)","trace[1373391325] 'compare' (duration: 76.868723ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:44:57.945332Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:57.590702Z","time spent":"354.62087ms","remote":"127.0.0.1:33592","response type":"/etcdserverpb.KV/Range","request count":0,"request size":36,"response count":1,"response size":375,"request content":"key:\"/registry/namespaces/kube-system\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:44:57.945424Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:57.589502Z","time spent":"355.85525ms","remote":"127.0.0.1:33448","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":118,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:44:57.945414Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"324.366816ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/kube-controller-manager-controller\" limit:1 ","response":"range_response_count:1 size:7354"} {"level":"info","ts":"2026-03-20T00:44:57.945485Z","caller":"traceutil/trace.go:172","msg":"trace[1828702292] range","detail":"{range_begin:/registry/pods/kube-system/kube-controller-manager-controller; range_end:; response_count:1; response_revision:317; }","duration":"324.455097ms","start":"2026-03-20T00:44:57.621015Z","end":"2026-03-20T00:44:57.945470Z","steps":["trace[1828702292] 'agreement among raft nodes before linearized reading' (duration: 324.261505ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:57.945526Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:44:57.620992Z","time spent":"324.524297ms","remote":"127.0.0.1:39242","response type":"/etcdserverpb.KV/Range","request count":0,"request size":65,"response count":1,"response size":7378,"request content":"key:\"/registry/pods/kube-system/kube-controller-manager-controller\" limit:1 "} {"level":"info","ts":"2026-03-20T00:44:58.168356Z","caller":"traceutil/trace.go:172","msg":"trace[1838943097] linearizableReadLoop","detail":"{readStateIndex:334; appliedIndex:334; }","duration":"200.664797ms","start":"2026-03-20T00:44:57.967667Z","end":"2026-03-20T00:44:58.168332Z","steps":["trace[1838943097] 'read index received' (duration: 200.655457ms)","trace[1838943097] 'applied index is now lower than readState.Index' (duration: 7.73µs)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:44:58.169117Z","caller":"traceutil/trace.go:172","msg":"trace[2115853111] transaction","detail":"{read_only:false; response_revision:319; number_of_response:1; }","duration":"213.05281ms","start":"2026-03-20T00:44:57.956045Z","end":"2026-03-20T00:44:58.169098Z","steps":["trace[2115853111] 'process raft request' (duration: 212.426095ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:58.168934Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"201.237641ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/endpointslices/default/kubernetes\" limit:1 ","response":"range_response_count:1 size:475"} {"level":"info","ts":"2026-03-20T00:44:58.169284Z","caller":"traceutil/trace.go:172","msg":"trace[1161997022] range","detail":"{range_begin:/registry/endpointslices/default/kubernetes; range_end:; response_count:1; response_revision:318; }","duration":"201.612034ms","start":"2026-03-20T00:44:57.967661Z","end":"2026-03-20T00:44:58.169273Z","steps":["trace[1161997022] 'agreement among raft nodes before linearized reading' (duration: 200.804948ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:58.198499Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"221.67993ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-03-20T00:44:58.198552Z","caller":"traceutil/trace.go:172","msg":"trace[1392162537] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:319; }","duration":"221.738171ms","start":"2026-03-20T00:44:57.976802Z","end":"2026-03-20T00:44:58.198541Z","steps":["trace[1392162537] 'agreement among raft nodes before linearized reading' (duration: 221.5989ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:44:58.198547Z","caller":"traceutil/trace.go:172","msg":"trace[1923137166] transaction","detail":"{read_only:false; response_revision:320; number_of_response:1; }","duration":"219.918656ms","start":"2026-03-20T00:44:57.978607Z","end":"2026-03-20T00:44:58.198526Z","steps":["trace[1923137166] 'process raft request' (duration: 219.767475ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:58.198927Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"222.65273ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:44:58.199013Z","caller":"traceutil/trace.go:172","msg":"trace[132433944] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:320; }","duration":"222.755411ms","start":"2026-03-20T00:44:57.976244Z","end":"2026-03-20T00:44:58.198999Z","steps":["trace[132433944] 'agreement among raft nodes before linearized reading' (duration: 222.62836ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:44:58.199040Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"230.028252ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/horizontal-pod-autoscaler\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:44:58.199099Z","caller":"traceutil/trace.go:172","msg":"trace[430232518] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/horizontal-pod-autoscaler; range_end:; response_count:0; response_revision:320; }","duration":"230.091312ms","start":"2026-03-20T00:44:57.968991Z","end":"2026-03-20T00:44:58.199083Z","steps":["trace[430232518] 'agreement among raft nodes before linearized reading' (duration: 229.966001ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:21.472021Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"124.872194ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:45:21.472138Z","caller":"traceutil/trace.go:172","msg":"trace[95079705] transaction","detail":"{read_only:false; response_revision:492; number_of_response:1; }","duration":"212.504516ms","start":"2026-03-20T00:45:21.259616Z","end":"2026-03-20T00:45:21.472120Z","steps":["trace[95079705] 'process raft request' (duration: 87.412891ms)","trace[95079705] 'compare' (duration: 124.699873ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:21.524526Z","caller":"traceutil/trace.go:172","msg":"trace[1215587709] linearizableReadLoop","detail":"{readStateIndex:513; appliedIndex:513; }","duration":"167.405732ms","start":"2026-03-20T00:45:21.357088Z","end":"2026-03-20T00:45:21.524494Z","steps":["trace[1215587709] 'read index received' (duration: 167.394212ms)","trace[1215587709] 'applied index is now lower than readState.Index' (duration: 9.91µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:21.524709Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"167.611194ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/cilium\" limit:1 ","response":"range_response_count:1 size:520"} {"level":"info","ts":"2026-03-20T00:45:21.524759Z","caller":"traceutil/trace.go:172","msg":"trace[1348055323] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/cilium; range_end:; response_count:1; response_revision:492; }","duration":"167.664454ms","start":"2026-03-20T00:45:21.357082Z","end":"2026-03-20T00:45:21.524746Z","steps":["trace[1348055323] 'agreement among raft nodes before linearized reading' (duration: 167.513353ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:21.525230Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"168.048216ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/cilium-operator\" limit:1 ","response":"range_response_count:1 size:538"} {"level":"info","ts":"2026-03-20T00:45:21.525302Z","caller":"traceutil/trace.go:172","msg":"trace[1599201599] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/cilium-operator; range_end:; response_count:1; response_revision:493; }","duration":"168.134267ms","start":"2026-03-20T00:45:21.357156Z","end":"2026-03-20T00:45:21.525290Z","steps":["trace[1599201599] 'agreement among raft nodes before linearized reading' (duration: 167.973795ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:21.525186Z","caller":"traceutil/trace.go:172","msg":"trace[1475112021] transaction","detail":"{read_only:false; response_revision:493; number_of_response:1; }","duration":"254.994015ms","start":"2026-03-20T00:45:21.270158Z","end":"2026-03-20T00:45:21.525152Z","steps":["trace[1475112021] 'process raft request' (duration: 254.483951ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:23.261341Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"191.208724ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/secrets\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:23.261455Z","caller":"traceutil/trace.go:172","msg":"trace[1031907185] range","detail":"{range_begin:/registry/secrets; range_end:; response_count:0; response_revision:499; }","duration":"191.343624ms","start":"2026-03-20T00:45:23.070088Z","end":"2026-03-20T00:45:23.261432Z","steps":["trace[1031907185] 'range keys from in-memory index tree' (duration: 190.971792ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.384217Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748490,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:45:24.644989Z","caller":"wal/wal.go:845","msg":"slow fdatasync","took":"1.058611348s","expected-duration":"1s"} {"level":"info","ts":"2026-03-20T00:45:24.645245Z","caller":"traceutil/trace.go:172","msg":"trace[531282587] linearizableReadLoop","detail":"{readStateIndex:521; appliedIndex:521; }","duration":"761.943873ms","start":"2026-03-20T00:45:23.883261Z","end":"2026-03-20T00:45:24.645205Z","steps":["trace[531282587] 'read index received' (duration: 761.930703ms)","trace[531282587] 'applied index is now lower than readState.Index' (duration: 11.51µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:24.645437Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"762.153054ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:24.645489Z","caller":"traceutil/trace.go:172","msg":"trace[383623813] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:499; }","duration":"762.217765ms","start":"2026-03-20T00:45:23.883257Z","end":"2026-03-20T00:45:24.645474Z","steps":["trace[383623813] 'agreement among raft nodes before linearized reading' (duration: 762.103504ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.645527Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.883235Z","time spent":"762.284415ms","remote":"127.0.0.1:33404","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-03-20T00:45:24.645670Z","caller":"traceutil/trace.go:172","msg":"trace[1333436684] transaction","detail":"{read_only:false; response_revision:500; number_of_response:1; }","duration":"1.059326012s","start":"2026-03-20T00:45:23.586263Z","end":"2026-03-20T00:45:24.645589Z","steps":["trace[1333436684] 'process raft request' (duration: 1.059184541s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.645881Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.586243Z","time spent":"1.059514683s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":8162,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-03-20T00:45:24.660376Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"223.039667ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-03-20T00:45:24.660431Z","caller":"traceutil/trace.go:172","msg":"trace[1788388796] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:500; }","duration":"223.112548ms","start":"2026-03-20T00:45:24.437307Z","end":"2026-03-20T00:45:24.660420Z","steps":["trace[1788388796] 'agreement among raft nodes before linearized reading' (duration: 222.941056ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.660419Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"684.418386ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:24.660483Z","caller":"traceutil/trace.go:172","msg":"trace[823849431] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:500; }","duration":"684.493797ms","start":"2026-03-20T00:45:23.975970Z","end":"2026-03-20T00:45:24.660464Z","steps":["trace[823849431] 'agreement among raft nodes before linearized reading' (duration: 684.384346ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:24.660917Z","caller":"traceutil/trace.go:172","msg":"trace[1921961816] transaction","detail":"{read_only:false; response_revision:501; number_of_response:1; }","duration":"1.071776118s","start":"2026-03-20T00:45:23.589127Z","end":"2026-03-20T00:45:24.660904Z","steps":["trace[1921961816] 'process raft request' (duration: 1.071546106s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.661004Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.589107Z","time spent":"1.071849159s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":6315,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:24.661029Z","caller":"traceutil/trace.go:172","msg":"trace[680080211] transaction","detail":"{read_only:false; response_revision:503; number_of_response:1; }","duration":"1.063993484s","start":"2026-03-20T00:45:23.597015Z","end":"2026-03-20T00:45:24.661009Z","steps":["trace[680080211] 'process raft request' (duration: 1.063805383s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.661125Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.596981Z","time spent":"1.064092645s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":22019,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:24.661127Z","caller":"traceutil/trace.go:172","msg":"trace[1453517824] transaction","detail":"{read_only:false; response_revision:504; number_of_response:1; }","duration":"1.058388395s","start":"2026-03-20T00:45:23.602720Z","end":"2026-03-20T00:45:24.661108Z","steps":["trace[1453517824] 'process raft request' (duration: 1.058129623s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.661213Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.602699Z","time spent":"1.058472695s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28462,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:24.661200Z","caller":"traceutil/trace.go:172","msg":"trace[1088732476] transaction","detail":"{read_only:false; response_revision:505; number_of_response:1; }","duration":"1.056103219s","start":"2026-03-20T00:45:23.605070Z","end":"2026-03-20T00:45:24.661173Z","steps":["trace[1088732476] 'process raft request' (duration: 1.055849128s)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:24.661099Z","caller":"traceutil/trace.go:172","msg":"trace[1870208140] transaction","detail":"{read_only:false; response_revision:502; number_of_response:1; }","duration":"1.070413718s","start":"2026-03-20T00:45:23.590669Z","end":"2026-03-20T00:45:24.661083Z","steps":["trace[1870208140] 'process raft request' (duration: 1.070122096s)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:24.661319Z","caller":"traceutil/trace.go:172","msg":"trace[1272046805] transaction","detail":"{read_only:false; response_revision:506; number_of_response:1; }","duration":"1.05473705s","start":"2026-03-20T00:45:23.606551Z","end":"2026-03-20T00:45:24.661288Z","steps":["trace[1272046805] 'process raft request' (duration: 1.054422498s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.661367Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.590659Z","time spent":"1.07068076s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9490,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-03-20T00:45:24.661427Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.606534Z","time spent":"1.054844541s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":29820,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:24.661586Z","caller":"traceutil/trace.go:172","msg":"trace[1669368986] transaction","detail":"{read_only:false; response_revision:507; number_of_response:1; }","duration":"1.046927116s","start":"2026-03-20T00:45:23.614641Z","end":"2026-03-20T00:45:24.661568Z","steps":["trace[1669368986] 'process raft request' (duration: 1.046591344s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.661651Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.614619Z","time spent":"1.047006396s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":29801,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:24.661787Z","caller":"traceutil/trace.go:172","msg":"trace[1074529964] transaction","detail":"{read_only:false; response_revision:508; number_of_response:1; }","duration":"1.037273468s","start":"2026-03-20T00:45:23.624492Z","end":"2026-03-20T00:45:24.661765Z","steps":["trace[1074529964] 'process raft request' (duration: 1.037008487s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.661833Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.624467Z","time spent":"1.037346939s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":63889,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:24.662047Z","caller":"traceutil/trace.go:172","msg":"trace[1520807956] transaction","detail":"{read_only:false; response_revision:509; number_of_response:1; }","duration":"1.028138485s","start":"2026-03-20T00:45:23.633897Z","end":"2026-03-20T00:45:24.662035Z","steps":["trace[1520807956] 'process raft request' (duration: 1.027898724s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.662076Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.605049Z","time spent":"1.05626597s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":28166,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-03-20T00:45:24.662106Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.633879Z","time spent":"1.028203796s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":58271,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:24.662376Z","caller":"traceutil/trace.go:172","msg":"trace[1927665000] transaction","detail":"{read_only:false; response_revision:510; number_of_response:1; }","duration":"991.888174ms","start":"2026-03-20T00:45:23.670476Z","end":"2026-03-20T00:45:24.662364Z","steps":["trace[1927665000] 'process raft request' (duration: 991.571792ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.662429Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.670441Z","time spent":"991.966525ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":79374,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:24.662755Z","caller":"traceutil/trace.go:172","msg":"trace[570648964] transaction","detail":"{read_only:false; response_revision:512; number_of_response:1; }","duration":"340.551826ms","start":"2026-03-20T00:45:24.322164Z","end":"2026-03-20T00:45:24.662716Z","steps":["trace[570648964] 'process raft request' (duration: 340.507365ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:24.662873Z","caller":"traceutil/trace.go:172","msg":"trace[759931528] transaction","detail":"{read_only:false; response_revision:511; number_of_response:1; }","duration":"904.157416ms","start":"2026-03-20T00:45:23.758700Z","end":"2026-03-20T00:45:24.662858Z","steps":["trace[759931528] 'process raft request' (duration: 903.728744ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:24.662904Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:24.322137Z","time spent":"340.664456ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":466,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:45:24.662949Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:23.758667Z","time spent":"904.252318ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":149907,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-03-20T00:45:25.817120Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"127.808016ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:45:25.817236Z","caller":"traceutil/trace.go:172","msg":"trace[834076183] transaction","detail":"{read_only:false; response_revision:571; number_of_response:1; }","duration":"315.471693ms","start":"2026-03-20T00:45:25.501747Z","end":"2026-03-20T00:45:25.817218Z","steps":["trace[834076183] 'process raft request' (duration: 187.498175ms)","trace[834076183] 'compare' (duration: 127.438763ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:25.817287Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:25.501722Z","time spent":"315.545363ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":14661,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:26.101633Z","caller":"traceutil/trace.go:172","msg":"trace[1558075590] linearizableReadLoop","detail":"{readStateIndex:596; appliedIndex:596; }","duration":"218.502135ms","start":"2026-03-20T00:45:25.883106Z","end":"2026-03-20T00:45:26.101609Z","steps":["trace[1558075590] 'read index received' (duration: 218.491914ms)","trace[1558075590] 'applied index is now lower than readState.Index' (duration: 8.651µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:26.602291Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748574,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:45:27.103139Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748574,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:45:27.603314Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748574,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:45:27.805285Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.922160711s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:27.805377Z","caller":"traceutil/trace.go:172","msg":"trace[1064939168] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:571; }","duration":"1.922260612s","start":"2026-03-20T00:45:25.883094Z","end":"2026-03-20T00:45:27.805355Z","steps":["trace[1064939168] 'agreement among raft nodes before linearized reading' (duration: 218.651805ms)","trace[1064939168] 'range keys from in-memory index tree' (duration: 1.703472465s)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:27.805415Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:25.883072Z","time spent":"1.922334662s","remote":"127.0.0.1:33404","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-03-20T00:45:27.808075Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.701140139s","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:45:27.808175Z","caller":"traceutil/trace.go:172","msg":"trace[687122367] transaction","detail":"{read_only:false; response_revision:572; number_of_response:1; }","duration":"2.227637525s","start":"2026-03-20T00:45:25.580522Z","end":"2026-03-20T00:45:27.808159Z","steps":["trace[687122367] 'process raft request' (duration: 525.443739ms)","trace[687122367] 'compare' (duration: 1.699596338s)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:27.808238Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:25.580497Z","time spent":"2.227709195s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":570081,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:45:28.103910Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748574,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:45:28.417088Z","caller":"wal/wal.go:845","msg":"slow fdatasync","took":"1.24193552s","expected-duration":"1s"} {"level":"info","ts":"2026-03-20T00:45:28.417334Z","caller":"traceutil/trace.go:172","msg":"trace[1045856219] linearizableReadLoop","detail":"{readStateIndex:597; appliedIndex:597; }","duration":"2.315588879s","start":"2026-03-20T00:45:26.101710Z","end":"2026-03-20T00:45:28.417299Z","steps":["trace[1045856219] 'read index received' (duration: 2.315576159s)","trace[1045856219] 'applied index is now lower than readState.Index' (duration: 10.98µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:28.451606Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46548","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.464136Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46560","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.499027Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46586","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.517396Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46612","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.592185Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46624","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.629043Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"2.653018797s","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:28.629142Z","caller":"traceutil/trace.go:172","msg":"trace[350767616] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:572; }","duration":"2.653131738s","start":"2026-03-20T00:45:25.975987Z","end":"2026-03-20T00:45:28.629119Z","steps":["trace[350767616] 'agreement among raft nodes before linearized reading' (duration: 2.441454568s)","trace[350767616] 'range keys from in-memory index tree' (duration: 211.519329ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:28.629338Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"211.221847ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:45:28.629560Z","caller":"traceutil/trace.go:172","msg":"trace[1364620785] transaction","detail":"{read_only:false; response_revision:574; number_of_response:1; }","duration":"1.960676463s","start":"2026-03-20T00:45:26.668871Z","end":"2026-03-20T00:45:28.629547Z","steps":["trace[1364620785] 'process raft request' (duration: 1.960538382s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.629661Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:26.668842Z","time spent":"1.960760884s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":466,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:28.629922Z","caller":"traceutil/trace.go:172","msg":"trace[197322178] transaction","detail":"{read_only:false; response_revision:573; number_of_response:1; }","duration":"2.680138154s","start":"2026-03-20T00:45:25.949765Z","end":"2026-03-20T00:45:28.629903Z","steps":["trace[197322178] 'process raft request' (duration: 2.468298142s)","trace[197322178] 'compare' (duration: 211.012876ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:28.629713Z","caller":"traceutil/trace.go:172","msg":"trace[1771717668] transaction","detail":"{read_only:false; response_revision:576; number_of_response:1; }","duration":"1.551650095s","start":"2026-03-20T00:45:27.077976Z","end":"2026-03-20T00:45:28.629626Z","steps":["trace[1771717668] 'process raft request' (duration: 1.551497323s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.629978Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:25.949738Z","time spent":"2.680216955s","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":207462,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:28.630069Z","caller":"traceutil/trace.go:172","msg":"trace[371894859] linearizableReadLoop","detail":"{readStateIndex:598; appliedIndex:597; }","duration":"212.653897ms","start":"2026-03-20T00:45:28.417406Z","end":"2026-03-20T00:45:28.630060Z","steps":["trace[371894859] 'read index received' (duration: 211.63236ms)","trace[371894859] 'applied index is now lower than readState.Index' (duration: 1.011257ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:28.630292Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:27.077941Z","time spent":"1.55215929s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":674,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:28.630380Z","caller":"traceutil/trace.go:172","msg":"trace[156740236] transaction","detail":"{read_only:false; response_revision:575; number_of_response:1; }","duration":"1.667179991s","start":"2026-03-20T00:45:26.963166Z","end":"2026-03-20T00:45:28.630346Z","steps":["trace[156740236] 'process raft request' (duration: 1.666281074s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.630416Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.936857372s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-03-20T00:45:28.630486Z","caller":"traceutil/trace.go:172","msg":"trace[699625592] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:577; }","duration":"1.936937003s","start":"2026-03-20T00:45:26.693534Z","end":"2026-03-20T00:45:28.630471Z","steps":["trace[699625592] 'agreement among raft nodes before linearized reading' (duration: 1.936741362s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.630522Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:26.693509Z","time spent":"1.937005113s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":1,"response size":464,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:45:28.630523Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:26.963138Z","time spent":"1.667312042s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":493,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:45:28.630757Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.169768774s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/162.253.55.52\" limit:1 ","response":"range_response_count:1 size:133"} {"level":"info","ts":"2026-03-20T00:45:28.630829Z","caller":"traceutil/trace.go:172","msg":"trace[677683232] range","detail":"{range_begin:/registry/masterleases/162.253.55.52; range_end:; response_count:1; response_revision:577; }","duration":"1.169838744s","start":"2026-03-20T00:45:27.460980Z","end":"2026-03-20T00:45:28.630818Z","steps":["trace[677683232] 'agreement among raft nodes before linearized reading' (duration: 1.169665803s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.630856Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:27.460952Z","time spent":"1.169896804s","remote":"127.0.0.1:33448","response type":"/etcdserverpb.KV/Range","request count":0,"request size":40,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/162.253.55.52\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:45:28.630855Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"823.936524ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-20T00:45:28.630866Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.662327237s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-20T00:45:28.630893Z","caller":"traceutil/trace.go:172","msg":"trace[2111485407] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:577; }","duration":"823.975095ms","start":"2026-03-20T00:45:27.806905Z","end":"2026-03-20T00:45:28.630880Z","steps":["trace[2111485407] 'agreement among raft nodes before linearized reading' (duration: 823.910294ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:28.630900Z","caller":"traceutil/trace.go:172","msg":"trace[1974936713] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:577; }","duration":"1.662361328s","start":"2026-03-20T00:45:26.968529Z","end":"2026-03-20T00:45:28.630891Z","steps":["trace[1974936713] 'agreement among raft nodes before linearized reading' (duration: 1.662275997s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.630924Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:26.968514Z","time spent":"1.662404289s","remote":"127.0.0.1:39384","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-cp-lock\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:45:28.630916Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:27.806882Z","time spent":"824.030426ms","remote":"127.0.0.1:33418","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"info","ts":"2026-03-20T00:45:28.631152Z","caller":"traceutil/trace.go:172","msg":"trace[924870857] transaction","detail":"{read_only:false; response_revision:577; number_of_response:1; }","duration":"754.246801ms","start":"2026-03-20T00:45:27.876891Z","end":"2026-03-20T00:45:28.631138Z","steps":["trace[924870857] 'process raft request' (duration: 752.60264ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.631248Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:27.876869Z","time spent":"754.336462ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":15664,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:45:28.631518Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"170.469122ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:28.631549Z","caller":"traceutil/trace.go:172","msg":"trace[1313493602] transaction","detail":"{read_only:false; response_revision:578; number_of_response:1; }","duration":"618.866653ms","start":"2026-03-20T00:45:28.012673Z","end":"2026-03-20T00:45:28.631540Z","steps":["trace[1313493602] 'process raft request' (duration: 617.204462ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.631585Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"104.335315ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tcproutes\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:28.631630Z","caller":"traceutil/trace.go:172","msg":"trace[751351173] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes; range_end:; response_count:0; response_revision:578; }","duration":"104.380295ms","start":"2026-03-20T00:45:28.527241Z","end":"2026-03-20T00:45:28.631621Z","steps":["trace[751351173] 'agreement among raft nodes before linearized reading' (duration: 104.312765ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.631678Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"159.043866ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-20T00:45:28.631645Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"126.040962ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:28.631695Z","caller":"traceutil/trace.go:172","msg":"trace[715489816] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants; range_end:; response_count:0; response_revision:578; }","duration":"159.060316ms","start":"2026-03-20T00:45:28.472629Z","end":"2026-03-20T00:45:28.631689Z","steps":["trace[715489816] 'agreement among raft nodes before linearized reading' (duration: 159.036215ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:28.631717Z","caller":"traceutil/trace.go:172","msg":"trace[162121448] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets; range_end:; response_count:0; response_revision:578; }","duration":"126.108693ms","start":"2026-03-20T00:45:28.505594Z","end":"2026-03-20T00:45:28.631703Z","steps":["trace[162121448] 'agreement among raft nodes before linearized reading' (duration: 126.021372ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.631548Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"126.137963ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.x-k8s.io/xlistenersets/\" range_end:\"/registry/gateway.networking.x-k8s.io/xlistenersets0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:28.631935Z","caller":"traceutil/trace.go:172","msg":"trace[944939548] range","detail":"{range_begin:/registry/gateway.networking.x-k8s.io/xlistenersets/; range_end:/registry/gateway.networking.x-k8s.io/xlistenersets0; response_count:0; response_revision:578; }","duration":"126.538735ms","start":"2026-03-20T00:45:28.505390Z","end":"2026-03-20T00:45:28.631929Z","steps":["trace[944939548] 'agreement among raft nodes before linearized reading' (duration: 125.978172ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.631992Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"104.678128ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tcproutes/\" range_end:\"/registry/gateway.networking.k8s.io/tcproutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:28.632003Z","caller":"traceutil/trace.go:172","msg":"trace[1116621092] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tcproutes/; range_end:/registry/gateway.networking.k8s.io/tcproutes0; response_count:0; response_revision:578; }","duration":"104.691678ms","start":"2026-03-20T00:45:28.527308Z","end":"2026-03-20T00:45:28.631999Z","steps":["trace[1116621092] 'agreement among raft nodes before linearized reading' (duration: 104.667637ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.631600Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:28.012644Z","time spent":"618.924363ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":570090,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:28.631569Z","caller":"traceutil/trace.go:172","msg":"trace[53951473] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies; range_end:; response_count:0; response_revision:578; }","duration":"170.523853ms","start":"2026-03-20T00:45:28.461034Z","end":"2026-03-20T00:45:28.631558Z","steps":["trace[53951473] 'agreement among raft nodes before linearized reading' (duration: 170.438032ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.632874Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"161.003618ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/referencegrants/\" range_end:\"/registry/gateway.networking.k8s.io/referencegrants0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:28.632904Z","caller":"traceutil/trace.go:172","msg":"trace[677610401] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/referencegrants/; range_end:/registry/gateway.networking.k8s.io/referencegrants0; response_count:0; response_revision:578; }","duration":"161.036638ms","start":"2026-03-20T00:45:28.471859Z","end":"2026-03-20T00:45:28.632895Z","steps":["trace[677610401] 'agreement among raft nodes before linearized reading' (duration: 160.984628ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.633090Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"172.105654ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies/\" range_end:\"/registry/gateway.envoyproxy.io/envoyextensionpolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:28.633144Z","caller":"traceutil/trace.go:172","msg":"trace[1752716111] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/envoyextensionpolicies/; range_end:/registry/gateway.envoyproxy.io/envoyextensionpolicies0; response_count:0; response_revision:578; }","duration":"172.168144ms","start":"2026-03-20T00:45:28.460964Z","end":"2026-03-20T00:45:28.633132Z","steps":["trace[1752716111] 'agreement among raft nodes before linearized reading' (duration: 172.077273ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:28.660616Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46650","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.698803Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46662","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.713892Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46682","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.741041Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46702","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.760874Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46728","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.796839Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46732","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.846430Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46756","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.875887Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46770","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.928654Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46802","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.966249Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46816","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:28.988125Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46834","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:29.066557Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46838","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:29.091984Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46844","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:29.106759Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46872","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:29.121434Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46890","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:29.148035Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46910","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:29.154021Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:46920","server-name":"","error":"EOF"} {"level":"info","ts":"2026-03-20T00:45:29.286380Z","caller":"traceutil/trace.go:172","msg":"trace[1019128158] transaction","detail":"{read_only:false; response_revision:583; number_of_response:1; }","duration":"114.175478ms","start":"2026-03-20T00:45:29.172179Z","end":"2026-03-20T00:45:29.286354Z","steps":["trace[1019128158] 'process raft request' (duration: 113.929726ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:30.766411Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"119.47923ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-03-20T00:45:30.766519Z","caller":"traceutil/trace.go:172","msg":"trace[2075335089] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:586; }","duration":"119.590111ms","start":"2026-03-20T00:45:30.646892Z","end":"2026-03-20T00:45:30.766482Z","steps":["trace[2075335089] 'agreement among raft nodes before linearized reading' (duration: 97.226951ms)","trace[2075335089] 'range keys from in-memory index tree' (duration: 22.114208ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:30.766534Z","caller":"traceutil/trace.go:172","msg":"trace[538555537] transaction","detail":"{read_only:false; response_revision:587; number_of_response:1; }","duration":"125.898594ms","start":"2026-03-20T00:45:30.640606Z","end":"2026-03-20T00:45:30.766504Z","steps":["trace[538555537] 'process raft request' (duration: 103.568934ms)","trace[538555537] 'compare' (duration: 22.065418ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:32.736401Z","caller":"traceutil/trace.go:172","msg":"trace[1469800917] transaction","detail":"{read_only:false; response_revision:591; number_of_response:1; }","duration":"129.137349ms","start":"2026-03-20T00:45:32.607230Z","end":"2026-03-20T00:45:32.736367Z","steps":["trace[1469800917] 'process raft request' (duration: 104.371135ms)","trace[1469800917] 'compare' (duration: 24.522702ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:32.760463Z","caller":"traceutil/trace.go:172","msg":"trace[1579754306] transaction","detail":"{read_only:false; response_revision:592; number_of_response:1; }","duration":"150.158317ms","start":"2026-03-20T00:45:32.610287Z","end":"2026-03-20T00:45:32.760445Z","steps":["trace[1579754306] 'process raft request' (duration: 150.022926ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:32.966452Z","caller":"traceutil/trace.go:172","msg":"trace[1049060348] linearizableReadLoop","detail":"{readStateIndex:619; appliedIndex:619; }","duration":"194.336121ms","start":"2026-03-20T00:45:32.772074Z","end":"2026-03-20T00:45:32.966410Z","steps":["trace[1049060348] 'read index received' (duration: 194.318301ms)","trace[1049060348] 'applied index is now lower than readState.Index' (duration: 15.21µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:32.971640Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"199.542895ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-20T00:45:32.971708Z","caller":"traceutil/trace.go:172","msg":"trace[525278448] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:593; }","duration":"199.627127ms","start":"2026-03-20T00:45:32.772069Z","end":"2026-03-20T00:45:32.971696Z","steps":["trace[525278448] 'agreement among raft nodes before linearized reading' (duration: 194.482552ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:32.971972Z","caller":"traceutil/trace.go:172","msg":"trace[1407564867] transaction","detail":"{read_only:false; response_revision:594; number_of_response:1; }","duration":"200.506623ms","start":"2026-03-20T00:45:32.771362Z","end":"2026-03-20T00:45:32.971869Z","steps":["trace[1407564867] 'process raft request' (duration: 195.267488ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:32.972407Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"144.584961ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-03-20T00:45:32.972436Z","caller":"traceutil/trace.go:172","msg":"trace[146850136] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:594; }","duration":"144.614901ms","start":"2026-03-20T00:45:32.827815Z","end":"2026-03-20T00:45:32.972430Z","steps":["trace[146850136] 'agreement among raft nodes before linearized reading' (duration: 144.541871ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:34.476290Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748733,"retry-timeout":"500ms"} {"level":"info","ts":"2026-03-20T00:45:34.521068Z","caller":"traceutil/trace.go:172","msg":"trace[1922581277] linearizableReadLoop","detail":"{readStateIndex:628; appliedIndex:628; }","duration":"544.821843ms","start":"2026-03-20T00:45:33.976225Z","end":"2026-03-20T00:45:34.521047Z","steps":["trace[1922581277] 'read index received' (duration: 544.814693ms)","trace[1922581277] 'applied index is now lower than readState.Index' (duration: 6.03µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:34.521187Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"544.945054ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:34.521223Z","caller":"traceutil/trace.go:172","msg":"trace[1168260998] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:601; }","duration":"545.034094ms","start":"2026-03-20T00:45:33.976178Z","end":"2026-03-20T00:45:34.521212Z","steps":["trace[1168260998] 'agreement among raft nodes before linearized reading' (duration: 544.945954ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:34.525807Z","caller":"traceutil/trace.go:172","msg":"trace[1297842888] transaction","detail":"{read_only:false; response_revision:602; number_of_response:1; }","duration":"1.031759055s","start":"2026-03-20T00:45:33.493996Z","end":"2026-03-20T00:45:34.525755Z","steps":["trace[1297842888] 'process raft request' (duration: 1.028766685s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:34.525937Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:33.493964Z","time spent":"1.031898376s","remote":"127.0.0.1:33546","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036105,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:45:34.757539Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"144.109629ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure:<>>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:45:34.757654Z","caller":"traceutil/trace.go:172","msg":"trace[995000038] transaction","detail":"{read_only:false; response_revision:603; number_of_response:1; }","duration":"173.509694ms","start":"2026-03-20T00:45:34.584128Z","end":"2026-03-20T00:45:34.757638Z","steps":["trace[995000038] 'process raft request' (duration: 29.220173ms)","trace[995000038] 'compare' (duration: 143.874428ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:35.269896Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748735,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:45:35.770613Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748735,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:45:36.271326Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748735,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:45:36.772484Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748735,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:45:36.883511Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"2.000273247s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"","error":"context deadline exceeded"} {"level":"info","ts":"2026-03-20T00:45:36.883830Z","caller":"traceutil/trace.go:172","msg":"trace[874407450] range","detail":"{range_begin:/registry/health; range_end:; }","duration":"2.000455055s","start":"2026-03-20T00:45:34.883199Z","end":"2026-03-20T00:45:36.883654Z","steps":["trace[874407450] 'agreement among raft nodes before linearized reading' (duration: 2.000269267s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:36.884098Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:34.883171Z","time spent":"2.000909226s","remote":"127.0.0.1:33404","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":0,"request content":"key:\"/registry/health\" "} 2026/03/20 00:45:36 WARNING: [core] [Server #6]grpc: Server.processUnaryRPC failed to write status: connection error: desc = "transport is closing" {"level":"warn","ts":"2026-03-20T00:45:36.971754Z","caller":"wal/wal.go:845","msg":"slow fdatasync","took":"2.205283435s","expected-duration":"1s"} {"level":"info","ts":"2026-03-20T00:45:36.972048Z","caller":"traceutil/trace.go:172","msg":"trace[1115787286] linearizableReadLoop","detail":"{readStateIndex:630; appliedIndex:630; }","duration":"2.202949441s","start":"2026-03-20T00:45:34.769066Z","end":"2026-03-20T00:45:36.972015Z","steps":["trace[1115787286] 'read index received' (duration: 2.20293834s)","trace[1115787286] 'applied index is now lower than readState.Index' (duration: 9.811µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:37.473276Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675748739,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:45:37.975156Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"2.998452787s","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-20T00:45:37.975756Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"3.206682793s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/roles/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:37.975846Z","caller":"traceutil/trace.go:172","msg":"trace[972149732] range","detail":"{range_begin:/registry/roles/envoy-gateway-system/envoy-gateway-gateway-helm-certgen; range_end:; response_count:0; response_revision:603; }","duration":"3.206777707s","start":"2026-03-20T00:45:34.769049Z","end":"2026-03-20T00:45:37.975826Z","steps":["trace[972149732] 'agreement among raft nodes before linearized reading' (duration: 2.203095407s)","trace[972149732] 'range keys from in-memory index tree' (duration: 1.003552875s)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:37.975884Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:34.769026Z","time spent":"3.20684874s","remote":"127.0.0.1:39546","response type":"/etcdserverpb.KV/Range","request count":0,"request size":75,"response count":0,"response size":29,"request content":"key:\"/registry/roles/envoy-gateway-system/envoy-gateway-gateway-helm-certgen\" limit:1 "} {"level":"info","ts":"2026-03-20T00:45:37.976316Z","caller":"traceutil/trace.go:172","msg":"trace[373742154] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:603; }","duration":"2.998565642s","start":"2026-03-20T00:45:34.976664Z","end":"2026-03-20T00:45:37.975229Z","steps":["trace[373742154] 'range keys from in-memory index tree' (duration: 2.998391795s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:37.976703Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.004582291s","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:45:37.976887Z","caller":"traceutil/trace.go:172","msg":"trace[1078778387] transaction","detail":"{read_only:false; response_revision:605; number_of_response:1; }","duration":"2.998522215s","start":"2026-03-20T00:45:34.978353Z","end":"2026-03-20T00:45:37.976875Z","steps":["trace[1078778387] 'process raft request' (duration: 2.998461362s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:37.976990Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:34.978321Z","time spent":"2.998596677s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":466,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:37.977267Z","caller":"traceutil/trace.go:172","msg":"trace[840530965] transaction","detail":"{read_only:false; response_revision:604; number_of_response:1; }","duration":"3.210924721s","start":"2026-03-20T00:45:34.766330Z","end":"2026-03-20T00:45:37.977254Z","steps":["trace[840530965] 'process raft request' (duration: 2.205733681s)","trace[840530965] 'compare' (duration: 1.003150367s)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:37.977318Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:34.766292Z","time spent":"3.210998652s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":493,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:37.977513Z","caller":"traceutil/trace.go:172","msg":"trace[14076663] linearizableReadLoop","detail":"{readStateIndex:631; appliedIndex:630; }","duration":"1.005269432s","start":"2026-03-20T00:45:36.972223Z","end":"2026-03-20T00:45:37.977493Z","steps":["trace[14076663] 'read index received' (duration: 951.102592ms)","trace[14076663] 'applied index is now lower than readState.Index' (duration: 54.16528ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:37.977650Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.093811724s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:37.977677Z","caller":"traceutil/trace.go:172","msg":"trace[1424311846] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:605; }","duration":"1.093841695s","start":"2026-03-20T00:45:36.883827Z","end":"2026-03-20T00:45:37.977668Z","steps":["trace[1424311846] 'agreement among raft nodes before linearized reading' (duration: 1.093786383s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:37.977710Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:36.883804Z","time spent":"1.093900299s","remote":"127.0.0.1:33418","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-03-20T00:45:37.977897Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"2.993965965s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-03-20T00:45:37.977944Z","caller":"traceutil/trace.go:172","msg":"trace[2069134404] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:605; }","duration":"2.994014528s","start":"2026-03-20T00:45:34.983918Z","end":"2026-03-20T00:45:37.977932Z","steps":["trace[2069134404] 'agreement among raft nodes before linearized reading' (duration: 2.993876031s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:37.977957Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"516.876674ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/162.253.55.52\" limit:1 ","response":"range_response_count:1 size:133"} {"level":"warn","ts":"2026-03-20T00:45:37.977973Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:34.983906Z","time spent":"2.994059619s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":1,"response size":464,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 "} {"level":"info","ts":"2026-03-20T00:45:37.977998Z","caller":"traceutil/trace.go:172","msg":"trace[1090567213] range","detail":"{range_begin:/registry/masterleases/162.253.55.52; range_end:; response_count:1; response_revision:605; }","duration":"516.918756ms","start":"2026-03-20T00:45:37.461071Z","end":"2026-03-20T00:45:37.977989Z","steps":["trace[1090567213] 'agreement among raft nodes before linearized reading' (duration: 516.814701ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:37.978027Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:37.461048Z","time spent":"516.973229ms","remote":"127.0.0.1:33448","response type":"/etcdserverpb.KV/Range","request count":0,"request size":40,"response count":1,"response size":157,"request content":"key:\"/registry/masterleases/162.253.55.52\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:45:37.979402Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"2.992613874s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-20T00:45:37.979507Z","caller":"traceutil/trace.go:172","msg":"trace[2081149120] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:605; }","duration":"2.994042539s","start":"2026-03-20T00:45:34.985443Z","end":"2026-03-20T00:45:37.979485Z","steps":["trace[2081149120] 'agreement among raft nodes before linearized reading' (duration: 2.992345652s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:37.979570Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:34.985435Z","time spent":"2.994106452s","remote":"127.0.0.1:39384","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-cp-lock\" limit:1 "} {"level":"info","ts":"2026-03-20T00:45:40.109735Z","caller":"traceutil/trace.go:172","msg":"trace[1027836002] linearizableReadLoop","detail":"{readStateIndex:650; appliedIndex:650; }","duration":"226.075086ms","start":"2026-03-20T00:45:39.883633Z","end":"2026-03-20T00:45:40.109708Z","steps":["trace[1027836002] 'read index received' (duration: 226.048375ms)","trace[1027836002] 'applied index is now lower than readState.Index' (duration: 8.03µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:40.109902Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"226.260843ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:40.109982Z","caller":"traceutil/trace.go:172","msg":"trace[15026978] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:622; }","duration":"226.349407ms","start":"2026-03-20T00:45:39.883614Z","end":"2026-03-20T00:45:40.109963Z","steps":["trace[15026978] 'agreement among raft nodes before linearized reading' (duration: 226.209381ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:40.111003Z","caller":"traceutil/trace.go:172","msg":"trace[2039825292] transaction","detail":"{read_only:false; response_revision:623; number_of_response:1; }","duration":"680.993657ms","start":"2026-03-20T00:45:39.429949Z","end":"2026-03-20T00:45:40.110943Z","steps":["trace[2039825292] 'process raft request' (duration: 680.096618ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:40.111150Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:39.429914Z","time spent":"681.160425ms","remote":"127.0.0.1:33546","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036221,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:45:40.115272Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"139.137741ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:40.115312Z","caller":"traceutil/trace.go:172","msg":"trace[1459838162] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:623; }","duration":"139.178683ms","start":"2026-03-20T00:45:39.976124Z","end":"2026-03-20T00:45:40.115303Z","steps":["trace[1459838162] 'agreement among raft nodes before linearized reading' (duration: 139.125251ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:40.115673Z","caller":"traceutil/trace.go:172","msg":"trace[508523951] transaction","detail":"{read_only:false; response_revision:624; number_of_response:1; }","duration":"134.236621ms","start":"2026-03-20T00:45:39.981387Z","end":"2026-03-20T00:45:40.115624Z","steps":["trace[508523951] 'process raft request' (duration: 134.101525ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:40.115826Z","caller":"traceutil/trace.go:172","msg":"trace[1175820495] transaction","detail":"{read_only:false; response_revision:625; number_of_response:1; }","duration":"132.894372ms","start":"2026-03-20T00:45:39.982861Z","end":"2026-03-20T00:45:40.115756Z","steps":["trace[1175820495] 'process raft request' (duration: 132.721284ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:40.753032Z","caller":"traceutil/trace.go:172","msg":"trace[1506269354] transaction","detail":"{read_only:false; response_revision:636; number_of_response:1; }","duration":"169.355537ms","start":"2026-03-20T00:45:40.583652Z","end":"2026-03-20T00:45:40.753008Z","steps":["trace[1506269354] 'process raft request' (duration: 168.726779ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:40.756482Z","caller":"traceutil/trace.go:172","msg":"trace[1348239772] transaction","detail":"{read_only:false; response_revision:637; number_of_response:1; }","duration":"160.184521ms","start":"2026-03-20T00:45:40.596238Z","end":"2026-03-20T00:45:40.756423Z","steps":["trace[1348239772] 'process raft request' (duration: 159.982512ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:41.337677Z","caller":"traceutil/trace.go:172","msg":"trace[1268202496] transaction","detail":"{read_only:false; response_revision:639; number_of_response:1; }","duration":"118.04645ms","start":"2026-03-20T00:45:41.219608Z","end":"2026-03-20T00:45:41.337654Z","steps":["trace[1268202496] 'process raft request' (duration: 117.232275ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:41.634767Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"197.554923ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:45:41.635276Z","caller":"traceutil/trace.go:172","msg":"trace[1469558219] transaction","detail":"{read_only:false; response_revision:643; number_of_response:1; }","duration":"229.987923ms","start":"2026-03-20T00:45:41.405271Z","end":"2026-03-20T00:45:41.635259Z","steps":["trace[1469558219] 'process raft request' (duration: 229.940441ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:41.635491Z","caller":"traceutil/trace.go:172","msg":"trace[1539281697] transaction","detail":"{read_only:false; response_revision:641; number_of_response:1; }","duration":"284.008008ms","start":"2026-03-20T00:45:41.351471Z","end":"2026-03-20T00:45:41.635479Z","steps":["trace[1539281697] 'process raft request' (duration: 85.664601ms)","trace[1539281697] 'compare' (duration: 197.305072ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:41.635568Z","caller":"traceutil/trace.go:172","msg":"trace[1262848133] transaction","detail":"{read_only:false; response_revision:642; number_of_response:1; }","duration":"276.702549ms","start":"2026-03-20T00:45:41.358858Z","end":"2026-03-20T00:45:41.635561Z","steps":["trace[1262848133] 'process raft request' (duration: 276.249559ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:42.264872Z","caller":"traceutil/trace.go:172","msg":"trace[1473402235] linearizableReadLoop","detail":"{readStateIndex:673; appliedIndex:673; }","duration":"133.636404ms","start":"2026-03-20T00:45:42.131204Z","end":"2026-03-20T00:45:42.264841Z","steps":["trace[1473402235] 'read index received' (duration: 133.621593ms)","trace[1473402235] 'applied index is now lower than readState.Index' (duration: 12.751µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:42.490090Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"358.87185ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 ","response":"range_response_count:1 size:435"} {"level":"info","ts":"2026-03-20T00:45:42.490189Z","caller":"traceutil/trace.go:172","msg":"trace[931633547] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:645; }","duration":"358.977215ms","start":"2026-03-20T00:45:42.131193Z","end":"2026-03-20T00:45:42.490171Z","steps":["trace[931633547] 'agreement among raft nodes before linearized reading' (duration: 133.80222ms)","trace[931633547] 'range keys from in-memory index tree' (duration: 224.928784ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:42.490231Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:42.131175Z","time spent":"359.045978ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":459,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:45:42.493553Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"227.020425ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:45:42.493657Z","caller":"traceutil/trace.go:172","msg":"trace[1405112003] transaction","detail":"{read_only:false; response_revision:646; number_of_response:1; }","duration":"420.352052ms","start":"2026-03-20T00:45:42.073287Z","end":"2026-03-20T00:45:42.493639Z","steps":["trace[1405112003] 'process raft request' (duration: 193.173189ms)","trace[1405112003] 'compare' (duration: 225.289671ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:42.493721Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:42.073239Z","time spent":"420.454856ms","remote":"127.0.0.1:33546","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036309,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:42.504237Z","caller":"traceutil/trace.go:172","msg":"trace[2032918486] linearizableReadLoop","detail":"{readStateIndex:674; appliedIndex:674; }","duration":"239.269524ms","start":"2026-03-20T00:45:42.264955Z","end":"2026-03-20T00:45:42.504225Z","steps":["trace[2032918486] 'read index received' (duration: 239.263354ms)","trace[2032918486] 'applied index is now lower than readState.Index' (duration: 5.35µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:42.504357Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"368.470885ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:439"} {"level":"info","ts":"2026-03-20T00:45:42.504384Z","caller":"traceutil/trace.go:172","msg":"trace[1018837183] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:646; }","duration":"368.495686ms","start":"2026-03-20T00:45:42.135874Z","end":"2026-03-20T00:45:42.504370Z","steps":["trace[1018837183] 'agreement among raft nodes before linearized reading' (duration: 368.396082ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:42.504403Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:42.135858Z","time spent":"368.541048ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":1,"response size":463,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 "} {"level":"info","ts":"2026-03-20T00:45:42.504410Z","caller":"traceutil/trace.go:172","msg":"trace[1435380997] transaction","detail":"{read_only:false; response_revision:648; number_of_response:1; }","duration":"382.936641ms","start":"2026-03-20T00:45:42.121460Z","end":"2026-03-20T00:45:42.504397Z","steps":["trace[1435380997] 'process raft request' (duration: 382.90826ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:42.504472Z","caller":"traceutil/trace.go:172","msg":"trace[867882890] transaction","detail":"{read_only:false; response_revision:647; number_of_response:1; }","duration":"383.239514ms","start":"2026-03-20T00:45:42.121221Z","end":"2026-03-20T00:45:42.504460Z","steps":["trace[867882890] 'process raft request' (duration: 383.071147ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:42.504503Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:42.121445Z","time spent":"383.010544ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":465,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:45:42.504541Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:42.121191Z","time spent":"383.308977ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":492,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:42.716124Z","caller":"traceutil/trace.go:172","msg":"trace[982455334] linearizableReadLoop","detail":"{readStateIndex:677; appliedIndex:677; }","duration":"150.799726ms","start":"2026-03-20T00:45:42.565274Z","end":"2026-03-20T00:45:42.716074Z","steps":["trace[982455334] 'read index received' (duration: 150.786256ms)","trace[982455334] 'applied index is now lower than readState.Index' (duration: 11.6µs)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:42.716275Z","caller":"traceutil/trace.go:172","msg":"trace[26768398] transaction","detail":"{read_only:false; response_revision:650; number_of_response:1; }","duration":"207.386035ms","start":"2026-03-20T00:45:42.508868Z","end":"2026-03-20T00:45:42.716254Z","steps":["trace[26768398] 'process raft request' (duration: 207.25933ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:42.716388Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"151.083698ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/events/kube-system/cilium-operator-75968c57df-dl969.189e66147407b57d\" limit:1 ","response":"range_response_count:1 size:865"} {"level":"info","ts":"2026-03-20T00:45:42.716660Z","caller":"traceutil/trace.go:172","msg":"trace[1143545175] range","detail":"{range_begin:/registry/events/kube-system/cilium-operator-75968c57df-dl969.189e66147407b57d; range_end:; response_count:1; response_revision:650; }","duration":"151.370691ms","start":"2026-03-20T00:45:42.565268Z","end":"2026-03-20T00:45:42.716639Z","steps":["trace[1143545175] 'agreement among raft nodes before linearized reading' (duration: 150.950893ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:42.722726Z","caller":"traceutil/trace.go:172","msg":"trace[1308137983] transaction","detail":"{read_only:false; response_revision:651; number_of_response:1; }","duration":"152.334892ms","start":"2026-03-20T00:45:42.570371Z","end":"2026-03-20T00:45:42.722706Z","steps":["trace[1308137983] 'process raft request' (duration: 152.212987ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:43.013305Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"287.184872ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/serviceaccounts/kube-system/job-controller\" limit:1 ","response":"range_response_count:1 size:193"} {"level":"info","ts":"2026-03-20T00:45:43.013406Z","caller":"traceutil/trace.go:172","msg":"trace[1775301402] range","detail":"{range_begin:/registry/serviceaccounts/kube-system/job-controller; range_end:; response_count:1; response_revision:651; }","duration":"287.299147ms","start":"2026-03-20T00:45:42.726082Z","end":"2026-03-20T00:45:43.013381Z","steps":["trace[1775301402] 'agreement among raft nodes before linearized reading' (duration: 89.682451ms)","trace[1775301402] 'range keys from in-memory index tree' (duration: 197.346823ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:43.013939Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"197.898777ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:45:43.014209Z","caller":"traceutil/trace.go:172","msg":"trace[843331853] transaction","detail":"{read_only:false; response_revision:652; number_of_response:1; }","duration":"290.799977ms","start":"2026-03-20T00:45:42.723387Z","end":"2026-03-20T00:45:43.014187Z","steps":["trace[843331853] 'process raft request' (duration: 92.474882ms)","trace[843331853] 'compare' (duration: 197.407556ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:43.696098Z","caller":"traceutil/trace.go:172","msg":"trace[478849915] transaction","detail":"{read_only:false; response_revision:659; number_of_response:1; }","duration":"120.824387ms","start":"2026-03-20T00:45:43.575250Z","end":"2026-03-20T00:45:43.696074Z","steps":["trace[478849915] 'process raft request' (duration: 120.678461ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:43.888083Z","caller":"traceutil/trace.go:172","msg":"trace[369850047] transaction","detail":"{read_only:false; response_revision:660; number_of_response:1; }","duration":"300.451107ms","start":"2026-03-20T00:45:43.587616Z","end":"2026-03-20T00:45:43.888067Z","steps":["trace[369850047] 'process raft request' (duration: 300.328132ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:43.888195Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:43.587581Z","time spent":"300.555362ms","remote":"127.0.0.1:39242","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":19646,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:43.925318Z","caller":"traceutil/trace.go:172","msg":"trace[1772013049] transaction","detail":"{read_only:false; response_revision:661; number_of_response:1; }","duration":"224.763161ms","start":"2026-03-20T00:45:43.700528Z","end":"2026-03-20T00:45:43.925291Z","steps":["trace[1772013049] 'process raft request' (duration: 224.542541ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:44.131676Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"206.481863ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"warn","ts":"2026-03-20T00:45:44.131897Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"156.181441ms","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-03-20T00:45:44.132447Z","caller":"traceutil/trace.go:172","msg":"trace[1729955625] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:661; }","duration":"156.245194ms","start":"2026-03-20T00:45:43.975692Z","end":"2026-03-20T00:45:44.131937Z","steps":["trace[1729955625] 'range keys from in-memory index tree' (duration: 156.1381ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:44.778225Z","caller":"traceutil/trace.go:172","msg":"trace[382539843] linearizableReadLoop","detail":"{readStateIndex:692; appliedIndex:692; }","duration":"208.591653ms","start":"2026-03-20T00:45:44.569610Z","end":"2026-03-20T00:45:44.778202Z","steps":["trace[382539843] 'read index received' (duration: 208.585173ms)","trace[382539843] 'applied index is now lower than readState.Index' (duration: 5.26µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:44.778437Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"208.817382ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 ","response":"range_response_count:1 size:435"} {"level":"info","ts":"2026-03-20T00:45:44.778464Z","caller":"traceutil/trace.go:172","msg":"trace[1154310608] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:663; }","duration":"208.859874ms","start":"2026-03-20T00:45:44.569596Z","end":"2026-03-20T00:45:44.778456Z","steps":["trace[1154310608] 'agreement among raft nodes before linearized reading' (duration: 208.721298ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:44.778642Z","caller":"traceutil/trace.go:172","msg":"trace[611879583] transaction","detail":"{read_only:false; response_revision:664; number_of_response:1; }","duration":"266.318733ms","start":"2026-03-20T00:45:44.512300Z","end":"2026-03-20T00:45:44.778619Z","steps":["trace[611879583] 'process raft request' (duration: 265.958697ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:44.931498Z","caller":"traceutil/trace.go:172","msg":"trace[866813497] transaction","detail":"{read_only:false; response_revision:665; number_of_response:1; }","duration":"149.238776ms","start":"2026-03-20T00:45:44.782226Z","end":"2026-03-20T00:45:44.931465Z","steps":["trace[866813497] 'process raft request' (duration: 126.130579ms)","trace[866813497] 'compare' (duration: 22.979762ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:44.931532Z","caller":"traceutil/trace.go:172","msg":"trace[1005073477] transaction","detail":"{read_only:false; response_revision:666; number_of_response:1; }","duration":"147.842147ms","start":"2026-03-20T00:45:44.783669Z","end":"2026-03-20T00:45:44.931511Z","steps":["trace[1005073477] 'process raft request' (duration: 147.787815ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:45.878975Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"119.562093ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/clusterroles\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:45.879056Z","caller":"traceutil/trace.go:172","msg":"trace[1547482900] range","detail":"{range_begin:/registry/clusterroles; range_end:; response_count:0; response_revision:667; }","duration":"119.649926ms","start":"2026-03-20T00:45:45.759388Z","end":"2026-03-20T00:45:45.879038Z","steps":["trace[1547482900] 'agreement among raft nodes before linearized reading' (duration: 32.035349ms)","trace[1547482900] 'range keys from in-memory index tree' (duration: 87.500403ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:45.879369Z","caller":"traceutil/trace.go:172","msg":"trace[501217229] transaction","detail":"{read_only:false; response_revision:668; number_of_response:1; }","duration":"858.212295ms","start":"2026-03-20T00:45:45.021131Z","end":"2026-03-20T00:45:45.879344Z","steps":["trace[501217229] 'process raft request' (duration: 770.353807ms)","trace[501217229] 'compare' (duration: 87.125898ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:45.879494Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:45.021103Z","time spent":"858.33907ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":479,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:46.095453Z","caller":"traceutil/trace.go:172","msg":"trace[151728186] linearizableReadLoop","detail":"{readStateIndex:697; appliedIndex:697; }","duration":"197.366214ms","start":"2026-03-20T00:45:45.898054Z","end":"2026-03-20T00:45:46.095420Z","steps":["trace[151728186] 'read index received' (duration: 197.353713ms)","trace[151728186] 'applied index is now lower than readState.Index' (duration: 10.361µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:46.095569Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"197.49155ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumcidrgroups.cilium.io\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:46.095635Z","caller":"traceutil/trace.go:172","msg":"trace[751903328] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumcidrgroups.cilium.io; range_end:; response_count:0; response_revision:668; }","duration":"197.572623ms","start":"2026-03-20T00:45:45.898050Z","end":"2026-03-20T00:45:46.095622Z","steps":["trace[751903328] 'agreement among raft nodes before linearized reading' (duration: 197.449268ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:46.095868Z","caller":"traceutil/trace.go:172","msg":"trace[2008833421] transaction","detail":"{read_only:false; response_revision:669; number_of_response:1; }","duration":"200.38371ms","start":"2026-03-20T00:45:45.895457Z","end":"2026-03-20T00:45:46.095841Z","steps":["trace[2008833421] 'process raft request' (duration: 200.153571ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:46.318709Z","caller":"traceutil/trace.go:172","msg":"trace[861468128] linearizableReadLoop","detail":"{readStateIndex:698; appliedIndex:698; }","duration":"223.145828ms","start":"2026-03-20T00:45:46.095535Z","end":"2026-03-20T00:45:46.318681Z","steps":["trace[861468128] 'read index received' (duration: 223.134908ms)","trace[861468128] 'applied index is now lower than readState.Index' (duration: 9.27µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:46.318828Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"228.166476ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliuml2announcementpolicies.cilium.io\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:46.318905Z","caller":"traceutil/trace.go:172","msg":"trace[769127050] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliuml2announcementpolicies.cilium.io; range_end:; response_count:0; response_revision:669; }","duration":"228.2523ms","start":"2026-03-20T00:45:46.090634Z","end":"2026-03-20T00:45:46.318886Z","steps":["trace[769127050] 'agreement among raft nodes before linearized reading' (duration: 228.098333ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:46.319112Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"256.498105ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-fgts7\" limit:1 ","response":"range_response_count:1 size:19661"} {"level":"info","ts":"2026-03-20T00:45:46.319161Z","caller":"traceutil/trace.go:172","msg":"trace[825885559] range","detail":"{range_begin:/registry/pods/kube-system/cilium-fgts7; range_end:; response_count:1; response_revision:669; }","duration":"256.565297ms","start":"2026-03-20T00:45:46.062585Z","end":"2026-03-20T00:45:46.319151Z","steps":["trace[825885559] 'agreement among raft nodes before linearized reading' (duration: 256.278506ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:46.319240Z","caller":"traceutil/trace.go:172","msg":"trace[2073378943] transaction","detail":"{read_only:false; response_revision:670; number_of_response:1; }","duration":"421.702351ms","start":"2026-03-20T00:45:45.897524Z","end":"2026-03-20T00:45:46.319227Z","steps":["trace[2073378943] 'process raft request' (duration: 421.205431ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:46.319327Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:45.897500Z","time spent":"421.781465ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3104,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-03-20T00:45:46.319684Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"343.455795ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:46.319791Z","caller":"traceutil/trace.go:172","msg":"trace[272735233] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:670; }","duration":"343.83038ms","start":"2026-03-20T00:45:45.975923Z","end":"2026-03-20T00:45:46.319753Z","steps":["trace[272735233] 'agreement among raft nodes before linearized reading' (duration: 343.037958ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:46.319318Z","caller":"traceutil/trace.go:172","msg":"trace[634539150] transaction","detail":"{read_only:false; response_revision:671; number_of_response:1; }","duration":"421.384729ms","start":"2026-03-20T00:45:45.897900Z","end":"2026-03-20T00:45:46.319284Z","steps":["trace[634539150] 'process raft request' (duration: 421.248683ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:46.320082Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:45.897883Z","time spent":"422.13131ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4234,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:46.320253Z","caller":"traceutil/trace.go:172","msg":"trace[1902311030] transaction","detail":"{read_only:false; response_revision:672; number_of_response:1; }","duration":"421.724003ms","start":"2026-03-20T00:45:45.898512Z","end":"2026-03-20T00:45:46.320236Z","steps":["trace[1902311030] 'process raft request' (duration: 420.747453ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:46.320381Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:45.898501Z","time spent":"421.818446ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3353,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:46.320400Z","caller":"traceutil/trace.go:172","msg":"trace[2065106623] transaction","detail":"{read_only:false; response_revision:673; number_of_response:1; }","duration":"420.485862ms","start":"2026-03-20T00:45:45.899897Z","end":"2026-03-20T00:45:46.320383Z","steps":["trace[2065106623] 'process raft request' (duration: 419.964009ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:46.320479Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:45.899886Z","time spent":"420.559155ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":4580,"response count":0,"response size":40,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-03-20T00:45:46.322382Z","caller":"traceutil/trace.go:172","msg":"trace[1397710449] transaction","detail":"{read_only:false; response_revision:674; number_of_response:1; }","duration":"258.393173ms","start":"2026-03-20T00:45:46.063967Z","end":"2026-03-20T00:45:46.322360Z","steps":["trace[1397710449] 'process raft request' (duration: 258.183934ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:46.322426Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"111.212109ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:46.322513Z","caller":"traceutil/trace.go:172","msg":"trace[724596376] range","detail":"{range_begin:/registry/pods; range_end:; response_count:0; response_revision:674; }","duration":"111.318903ms","start":"2026-03-20T00:45:46.211175Z","end":"2026-03-20T00:45:46.322494Z","steps":["trace[724596376] 'agreement among raft nodes before linearized reading' (duration: 111.168687ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:46.919449Z","caller":"traceutil/trace.go:172","msg":"trace[1799698937] transaction","detail":"{read_only:false; response_revision:689; number_of_response:1; }","duration":"225.914181ms","start":"2026-03-20T00:45:46.693515Z","end":"2026-03-20T00:45:46.919429Z","steps":["trace[1799698937] 'process raft request' (duration: 225.774985ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:47.079823Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"188.539582ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumclusterwidenetworkpolicies.cilium.io\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:47.079896Z","caller":"traceutil/trace.go:172","msg":"trace[1846417862] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumclusterwidenetworkpolicies.cilium.io; range_end:; response_count:0; response_revision:689; }","duration":"188.615905ms","start":"2026-03-20T00:45:46.891263Z","end":"2026-03-20T00:45:47.079879Z","steps":["trace[1846417862] 'agreement among raft nodes before linearized reading' (duration: 76.987927ms)","trace[1846417862] 'range keys from in-memory index tree' (duration: 111.521284ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:47.079930Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"111.554655ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"warn","ts":"2026-03-20T00:45:47.079823Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"103.998404ms","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-03-20T00:45:47.080003Z","caller":"traceutil/trace.go:172","msg":"trace[513289029] transaction","detail":"{read_only:false; response_revision:690; number_of_response:1; }","duration":"296.067759ms","start":"2026-03-20T00:45:46.783925Z","end":"2026-03-20T00:45:47.079992Z","steps":["trace[513289029] 'process raft request' (duration: 184.397499ms)","trace[513289029] 'compare' (duration: 111.486722ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:47.080025Z","caller":"traceutil/trace.go:172","msg":"trace[1252407451] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:689; }","duration":"104.253304ms","start":"2026-03-20T00:45:46.975755Z","end":"2026-03-20T00:45:47.080008Z","steps":["trace[1252407451] 'range keys from in-memory index tree' (duration: 103.918131ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:47.227951Z","caller":"traceutil/trace.go:172","msg":"trace[644848065] linearizableReadLoop","detail":"{readStateIndex:719; appliedIndex:719; }","duration":"259.698826ms","start":"2026-03-20T00:45:46.968215Z","end":"2026-03-20T00:45:47.227913Z","steps":["trace[644848065] 'read index received' (duration: 259.664745ms)","trace[644848065] 'applied index is now lower than readState.Index' (duration: 23.531µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:47.288352Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"353.235718ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-03-20T00:45:47.288439Z","caller":"traceutil/trace.go:172","msg":"trace[1423678001] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:690; }","duration":"353.326721ms","start":"2026-03-20T00:45:46.935089Z","end":"2026-03-20T00:45:47.288415Z","steps":["trace[1423678001] 'agreement among raft nodes before linearized reading' (duration: 292.936999ms)","trace[1423678001] 'range keys from in-memory index tree' (duration: 60.192694ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:47.288479Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:46.935067Z","time spent":"353.403594ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":1,"response size":464,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:45:47.288594Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"353.364242ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-20T00:45:47.288660Z","caller":"traceutil/trace.go:172","msg":"trace[872596746] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:690; }","duration":"353.471226ms","start":"2026-03-20T00:45:46.935174Z","end":"2026-03-20T00:45:47.288646Z","steps":["trace[872596746] 'agreement among raft nodes before linearized reading' (duration: 292.7634ms)","trace[872596746] 'range keys from in-memory index tree' (duration: 60.440986ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:47.288700Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:46.935152Z","time spent":"353.540489ms","remote":"127.0.0.1:39384","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-cp-lock\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:45:47.288710Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"197.40572ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-20T00:45:47.288784Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"212.956084ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-fgts7\" limit:1 ","response":"range_response_count:1 size:19895"} {"level":"info","ts":"2026-03-20T00:45:47.288796Z","caller":"traceutil/trace.go:172","msg":"trace[1452825939] range","detail":"{range_begin:/registry/apiextensions.k8s.io/customresourcedefinitions/ciliumnetworkpolicies.cilium.io; range_end:; response_count:0; response_revision:691; }","duration":"197.490613ms","start":"2026-03-20T00:45:47.091269Z","end":"2026-03-20T00:45:47.288760Z","steps":["trace[1452825939] 'agreement among raft nodes before linearized reading' (duration: 197.346917ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:47.288810Z","caller":"traceutil/trace.go:172","msg":"trace[604809170] range","detail":"{range_begin:/registry/pods/kube-system/cilium-fgts7; range_end:; response_count:1; response_revision:691; }","duration":"212.996796ms","start":"2026-03-20T00:45:47.075807Z","end":"2026-03-20T00:45:47.288803Z","steps":["trace[604809170] 'agreement among raft nodes before linearized reading' (duration: 212.902122ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:47.288752Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"208.602336ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:47.288953Z","caller":"traceutil/trace.go:172","msg":"trace[2035427219] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:691; }","duration":"208.875807ms","start":"2026-03-20T00:45:47.080061Z","end":"2026-03-20T00:45:47.288936Z","steps":["trace[2035427219] 'agreement among raft nodes before linearized reading' (duration: 208.573165ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:47.289018Z","caller":"traceutil/trace.go:172","msg":"trace[2012551435] transaction","detail":"{read_only:false; response_revision:691; number_of_response:1; }","duration":"362.389134ms","start":"2026-03-20T00:45:46.926620Z","end":"2026-03-20T00:45:47.289009Z","steps":["trace[2012551435] 'process raft request' (duration: 301.315303ms)","trace[2012551435] 'compare' (duration: 60.466637ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:47.289075Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:46.926602Z","time spent":"362.431026ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9296,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:47.442693Z","caller":"traceutil/trace.go:172","msg":"trace[1705924303] linearizableReadLoop","detail":"{readStateIndex:720; appliedIndex:720; }","duration":"107.213762ms","start":"2026-03-20T00:45:47.335454Z","end":"2026-03-20T00:45:47.442668Z","steps":["trace[1705924303] 'read index received' (duration: 107.205121ms)","trace[1705924303] 'applied index is now lower than readState.Index' (duration: 6.741µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:47.442858Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"107.384779ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/runtimeclasses\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:47.442894Z","caller":"traceutil/trace.go:172","msg":"trace[540980023] range","detail":"{range_begin:/registry/runtimeclasses; range_end:; response_count:0; response_revision:691; }","duration":"107.434271ms","start":"2026-03-20T00:45:47.335448Z","end":"2026-03-20T00:45:47.442882Z","steps":["trace[540980023] 'agreement among raft nodes before linearized reading' (duration: 107.340208ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:47.442952Z","caller":"traceutil/trace.go:172","msg":"trace[1034768383] transaction","detail":"{read_only:false; response_revision:692; number_of_response:1; }","duration":"150.473125ms","start":"2026-03-20T00:45:47.292460Z","end":"2026-03-20T00:45:47.442933Z","steps":["trace[1034768383] 'process raft request' (duration: 150.367291ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:47.684176Z","caller":"traceutil/trace.go:172","msg":"trace[1059129195] linearizableReadLoop","detail":"{readStateIndex:721; appliedIndex:721; }","duration":"222.41358ms","start":"2026-03-20T00:45:47.461729Z","end":"2026-03-20T00:45:47.684143Z","steps":["trace[1059129195] 'read index received' (duration: 222.376519ms)","trace[1059129195] 'applied index is now lower than readState.Index' (duration: 34.711µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:47.684444Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"222.676451ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/162.253.55.52\" limit:1 ","response":"range_response_count:1 size:133"} {"level":"info","ts":"2026-03-20T00:45:47.684516Z","caller":"traceutil/trace.go:172","msg":"trace[322132375] range","detail":"{range_begin:/registry/masterleases/162.253.55.52; range_end:; response_count:1; response_revision:692; }","duration":"222.776025ms","start":"2026-03-20T00:45:47.461725Z","end":"2026-03-20T00:45:47.684501Z","steps":["trace[322132375] 'agreement among raft nodes before linearized reading' (duration: 222.538225ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:47.684537Z","caller":"traceutil/trace.go:172","msg":"trace[1271264889] transaction","detail":"{read_only:false; response_revision:693; number_of_response:1; }","duration":"391.210853ms","start":"2026-03-20T00:45:47.293302Z","end":"2026-03-20T00:45:47.684513Z","steps":["trace[1271264889] 'process raft request' (duration: 390.936692ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:47.684734Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:47.293285Z","time spent":"391.348289ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":425,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:47.684959Z","caller":"traceutil/trace.go:172","msg":"trace[1198762685] transaction","detail":"{read_only:false; response_revision:694; number_of_response:1; }","duration":"391.287498ms","start":"2026-03-20T00:45:47.293656Z","end":"2026-03-20T00:45:47.684944Z","steps":["trace[1198762685] 'process raft request' (duration: 390.793497ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:47.685026Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:47.293631Z","time spent":"391.364961ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":421,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:47.685276Z","caller":"traceutil/trace.go:172","msg":"trace[2050249836] transaction","detail":"{read_only:false; response_revision:696; number_of_response:1; }","duration":"381.177394ms","start":"2026-03-20T00:45:47.304082Z","end":"2026-03-20T00:45:47.685260Z","steps":["trace[2050249836] 'process raft request' (duration: 380.875262ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:47.685313Z","caller":"traceutil/trace.go:172","msg":"trace[1252314778] transaction","detail":"{read_only:false; response_revision:695; number_of_response:1; }","duration":"389.927121ms","start":"2026-03-20T00:45:47.295330Z","end":"2026-03-20T00:45:47.685257Z","steps":["trace[1252314778] 'process raft request' (duration: 389.547216ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:47.685380Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:47.304075Z","time spent":"381.245518ms","remote":"127.0.0.1:39242","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":20066,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:45:47.685530Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:47.295322Z","time spent":"390.082798ms","remote":"127.0.0.1:33484","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":9305,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:45:47.694836Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"134.689573ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/networkpolicies\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:47.694890Z","caller":"traceutil/trace.go:172","msg":"trace[430767360] range","detail":"{range_begin:/registry/networkpolicies; range_end:; response_count:0; response_revision:696; }","duration":"134.754985ms","start":"2026-03-20T00:45:47.560124Z","end":"2026-03-20T00:45:47.694879Z","steps":["trace[430767360] 'agreement among raft nodes before linearized reading' (duration: 134.63264ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:47.694956Z","caller":"traceutil/trace.go:172","msg":"trace[586080266] transaction","detail":"{read_only:false; response_revision:697; number_of_response:1; }","duration":"246.338436ms","start":"2026-03-20T00:45:47.448603Z","end":"2026-03-20T00:45:47.694942Z","steps":["trace[586080266] 'process raft request' (duration: 246.225141ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:47.695073Z","caller":"traceutil/trace.go:172","msg":"trace[140841945] transaction","detail":"{read_only:false; response_revision:698; number_of_response:1; }","duration":"201.190725ms","start":"2026-03-20T00:45:47.493857Z","end":"2026-03-20T00:45:47.695048Z","steps":["trace[140841945] 'process raft request' (duration: 201.0568ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:48.075233Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33312","server-name":"","error":"EOF"} {"level":"info","ts":"2026-03-20T00:45:48.714222Z","caller":"traceutil/trace.go:172","msg":"trace[1083775477] linearizableReadLoop","detail":"{readStateIndex:753; appliedIndex:753; }","duration":"138.526353ms","start":"2026-03-20T00:45:48.575664Z","end":"2026-03-20T00:45:48.714190Z","steps":["trace[1083775477] 'read index received' (duration: 138.515133ms)","trace[1083775477] 'applied index is now lower than readState.Index' (duration: 9.58µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:48.714566Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"138.879047ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-operator-75968c57df-dl969\" limit:1 ","response":"range_response_count:1 size:5388"} {"level":"info","ts":"2026-03-20T00:45:48.714619Z","caller":"traceutil/trace.go:172","msg":"trace[363622874] range","detail":"{range_begin:/registry/pods/kube-system/cilium-operator-75968c57df-dl969; range_end:; response_count:1; response_revision:723; }","duration":"138.95773ms","start":"2026-03-20T00:45:48.575650Z","end":"2026-03-20T00:45:48.714608Z","steps":["trace[363622874] 'agreement among raft nodes before linearized reading' (duration: 138.69674ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:48.714653Z","caller":"traceutil/trace.go:172","msg":"trace[115445862] transaction","detail":"{read_only:false; response_revision:724; number_of_response:1; }","duration":"148.931242ms","start":"2026-03-20T00:45:48.565703Z","end":"2026-03-20T00:45:48.714634Z","steps":["trace[115445862] 'process raft request' (duration: 148.537666ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:50.656720Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33330","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:50.671353Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33346","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:50.772533Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33352","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:50.798463Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33368","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:50.952011Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33396","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:50.966838Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:33406","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:45:53.981326Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"147.872944ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-fgts7\" limit:1 ","response":"range_response_count:1 size:20081"} {"level":"info","ts":"2026-03-20T00:45:53.981407Z","caller":"traceutil/trace.go:172","msg":"trace[491020331] range","detail":"{range_begin:/registry/pods/kube-system/cilium-fgts7; range_end:; response_count:1; response_revision:763; }","duration":"147.963958ms","start":"2026-03-20T00:45:53.833422Z","end":"2026-03-20T00:45:53.981386Z","steps":["trace[491020331] 'agreement among raft nodes before linearized reading' (duration: 16.799839ms)","trace[491020331] 'range keys from in-memory index tree' (duration: 130.92308ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:53.981404Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"131.048184ms","expected-duration":"100ms","prefix":"","request":"header: txn: success:> failure: >>","response":"size:16"} {"level":"info","ts":"2026-03-20T00:45:53.981603Z","caller":"traceutil/trace.go:172","msg":"trace[2115626834] transaction","detail":"{read_only:false; response_revision:764; number_of_response:1; }","duration":"263.782322ms","start":"2026-03-20T00:45:53.717803Z","end":"2026-03-20T00:45:53.981585Z","steps":["trace[2115626834] 'process raft request' (duration: 132.476408ms)","trace[2115626834] 'compare' (duration: 130.892739ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:54.239765Z","caller":"traceutil/trace.go:172","msg":"trace[1010872381] linearizableReadLoop","detail":"{readStateIndex:797; appliedIndex:797; }","duration":"234.212416ms","start":"2026-03-20T00:45:54.005525Z","end":"2026-03-20T00:45:54.239737Z","steps":["trace[1010872381] 'read index received' (duration: 234.205176ms)","trace[1010872381] 'applied index is now lower than readState.Index' (duration: 5.67µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:54.239951Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"234.404903ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/flowschemas\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:54.240031Z","caller":"traceutil/trace.go:172","msg":"trace[1997663639] range","detail":"{range_begin:/registry/flowschemas; range_end:; response_count:0; response_revision:764; }","duration":"234.494647ms","start":"2026-03-20T00:45:54.005519Z","end":"2026-03-20T00:45:54.240014Z","steps":["trace[1997663639] 'agreement among raft nodes before linearized reading' (duration: 234.356691ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:54.240394Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"112.618446ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" limit:1 ","response":"range_response_count:1 size:493"} {"level":"info","ts":"2026-03-20T00:45:54.240400Z","caller":"traceutil/trace.go:172","msg":"trace[550633872] transaction","detail":"{read_only:false; response_revision:765; number_of_response:1; }","duration":"241.619696ms","start":"2026-03-20T00:45:53.998746Z","end":"2026-03-20T00:45:54.240366Z","steps":["trace[550633872] 'process raft request' (duration: 241.19779ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:54.240456Z","caller":"traceutil/trace.go:172","msg":"trace[1913970518] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:765; }","duration":"112.679978ms","start":"2026-03-20T00:45:54.127760Z","end":"2026-03-20T00:45:54.240440Z","steps":["trace[1913970518] 'agreement among raft nodes before linearized reading' (duration: 112.530953ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:54.381386Z","caller":"traceutil/trace.go:172","msg":"trace[761034661] linearizableReadLoop","detail":"{readStateIndex:798; appliedIndex:798; }","duration":"134.922623ms","start":"2026-03-20T00:45:54.246435Z","end":"2026-03-20T00:45:54.381357Z","steps":["trace[761034661] 'read index received' (duration: 134.914032ms)","trace[761034661] 'applied index is now lower than readState.Index' (duration: 7.761µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:54.464344Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"217.902514ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-fgts7\" limit:1 ","response":"range_response_count:1 size:20081"} {"level":"info","ts":"2026-03-20T00:45:54.464409Z","caller":"traceutil/trace.go:172","msg":"trace[1543354578] range","detail":"{range_begin:/registry/pods/kube-system/cilium-fgts7; range_end:; response_count:1; response_revision:765; }","duration":"217.975857ms","start":"2026-03-20T00:45:54.246417Z","end":"2026-03-20T00:45:54.464393Z","steps":["trace[1543354578] 'agreement among raft nodes before linearized reading' (duration: 135.048658ms)","trace[1543354578] 'range keys from in-memory index tree' (duration: 82.800244ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:54.464459Z","caller":"traceutil/trace.go:172","msg":"trace[1386547378] transaction","detail":"{read_only:false; response_revision:766; number_of_response:1; }","duration":"219.847747ms","start":"2026-03-20T00:45:54.244586Z","end":"2026-03-20T00:45:54.464433Z","steps":["trace[1386547378] 'process raft request' (duration: 136.749432ms)","trace[1386547378] 'compare' (duration: 82.972ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:54.938716Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"250.696387ms","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-03-20T00:45:54.938829Z","caller":"traceutil/trace.go:172","msg":"trace[2063744797] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:766; }","duration":"250.827862ms","start":"2026-03-20T00:45:54.687985Z","end":"2026-03-20T00:45:54.938812Z","steps":["trace[2063744797] 'range keys from in-memory index tree' (duration: 250.638785ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:55.001722Z","caller":"traceutil/trace.go:172","msg":"trace[811118398] transaction","detail":"{read_only:false; response_revision:767; number_of_response:1; }","duration":"520.593693ms","start":"2026-03-20T00:45:54.481081Z","end":"2026-03-20T00:45:55.001674Z","steps":["trace[811118398] 'process raft request' (duration: 519.899428ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:55.001979Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:54.481056Z","time spent":"520.830892ms","remote":"127.0.0.1:39242","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":19878,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:55.252019Z","caller":"traceutil/trace.go:172","msg":"trace[1059078236] transaction","detail":"{read_only:false; response_revision:768; number_of_response:1; }","duration":"519.725456ms","start":"2026-03-20T00:45:54.732273Z","end":"2026-03-20T00:45:55.251998Z","steps":["trace[1059078236] 'process raft request' (duration: 519.56782ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:55.252180Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:54.732242Z","time spent":"519.865211ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":466,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:55.276622Z","caller":"traceutil/trace.go:172","msg":"trace[1039327643] transaction","detail":"{read_only:false; response_revision:771; number_of_response:1; }","duration":"167.645702ms","start":"2026-03-20T00:45:55.108955Z","end":"2026-03-20T00:45:55.276600Z","steps":["trace[1039327643] 'process raft request' (duration: 167.593241ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:55.276653Z","caller":"traceutil/trace.go:172","msg":"trace[2145209817] transaction","detail":"{read_only:false; response_revision:769; number_of_response:1; }","duration":"265.819592ms","start":"2026-03-20T00:45:55.010788Z","end":"2026-03-20T00:45:55.276608Z","steps":["trace[2145209817] 'process raft request' (duration: 265.591062ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:55.276705Z","caller":"traceutil/trace.go:172","msg":"trace[50352362] transaction","detail":"{read_only:false; response_revision:770; number_of_response:1; }","duration":"262.710086ms","start":"2026-03-20T00:45:55.013945Z","end":"2026-03-20T00:45:55.276655Z","steps":["trace[50352362] 'process raft request' (duration: 262.556111ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:55.461572Z","caller":"traceutil/trace.go:172","msg":"trace[509437422] transaction","detail":"{read_only:false; response_revision:772; number_of_response:1; }","duration":"175.898119ms","start":"2026-03-20T00:45:55.285650Z","end":"2026-03-20T00:45:55.461548Z","steps":["trace[509437422] 'process raft request' (duration: 159.198758ms)","trace[509437422] 'compare' (duration: 16.390969ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:55.545876Z","caller":"traceutil/trace.go:172","msg":"trace[1791411467] transaction","detail":"{read_only:false; response_revision:773; number_of_response:1; }","duration":"259.177306ms","start":"2026-03-20T00:45:55.286676Z","end":"2026-03-20T00:45:55.545853Z","steps":["trace[1791411467] 'process raft request' (duration: 258.912016ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:55.546113Z","caller":"traceutil/trace.go:172","msg":"trace[595365012] transaction","detail":"{read_only:false; response_revision:775; number_of_response:1; }","duration":"257.761283ms","start":"2026-03-20T00:45:55.288332Z","end":"2026-03-20T00:45:55.546094Z","steps":["trace[595365012] 'process raft request' (duration: 257.653819ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:55.546162Z","caller":"traceutil/trace.go:172","msg":"trace[1752676969] transaction","detail":"{read_only:false; response_revision:774; number_of_response:1; }","duration":"258.048153ms","start":"2026-03-20T00:45:55.288078Z","end":"2026-03-20T00:45:55.546126Z","steps":["trace[1752676969] 'process raft request' (duration: 257.68047ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:55.702751Z","caller":"traceutil/trace.go:172","msg":"trace[221759039] transaction","detail":"{read_only:false; response_revision:776; number_of_response:1; }","duration":"148.549022ms","start":"2026-03-20T00:45:55.554161Z","end":"2026-03-20T00:45:55.702710Z","steps":["trace[221759039] 'process raft request' (duration: 99.153996ms)","trace[221759039] 'compare' (duration: 48.538474ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:55.900368Z","caller":"traceutil/trace.go:172","msg":"trace[969469330] linearizableReadLoop","detail":"{readStateIndex:809; appliedIndex:809; }","duration":"176.166779ms","start":"2026-03-20T00:45:55.724129Z","end":"2026-03-20T00:45:55.900296Z","steps":["trace[969469330] 'read index received' (duration: 176.153419ms)","trace[969469330] 'applied index is now lower than readState.Index' (duration: 11.58µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:55.902393Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"178.249907ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/volumeattributesclasses\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:55.902457Z","caller":"traceutil/trace.go:172","msg":"trace[231261597] range","detail":"{range_begin:/registry/volumeattributesclasses; range_end:; response_count:0; response_revision:776; }","duration":"178.32649ms","start":"2026-03-20T00:45:55.724113Z","end":"2026-03-20T00:45:55.902440Z","steps":["trace[231261597] 'agreement among raft nodes before linearized reading' (duration: 176.277614ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:55.902861Z","caller":"traceutil/trace.go:172","msg":"trace[244869427] transaction","detail":"{read_only:false; response_revision:777; number_of_response:1; }","duration":"194.168598ms","start":"2026-03-20T00:45:55.708665Z","end":"2026-03-20T00:45:55.902833Z","steps":["trace[244869427] 'process raft request' (duration: 191.636533ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:55.903060Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"130.559163ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-20T00:45:55.903100Z","caller":"traceutil/trace.go:172","msg":"trace[2119628324] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:777; }","duration":"130.624045ms","start":"2026-03-20T00:45:55.772468Z","end":"2026-03-20T00:45:55.903092Z","steps":["trace[2119628324] 'agreement among raft nodes before linearized reading' (duration: 130.394447ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:56.537423Z","caller":"traceutil/trace.go:172","msg":"trace[865446215] transaction","detail":"{read_only:false; response_revision:782; number_of_response:1; }","duration":"102.555671ms","start":"2026-03-20T00:45:56.434845Z","end":"2026-03-20T00:45:56.537401Z","steps":["trace[865446215] 'process raft request' (duration: 102.416165ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:57.297908Z","caller":"traceutil/trace.go:172","msg":"trace[40244016] transaction","detail":"{read_only:false; response_revision:785; number_of_response:1; }","duration":"152.270114ms","start":"2026-03-20T00:45:57.145609Z","end":"2026-03-20T00:45:57.297879Z","steps":["trace[40244016] 'process raft request' (duration: 113.3764ms)","trace[40244016] 'compare' (duration: 38.697877ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:57.556211Z","caller":"traceutil/trace.go:172","msg":"trace[304775283] transaction","detail":"{read_only:false; response_revision:786; number_of_response:1; }","duration":"410.476167ms","start":"2026-03-20T00:45:57.145706Z","end":"2026-03-20T00:45:57.556182Z","steps":["trace[304775283] 'process raft request' (duration: 404.875883ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:57.556257Z","caller":"traceutil/trace.go:172","msg":"trace[952392468] transaction","detail":"{read_only:false; response_revision:788; number_of_response:1; }","duration":"298.504498ms","start":"2026-03-20T00:45:57.257730Z","end":"2026-03-20T00:45:57.556235Z","steps":["trace[952392468] 'process raft request' (duration: 298.447666ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:57.556311Z","caller":"traceutil/trace.go:172","msg":"trace[398588699] transaction","detail":"{read_only:false; response_revision:787; number_of_response:1; }","duration":"402.746966ms","start":"2026-03-20T00:45:57.153527Z","end":"2026-03-20T00:45:57.556274Z","steps":["trace[398588699] 'process raft request' (duration: 402.528468ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:57.556382Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:57.145620Z","time spent":"410.674475ms","remote":"127.0.0.1:39408","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1252,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:45:57.556501Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:57.153511Z","time spent":"402.886682ms","remote":"127.0.0.1:39242","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":5746,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:57.561302Z","caller":"traceutil/trace.go:172","msg":"trace[1082498231] transaction","detail":"{read_only:false; response_revision:789; number_of_response:1; }","duration":"279.143935ms","start":"2026-03-20T00:45:57.282126Z","end":"2026-03-20T00:45:57.561270Z","steps":["trace[1082498231] 'process raft request' (duration: 278.804653ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:58.142684Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"101.510539ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/csinodes\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:58.142715Z","caller":"traceutil/trace.go:172","msg":"trace[153513894] transaction","detail":"{read_only:false; response_revision:796; number_of_response:1; }","duration":"133.867741ms","start":"2026-03-20T00:45:58.008819Z","end":"2026-03-20T00:45:58.142687Z","steps":["trace[153513894] 'process raft request' (duration: 65.426181ms)","trace[153513894] 'compare' (duration: 68.285075ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:45:58.142859Z","caller":"traceutil/trace.go:172","msg":"trace[1154667822] range","detail":"{range_begin:/registry/csinodes; range_end:; response_count:0; response_revision:795; }","duration":"101.722016ms","start":"2026-03-20T00:45:58.041106Z","end":"2026-03-20T00:45:58.142828Z","steps":["trace[1154667822] 'agreement among raft nodes before linearized reading' (duration: 33.140501ms)","trace[1154667822] 'range keys from in-memory index tree' (duration: 68.306485ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:59.663715Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675749141,"retry-timeout":"500ms"} {"level":"info","ts":"2026-03-20T00:45:59.825539Z","caller":"traceutil/trace.go:172","msg":"trace[287773766] linearizableReadLoop","detail":"{readStateIndex:831; appliedIndex:831; }","duration":"662.16336ms","start":"2026-03-20T00:45:59.163349Z","end":"2026-03-20T00:45:59.825513Z","steps":["trace[287773766] 'read index received' (duration: 662.134779ms)","trace[287773766] 'applied index is now lower than readState.Index' (duration: 27.121µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:45:59.825685Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"662.319326ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/specs\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:45:59.825722Z","caller":"traceutil/trace.go:172","msg":"trace[117397208] range","detail":"{range_begin:/registry/services/specs; range_end:; response_count:0; response_revision:797; }","duration":"662.376218ms","start":"2026-03-20T00:45:59.163337Z","end":"2026-03-20T00:45:59.825713Z","steps":["trace[117397208] 'agreement among raft nodes before linearized reading' (duration: 662.275305ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:59.825868Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:59.163316Z","time spent":"662.43277ms","remote":"127.0.0.1:39264","response type":"/etcdserverpb.KV/Range","request count":0,"request size":28,"response count":0,"response size":29,"request content":"key:\"/registry/services/specs\" limit:1 "} {"level":"info","ts":"2026-03-20T00:45:59.825877Z","caller":"traceutil/trace.go:172","msg":"trace[440619648] transaction","detail":"{read_only:false; response_revision:798; number_of_response:1; }","duration":"708.725425ms","start":"2026-03-20T00:45:59.117107Z","end":"2026-03-20T00:45:59.825832Z","steps":["trace[440619648] 'process raft request' (duration: 708.451706ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:45:59.826015Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:45:59.117083Z","time spent":"708.85698ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":674,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:45:59.851580Z","caller":"traceutil/trace.go:172","msg":"trace[836732976] transaction","detail":"{read_only:false; response_revision:800; number_of_response:1; }","duration":"285.604379ms","start":"2026-03-20T00:45:59.565953Z","end":"2026-03-20T00:45:59.851558Z","steps":["trace[836732976] 'process raft request' (duration: 285.548267ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:45:59.851963Z","caller":"traceutil/trace.go:172","msg":"trace[627003418] transaction","detail":"{read_only:false; response_revision:799; number_of_response:1; }","duration":"286.244482ms","start":"2026-03-20T00:45:59.565688Z","end":"2026-03-20T00:45:59.851932Z","steps":["trace[627003418] 'process raft request' (duration: 285.689112ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:00.345083Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:40670","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:46:00.361628Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:40684","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:46:00.383513Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:40728","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:46:00.474434Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"118.221434ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/securitypolicies/\" range_end:\"/registry/gateway.envoyproxy.io/securitypolicies0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:00.474524Z","caller":"traceutil/trace.go:172","msg":"trace[999689083] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies/; range_end:/registry/gateway.envoyproxy.io/securitypolicies0; response_count:0; response_revision:802; }","duration":"118.340078ms","start":"2026-03-20T00:46:00.356164Z","end":"2026-03-20T00:46:00.474504Z","steps":["trace[999689083] 'range keys from in-memory index tree' (duration: 118.10762ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:00.474591Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"118.130691ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/securitypolicies\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:00.474674Z","caller":"traceutil/trace.go:172","msg":"trace[588955946] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/securitypolicies; range_end:; response_count:0; response_revision:802; }","duration":"118.223774ms","start":"2026-03-20T00:46:00.356430Z","end":"2026-03-20T00:46:00.474653Z","steps":["trace[588955946] 'range keys from in-memory index tree' (duration: 118.07475ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:00.474867Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"102.587954ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodeconfigs\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:00.474905Z","caller":"traceutil/trace.go:172","msg":"trace[917802907] range","detail":"{range_begin:/registry/cilium.io/ciliumnodeconfigs; range_end:; response_count:0; response_revision:802; }","duration":"102.624596ms","start":"2026-03-20T00:46:00.372270Z","end":"2026-03-20T00:46:00.474895Z","steps":["trace[917802907] 'range keys from in-memory index tree' (duration: 102.561013ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:00.474929Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"169.707274ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumloadbalancerippools\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:00.474953Z","caller":"traceutil/trace.go:172","msg":"trace[2056526350] range","detail":"{range_begin:/registry/cilium.io/ciliumloadbalancerippools; range_end:; response_count:0; response_revision:802; }","duration":"169.732995ms","start":"2026-03-20T00:46:00.305213Z","end":"2026-03-20T00:46:00.474946Z","steps":["trace[2056526350] 'range keys from in-memory index tree' (duration: 169.62713ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:00.475137Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"169.702043ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumcidrgroups\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:00.475167Z","caller":"traceutil/trace.go:172","msg":"trace[2134930357] range","detail":"{range_begin:/registry/cilium.io/ciliumcidrgroups; range_end:; response_count:0; response_revision:802; }","duration":"169.729544ms","start":"2026-03-20T00:46:00.305427Z","end":"2026-03-20T00:46:00.475157Z","steps":["trace[2134930357] 'range keys from in-memory index tree' (duration: 169.634361ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:00.475259Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"103.027211ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodeconfigs/\" range_end:\"/registry/cilium.io/ciliumnodeconfigs0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-20T00:46:00.475312Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"169.830178ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumnodes\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:00.475338Z","caller":"traceutil/trace.go:172","msg":"trace[861631630] range","detail":"{range_begin:/registry/cilium.io/ciliumnodes; range_end:; response_count:0; response_revision:802; }","duration":"169.852279ms","start":"2026-03-20T00:46:00.305475Z","end":"2026-03-20T00:46:00.475328Z","steps":["trace[861631630] 'range keys from in-memory index tree' (duration: 169.795567ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:46:00.475332Z","caller":"traceutil/trace.go:172","msg":"trace[1934274277] range","detail":"{range_begin:/registry/cilium.io/ciliumnodeconfigs/; range_end:/registry/cilium.io/ciliumnodeconfigs0; response_count:0; response_revision:802; }","duration":"103.108063ms","start":"2026-03-20T00:46:00.372209Z","end":"2026-03-20T00:46:00.475317Z","steps":["trace[1934274277] 'range keys from in-memory index tree' (duration: 102.919666ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:00.475477Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"169.938962ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumidentities\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:00.475503Z","caller":"traceutil/trace.go:172","msg":"trace[1955216164] range","detail":"{range_begin:/registry/cilium.io/ciliumidentities; range_end:; response_count:0; response_revision:802; }","duration":"169.964833ms","start":"2026-03-20T00:46:00.305531Z","end":"2026-03-20T00:46:00.475495Z","steps":["trace[1955216164] 'range keys from in-memory index tree' (duration: 169.88115ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:00.475637Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"169.981033ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cilium.io/ciliumclusterwidenetworkpolicies\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:00.475664Z","caller":"traceutil/trace.go:172","msg":"trace[1508483837] range","detail":"{range_begin:/registry/cilium.io/ciliumclusterwidenetworkpolicies; range_end:; response_count:0; response_revision:802; }","duration":"170.009334ms","start":"2026-03-20T00:46:00.305648Z","end":"2026-03-20T00:46:00.475657Z","steps":["trace[1508483837] 'range keys from in-memory index tree' (duration: 169.951912ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:00.511795Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:40742","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:46:00.526376Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:40758","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:46:00.538378Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:40778","server-name":"","error":"EOF"} {"level":"warn","ts":"2026-03-20T00:46:00.553632Z","caller":"embed/config_logging.go:188","msg":"rejected connection on client endpoint","remote-addr":"127.0.0.1:40800","server-name":"","error":"EOF"} {"level":"info","ts":"2026-03-20T00:46:02.092018Z","caller":"traceutil/trace.go:172","msg":"trace[137988359] linearizableReadLoop","detail":"{readStateIndex:838; appliedIndex:838; }","duration":"115.359324ms","start":"2026-03-20T00:46:01.976628Z","end":"2026-03-20T00:46:02.091988Z","steps":["trace[137988359] 'read index received' (duration: 115.350033ms)","trace[137988359] 'applied index is now lower than readState.Index' (duration: 7.991µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:46:02.092225Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"115.552341ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:02.092277Z","caller":"traceutil/trace.go:172","msg":"trace[1302939165] transaction","detail":"{read_only:false; response_revision:805; number_of_response:1; }","duration":"234.441102ms","start":"2026-03-20T00:46:01.857817Z","end":"2026-03-20T00:46:02.092258Z","steps":["trace[1302939165] 'process raft request' (duration: 234.262696ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:46:02.092307Z","caller":"traceutil/trace.go:172","msg":"trace[1173153567] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:804; }","duration":"115.668575ms","start":"2026-03-20T00:46:01.976618Z","end":"2026-03-20T00:46:02.092286Z","steps":["trace[1173153567] 'agreement among raft nodes before linearized reading' (duration: 115.491769ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:46:02.093687Z","caller":"traceutil/trace.go:172","msg":"trace[1059908523] transaction","detail":"{read_only:false; response_revision:806; number_of_response:1; }","duration":"235.294182ms","start":"2026-03-20T00:46:01.858376Z","end":"2026-03-20T00:46:02.093670Z","steps":["trace[1059908523] 'process raft request' (duration: 235.161608ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:46:02.281669Z","caller":"traceutil/trace.go:172","msg":"trace[1892900713] transaction","detail":"{read_only:false; response_revision:807; number_of_response:1; }","duration":"183.01695ms","start":"2026-03-20T00:46:02.098629Z","end":"2026-03-20T00:46:02.281646Z","steps":["trace[1892900713] 'process raft request' (duration: 181.367323ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:46:02.479976Z","caller":"traceutil/trace.go:172","msg":"trace[1893151606] transaction","detail":"{read_only:false; response_revision:808; number_of_response:1; }","duration":"193.378327ms","start":"2026-03-20T00:46:02.286574Z","end":"2026-03-20T00:46:02.479952Z","steps":["trace[1893151606] 'process raft request' (duration: 168.15858ms)","trace[1893151606] 'compare' (duration: 25.107263ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:46:03.073339Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"103.860442ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:29"} {"level":"info","ts":"2026-03-20T00:46:04.371051Z","caller":"traceutil/trace.go:172","msg":"trace[1694028410] transaction","detail":"{read_only:false; response_revision:811; number_of_response:1; }","duration":"270.91736ms","start":"2026-03-20T00:46:04.100098Z","end":"2026-03-20T00:46:04.371015Z","steps":["trace[1694028410] 'process raft request' (duration: 225.419961ms)","trace[1694028410] 'compare' (duration: 45.185509ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:46:06.864878Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"318.249401ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:440"} {"level":"info","ts":"2026-03-20T00:46:06.864979Z","caller":"traceutil/trace.go:172","msg":"trace[995560086] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:817; }","duration":"318.362505ms","start":"2026-03-20T00:46:06.546596Z","end":"2026-03-20T00:46:06.864958Z","steps":["trace[995560086] 'range keys from in-memory index tree' (duration: 317.230968ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:06.865031Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:06.546581Z","time spent":"318.436768ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":1,"response size":464,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 "} {"level":"info","ts":"2026-03-20T00:46:07.036622Z","caller":"traceutil/trace.go:172","msg":"trace[1856096134] linearizableReadLoop","detail":"{readStateIndex:852; appliedIndex:852; }","duration":"153.27247ms","start":"2026-03-20T00:46:06.883301Z","end":"2026-03-20T00:46:07.036573Z","steps":["trace[1856096134] 'read index received' (duration: 153.253249ms)","trace[1856096134] 'applied index is now lower than readState.Index' (duration: 16.05µs)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:46:07.036995Z","caller":"traceutil/trace.go:172","msg":"trace[2118211070] transaction","detail":"{read_only:false; response_revision:818; number_of_response:1; }","duration":"167.436007ms","start":"2026-03-20T00:46:06.869541Z","end":"2026-03-20T00:46:07.036977Z","steps":["trace[2118211070] 'process raft request' (duration: 167.195858ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:07.037076Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"153.750966ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:07.037189Z","caller":"traceutil/trace.go:172","msg":"trace[2037836870] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:817; }","duration":"153.87496ms","start":"2026-03-20T00:46:06.883283Z","end":"2026-03-20T00:46:07.037158Z","steps":["trace[2037836870] 'agreement among raft nodes before linearized reading' (duration: 153.419805ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:07.087847Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"111.640363ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:07.087917Z","caller":"traceutil/trace.go:172","msg":"trace[1551122412] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:818; }","duration":"111.717425ms","start":"2026-03-20T00:46:06.976185Z","end":"2026-03-20T00:46:07.087903Z","steps":["trace[1551122412] 'agreement among raft nodes before linearized reading' (duration: 105.984799ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:46:07.088163Z","caller":"traceutil/trace.go:172","msg":"trace[234084601] transaction","detail":"{read_only:false; response_revision:819; number_of_response:1; }","duration":"217.962561ms","start":"2026-03-20T00:46:06.870180Z","end":"2026-03-20T00:46:07.088143Z","steps":["trace[234084601] 'process raft request' (duration: 211.996777ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:08.658365Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675749263,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:46:09.158561Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675749263,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:46:09.659616Z","caller":"etcdserver/v3_server.go:911","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":16594529912675749263,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-03-20T00:46:09.993117Z","caller":"wal/wal.go:845","msg":"slow fdatasync","took":"1.855735423s","expected-duration":"1s"} {"level":"info","ts":"2026-03-20T00:46:09.993340Z","caller":"traceutil/trace.go:172","msg":"trace[1817229638] linearizableReadLoop","detail":"{readStateIndex:864; appliedIndex:864; }","duration":"1.835768659s","start":"2026-03-20T00:46:08.157538Z","end":"2026-03-20T00:46:09.993307Z","steps":["trace[1817229638] 'read index received' (duration: 1.835758819s)","trace[1817229638] 'applied index is now lower than readState.Index' (duration: 7.89µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:46:09.993647Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.836091269s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-24g22\" limit:1 ","response":"range_response_count:1 size:4466"} {"level":"info","ts":"2026-03-20T00:46:09.993700Z","caller":"traceutil/trace.go:172","msg":"trace[2028171291] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-24g22; range_end:; response_count:1; response_revision:828; }","duration":"1.836161411s","start":"2026-03-20T00:46:08.157525Z","end":"2026-03-20T00:46:09.993687Z","steps":["trace[2028171291] 'agreement among raft nodes before linearized reading' (duration: 1.835935544s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:09.993735Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:08.157505Z","time spent":"1.836221254s","remote":"127.0.0.1:39242","response type":"/etcdserverpb.KV/Range","request count":0,"request size":80,"response count":1,"response size":4490,"request content":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-24g22\" limit:1 "} {"level":"info","ts":"2026-03-20T00:46:09.993978Z","caller":"traceutil/trace.go:172","msg":"trace[226682012] transaction","detail":"{read_only:false; response_revision:829; number_of_response:1; }","duration":"1.856696484s","start":"2026-03-20T00:46:08.137264Z","end":"2026-03-20T00:46:09.993961Z","steps":["trace[226682012] 'process raft request' (duration: 1.85658466s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:09.994085Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:08.137235Z","time spent":"1.856792776s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":465,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"warn","ts":"2026-03-20T00:46:10.012367Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.128636936s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:10.012438Z","caller":"traceutil/trace.go:172","msg":"trace[1399863572] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:829; }","duration":"1.128713079s","start":"2026-03-20T00:46:08.883710Z","end":"2026-03-20T00:46:10.012423Z","steps":["trace[1399863572] 'agreement among raft nodes before linearized reading' (duration: 1.128598465s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:10.012479Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.470526556s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/validatingadmissionpolicybindings\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-20T00:46:10.012461Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"919.366229ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:440"} {"level":"warn","ts":"2026-03-20T00:46:10.012578Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"953.853037ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/prioritylevelconfigurations\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:10.012605Z","caller":"traceutil/trace.go:172","msg":"trace[1316204957] range","detail":"{range_begin:/registry/prioritylevelconfigurations; range_end:; response_count:0; response_revision:829; }","duration":"953.879448ms","start":"2026-03-20T00:46:09.058717Z","end":"2026-03-20T00:46:10.012597Z","steps":["trace[1316204957] 'agreement among raft nodes before linearized reading' (duration: 953.808106ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:46:10.012624Z","caller":"traceutil/trace.go:172","msg":"trace[956919917] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:829; }","duration":"919.477802ms","start":"2026-03-20T00:46:09.093057Z","end":"2026-03-20T00:46:10.012535Z","steps":["trace[956919917] 'agreement among raft nodes before linearized reading' (duration: 919.214584ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:46:10.012648Z","caller":"traceutil/trace.go:172","msg":"trace[1054326752] range","detail":"{range_begin:/registry/validatingadmissionpolicybindings; range_end:; response_count:0; response_revision:829; }","duration":"1.470682741s","start":"2026-03-20T00:46:08.541944Z","end":"2026-03-20T00:46:10.012627Z","steps":["trace[1054326752] 'agreement among raft nodes before linearized reading' (duration: 1.470515276s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:10.012675Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.036386955s","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 keys_only:true ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-20T00:46:10.012695Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:09.093025Z","time spent":"919.648408ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Range","request count":0,"request size":48,"response count":1,"response size":464,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 "} {"level":"info","ts":"2026-03-20T00:46:10.012733Z","caller":"traceutil/trace.go:172","msg":"trace[1963388297] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:829; }","duration":"1.036470888s","start":"2026-03-20T00:46:08.976249Z","end":"2026-03-20T00:46:10.012720Z","steps":["trace[1963388297] 'agreement among raft nodes before linearized reading' (duration: 1.036348414s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:10.012729Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:08.541930Z","time spent":"1.470779935s","remote":"127.0.0.1:39872","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":0,"response size":29,"request content":"key:\"/registry/validatingadmissionpolicybindings\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:46:10.012636Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:09.058709Z","time spent":"953.92034ms","remote":"127.0.0.1:39738","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":0,"response size":29,"request content":"key:\"/registry/prioritylevelconfigurations\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:46:10.012765Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.49453631s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/priorityclasses\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-03-20T00:46:10.012443Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.360072s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourceslices\" limit:1 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-03-20T00:46:10.012859Z","caller":"traceutil/trace.go:172","msg":"trace[1218813534] range","detail":"{range_begin:/registry/priorityclasses; range_end:; response_count:0; response_revision:829; }","duration":"1.494639123s","start":"2026-03-20T00:46:08.518206Z","end":"2026-03-20T00:46:10.012846Z","steps":["trace[1218813534] 'agreement among raft nodes before linearized reading' (duration: 1.494493618s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:10.012896Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:08.518178Z","time spent":"1.494708725s","remote":"127.0.0.1:39610","response type":"/etcdserverpb.KV/Range","request count":0,"request size":29,"response count":0,"response size":29,"request content":"key:\"/registry/priorityclasses\" limit:1 "} {"level":"info","ts":"2026-03-20T00:46:10.012895Z","caller":"traceutil/trace.go:172","msg":"trace[436756888] range","detail":"{range_begin:/registry/resourceslices; range_end:; response_count:0; response_revision:829; }","duration":"1.360507404s","start":"2026-03-20T00:46:08.652365Z","end":"2026-03-20T00:46:10.012872Z","steps":["trace[436756888] 'agreement among raft nodes before linearized reading' (duration: 1.36005629s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:10.012963Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:08.652341Z","time spent":"1.360602357s","remote":"127.0.0.1:39974","response type":"/etcdserverpb.KV/Range","request count":0,"request size":28,"response count":0,"response size":29,"request content":"key:\"/registry/resourceslices\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:46:10.012506Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:08.883688Z","time spent":"1.128778531s","remote":"127.0.0.1:33404","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":29,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-03-20T00:46:10.012393Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"1.556500526s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-20T00:46:10.013373Z","caller":"traceutil/trace.go:172","msg":"trace[2116609374] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:829; }","duration":"1.557469976s","start":"2026-03-20T00:46:08.455874Z","end":"2026-03-20T00:46:10.013344Z","steps":["trace[2116609374] 'agreement among raft nodes before linearized reading' (duration: 1.556389683s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:10.013707Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:08.455842Z","time spent":"1.557830108s","remote":"127.0.0.1:39384","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-cp-lock\" limit:1 "} {"level":"warn","ts":"2026-03-20T00:46:10.018535Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"976.645672ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" limit:1 ","response":"range_response_count:1 size:494"} {"level":"info","ts":"2026-03-20T00:46:10.018728Z","caller":"traceutil/trace.go:172","msg":"trace[168379253] transaction","detail":"{read_only:false; response_revision:830; number_of_response:1; }","duration":"1.63441036s","start":"2026-03-20T00:46:08.384302Z","end":"2026-03-20T00:46:10.018712Z","steps":["trace[168379253] 'process raft request' (duration: 1.629015699s)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:10.018902Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:08.384274Z","time spent":"1.634533514s","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":493,"response count":0,"response size":40,"request content":"compare: success:> failure: >"} {"level":"info","ts":"2026-03-20T00:46:10.019877Z","caller":"traceutil/trace.go:172","msg":"trace[186240469] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:829; }","duration":"976.705423ms","start":"2026-03-20T00:46:09.041873Z","end":"2026-03-20T00:46:10.018578Z","steps":["trace[186240469] 'agreement among raft nodes before linearized reading' (duration: 971.180499ms)"],"step_count":1} {"level":"warn","ts":"2026-03-20T00:46:10.020209Z","caller":"v3rpc/interceptor.go:202","msg":"request stats","start time":"2026-03-20T00:46:09.041845Z","time spent":"978.341415ms","remote":"127.0.0.1:39384","response type":"/etcdserverpb.KV/Range","request count":0,"request size":62,"response count":1,"response size":518,"request content":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" limit:1 "} {"level":"info","ts":"2026-03-20T00:46:12.071999Z","caller":"traceutil/trace.go:172","msg":"trace[592609418] transaction","detail":"{read_only:false; response_revision:839; number_of_response:1; }","duration":"177.797123ms","start":"2026-03-20T00:46:11.894182Z","end":"2026-03-20T00:46:12.071979Z","steps":["trace[592609418] 'process raft request' (duration: 177.636989ms)"],"step_count":1} {"level":"info","ts":"2026-03-20T00:46:12.178821Z","caller":"traceutil/trace.go:172","msg":"trace[754514678] linearizableReadLoop","detail":"{readStateIndex:875; appliedIndex:875; }","duration":"107.102206ms","start":"2026-03-20T00:46:12.071704Z","end":"2026-03-20T00:46:12.178806Z","steps":["trace[754514678] 'read index received' (duration: 107.095266ms)","trace[754514678] 'applied index is now lower than readState.Index' (duration: 5.89µs)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:46:12.232427Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"199.762666ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" limit:1 ","response":"range_response_count:1 size:493"} {"level":"info","ts":"2026-03-20T00:46:12.232521Z","caller":"traceutil/trace.go:172","msg":"trace[98745933] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:839; }","duration":"199.873669ms","start":"2026-03-20T00:46:12.032625Z","end":"2026-03-20T00:46:12.232498Z","steps":["trace[98745933] 'agreement among raft nodes before linearized reading' (duration: 146.184052ms)","trace[98745933] 'range keys from in-memory index tree' (duration: 53.45226ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:46:12.232877Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"202.419338ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" limit:1 ","response":"range_response_count:1 size:436"} {"level":"info","ts":"2026-03-20T00:46:12.232918Z","caller":"traceutil/trace.go:172","msg":"trace[1147574586] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:839; }","duration":"202.45866ms","start":"2026-03-20T00:46:12.030448Z","end":"2026-03-20T00:46:12.232907Z","steps":["trace[1147574586] 'agreement among raft nodes before linearized reading' (duration: 148.37387ms)","trace[1147574586] 'range keys from in-memory index tree' (duration: 53.980466ms)"],"step_count":2} {"level":"warn","ts":"2026-03-20T00:46:12.232976Z","caller":"txn/util.go:93","msg":"apply request took too long","took":"203.391748ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" limit:1 ","response":"range_response_count:1 size:439"} {"level":"info","ts":"2026-03-20T00:46:12.233032Z","caller":"traceutil/trace.go:172","msg":"trace[57976821] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:839; }","duration":"203.44935ms","start":"2026-03-20T00:46:12.029568Z","end":"2026-03-20T00:46:12.233017Z","steps":["trace[57976821] 'agreement among raft nodes before linearized reading' (duration: 149.287379ms)","trace[57976821] 'range keys from in-memory index tree' (duration: 54.042307ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:46:12.233347Z","caller":"traceutil/trace.go:172","msg":"trace[1135272754] transaction","detail":"{read_only:false; response_revision:840; number_of_response:1; }","duration":"234.076565ms","start":"2026-03-20T00:46:11.999246Z","end":"2026-03-20T00:46:12.233323Z","steps":["trace[1135272754] 'process raft request' (duration: 179.729498ms)","trace[1135272754] 'compare' (duration: 53.244044ms)"],"step_count":2} {"level":"info","ts":"2026-03-20T00:46:12.233380Z","caller":"traceutil/trace.go:172","msg":"trace[575456972] transaction","detail":"{read_only:false; response_revision:841; number_of_response:1; }","duration":"209.94899ms","start":"2026-03-20T00:46:12.023414Z","end":"2026-03-20T00:46:12.233363Z","steps":["trace[575456972] 'process raft request' (duration: 209.670521ms)"],"step_count":1}