2026-06-18T07:06:55.456Z|00001|vlog|INFO|opened log file /var/log/openvswitch/ovs-vswitchd.log 2026-06-18T07:06:55.464Z|00002|ovs_numa|INFO|Discovered 16 CPU cores on NUMA node 0 2026-06-18T07:06:55.464Z|00003|ovs_numa|INFO|Discovered 1 NUMA nodes and 16 CPU cores 2026-06-18T07:06:55.464Z|00004|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connecting... 2026-06-18T07:06:55.464Z|00005|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connected 2026-06-18T07:06:55.474Z|00006|bridge|INFO|ovs-vswitchd (Open vSwitch) 3.3.4 2026-06-18T07:07:00.931Z|00007|dpif_netlink|INFO|Datapath dispatch mode: per-cpu 2026-06-18T07:07:00.932Z|00008|ofproto_dpif|INFO|system@ovs-system: Datapath supports recirculation 2026-06-18T07:07:00.932Z|00009|ofproto_dpif|INFO|system@ovs-system: VLAN header stack length probed as 2 2026-06-18T07:07:00.932Z|00010|ofproto_dpif|INFO|system@ovs-system: MPLS label stack length probed as 3 2026-06-18T07:07:00.932Z|00011|ofproto_dpif|INFO|system@ovs-system: Datapath supports truncate action 2026-06-18T07:07:00.932Z|00012|ofproto_dpif|INFO|system@ovs-system: Datapath supports unique flow ids 2026-06-18T07:07:00.932Z|00013|ofproto_dpif|INFO|system@ovs-system: Datapath supports clone action 2026-06-18T07:07:00.933Z|00014|ofproto_dpif|INFO|system@ovs-system: Max sample nesting level probed as 10 2026-06-18T07:07:00.933Z|00015|ofproto_dpif|INFO|system@ovs-system: Datapath supports eventmask in conntrack action 2026-06-18T07:07:00.933Z|00016|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_clear action 2026-06-18T07:07:00.933Z|00017|ofproto_dpif|INFO|system@ovs-system: Max dp_hash algorithm probed to be 1 2026-06-18T07:07:00.933Z|00018|ofproto_dpif|INFO|system@ovs-system: Datapath supports check_pkt_len action 2026-06-18T07:07:00.933Z|00019|ofproto_dpif|INFO|system@ovs-system: Datapath supports timeout policy in conntrack action 2026-06-18T07:07:00.933Z|00020|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zero_snat 2026-06-18T07:07:00.933Z|00021|ofproto_dpif|INFO|system@ovs-system: Datapath supports add_mpls action 2026-06-18T07:07:00.933Z|00022|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state 2026-06-18T07:07:00.933Z|00023|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zone 2026-06-18T07:07:00.933Z|00024|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_mark 2026-06-18T07:07:00.933Z|00025|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_label 2026-06-18T07:07:00.933Z|00026|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state_nat 2026-06-18T07:07:00.933Z|00027|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple 2026-06-18T07:07:00.933Z|00028|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple6 2026-06-18T07:07:00.933Z|00029|ofproto_dpif|INFO|system@ovs-system: Datapath does not support IPv6 ND Extensions 2026-06-18T07:07:00.934Z|00030|ofproto_dpif_upcall|INFO|Overriding n-handler-threads to 16, setting n-revalidator-threads to 5 2026-06-18T07:07:00.934Z|00031|ofproto_dpif_upcall|INFO|Starting 21 threads 2026-06-18T07:07:01.082Z|00032|bridge|INFO|bridge br-int: added interface br-int on port 65534 2026-06-18T07:07:01.082Z|00033|bridge|INFO|bridge br-int: using datapath ID 0000927fa34a7a8a 2026-06-18T07:07:01.082Z|00034|connmgr|INFO|br-int: added service controller "punix:/var/run/openvswitch/br-int.mgmt" 2026-06-18T07:07:05.591Z|00035|memory|INFO|199152 kB peak resident set size after 10.1 seconds 2026-06-18T07:07:05.591Z|00036|memory|INFO|handlers:16 idl-cells-Open_vSwitch:101 ports:1 revalidators:5 rules:4 2026-06-18T07:18:53.440Z|00037|bridge|INFO|bridge br-int: deleted interface br-int on port 65534 2026-06-18T07:18:54.267Z|00001|vlog|INFO|opened log file /var/log/openvswitch/ovs-vswitchd.log 2026-06-18T07:18:54.276Z|00002|ovs_numa|INFO|Discovered 16 CPU cores on NUMA node 0 2026-06-18T07:18:54.276Z|00003|ovs_numa|INFO|Discovered 1 NUMA nodes and 16 CPU cores 2026-06-18T07:18:54.276Z|00004|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connecting... 2026-06-18T07:18:54.276Z|00005|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connected 2026-06-18T07:18:54.285Z|00006|ofproto_dpif|INFO|system@ovs-system: Datapath supports recirculation 2026-06-18T07:18:54.285Z|00007|ofproto_dpif|INFO|system@ovs-system: VLAN header stack length probed as 2 2026-06-18T07:18:54.285Z|00008|ofproto_dpif|INFO|system@ovs-system: MPLS label stack length probed as 3 2026-06-18T07:18:54.285Z|00009|ofproto_dpif|INFO|system@ovs-system: Datapath supports truncate action 2026-06-18T07:18:54.286Z|00010|ofproto_dpif|INFO|system@ovs-system: Datapath supports unique flow ids 2026-06-18T07:18:54.286Z|00011|ofproto_dpif|INFO|system@ovs-system: Datapath supports clone action 2026-06-18T07:18:54.286Z|00012|ofproto_dpif|INFO|system@ovs-system: Max sample nesting level probed as 10 2026-06-18T07:18:54.286Z|00013|ofproto_dpif|INFO|system@ovs-system: Datapath supports eventmask in conntrack action 2026-06-18T07:18:54.286Z|00014|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_clear action 2026-06-18T07:18:54.286Z|00015|ofproto_dpif|INFO|system@ovs-system: Max dp_hash algorithm probed to be 1 2026-06-18T07:18:54.286Z|00016|ofproto_dpif|INFO|system@ovs-system: Datapath supports check_pkt_len action 2026-06-18T07:18:54.286Z|00017|ofproto_dpif|INFO|system@ovs-system: Datapath supports timeout policy in conntrack action 2026-06-18T07:18:54.286Z|00018|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zero_snat 2026-06-18T07:18:54.286Z|00019|ofproto_dpif|INFO|system@ovs-system: Datapath supports add_mpls action 2026-06-18T07:18:54.286Z|00020|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state 2026-06-18T07:18:54.286Z|00021|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zone 2026-06-18T07:18:54.286Z|00022|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_mark 2026-06-18T07:18:54.286Z|00023|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_label 2026-06-18T07:18:54.286Z|00024|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state_nat 2026-06-18T07:18:54.286Z|00025|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple 2026-06-18T07:18:54.286Z|00026|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple6 2026-06-18T07:18:54.286Z|00027|ofproto_dpif|INFO|system@ovs-system: Datapath does not support IPv6 ND Extensions 2026-06-18T07:18:54.287Z|00028|ofproto_dpif_upcall|INFO|Overriding n-handler-threads to 16, setting n-revalidator-threads to 5 2026-06-18T07:18:54.287Z|00029|ofproto_dpif_upcall|INFO|Starting 21 threads 2026-06-18T07:18:54.408Z|00030|bridge|INFO|bridge br-int: added interface br-int on port 65534 2026-06-18T07:18:54.408Z|00031|bridge|INFO|bridge br-int: using datapath ID 0000927fa34a7a8a 2026-06-18T07:18:54.408Z|00032|connmgr|INFO|br-int: added service controller "punix:/var/run/openvswitch/br-int.mgmt" 2026-06-18T07:18:54.450Z|00033|bridge|INFO|ovs-vswitchd (Open vSwitch) 3.3.4 2026-06-18T07:18:54.715Z|00034|bridge|INFO|bridge br-int: deleted interface br-int on port 65534 2026-06-18T07:18:55.282Z|00001|vlog|INFO|opened log file /var/log/openvswitch/ovs-vswitchd.log 2026-06-18T07:18:55.291Z|00002|ovs_numa|INFO|Discovered 16 CPU cores on NUMA node 0 2026-06-18T07:18:55.291Z|00003|ovs_numa|INFO|Discovered 1 NUMA nodes and 16 CPU cores 2026-06-18T07:18:55.291Z|00004|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connecting... 2026-06-18T07:18:55.291Z|00005|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connected 2026-06-18T07:18:55.298Z|00006|ofproto_dpif|INFO|system@ovs-system: Datapath supports recirculation 2026-06-18T07:18:55.298Z|00007|ofproto_dpif|INFO|system@ovs-system: VLAN header stack length probed as 2 2026-06-18T07:18:55.298Z|00008|ofproto_dpif|INFO|system@ovs-system: MPLS label stack length probed as 3 2026-06-18T07:18:55.298Z|00009|ofproto_dpif|INFO|system@ovs-system: Datapath supports truncate action 2026-06-18T07:18:55.298Z|00010|ofproto_dpif|INFO|system@ovs-system: Datapath supports unique flow ids 2026-06-18T07:18:55.298Z|00011|ofproto_dpif|INFO|system@ovs-system: Datapath supports clone action 2026-06-18T07:18:55.299Z|00012|ofproto_dpif|INFO|system@ovs-system: Max sample nesting level probed as 10 2026-06-18T07:18:55.299Z|00013|ofproto_dpif|INFO|system@ovs-system: Datapath supports eventmask in conntrack action 2026-06-18T07:18:55.299Z|00014|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_clear action 2026-06-18T07:18:55.299Z|00015|ofproto_dpif|INFO|system@ovs-system: Max dp_hash algorithm probed to be 1 2026-06-18T07:18:55.299Z|00016|ofproto_dpif|INFO|system@ovs-system: Datapath supports check_pkt_len action 2026-06-18T07:18:55.299Z|00017|ofproto_dpif|INFO|system@ovs-system: Datapath supports timeout policy in conntrack action 2026-06-18T07:18:55.299Z|00018|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zero_snat 2026-06-18T07:18:55.299Z|00019|ofproto_dpif|INFO|system@ovs-system: Datapath supports add_mpls action 2026-06-18T07:18:55.299Z|00020|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state 2026-06-18T07:18:55.299Z|00021|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zone 2026-06-18T07:18:55.299Z|00022|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_mark 2026-06-18T07:18:55.299Z|00023|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_label 2026-06-18T07:18:55.299Z|00024|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state_nat 2026-06-18T07:18:55.299Z|00025|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple 2026-06-18T07:18:55.299Z|00026|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple6 2026-06-18T07:18:55.299Z|00027|ofproto_dpif|INFO|system@ovs-system: Datapath does not support IPv6 ND Extensions 2026-06-18T07:18:55.299Z|00028|ofproto_dpif_upcall|INFO|Overriding n-handler-threads to 16, setting n-revalidator-threads to 5 2026-06-18T07:18:55.299Z|00029|ofproto_dpif_upcall|INFO|Starting 21 threads 2026-06-18T07:18:55.422Z|00030|bridge|INFO|bridge br-int: added interface br-int on port 65534 2026-06-18T07:18:55.423Z|00031|bridge|INFO|bridge br-int: using datapath ID 0000927fa34a7a8a 2026-06-18T07:18:55.423Z|00032|connmgr|INFO|br-int: added service controller "punix:/var/run/openvswitch/br-int.mgmt" 2026-06-18T07:18:55.423Z|00033|bridge|INFO|ovs-vswitchd (Open vSwitch) 3.3.4 2026-06-18T07:18:55.951Z|00034|bridge|INFO|bridge br-ex: added interface br-ex on port 65534 2026-06-18T07:18:55.952Z|00035|bridge|INFO|bridge br-ex: using datapath ID 00003eca18d24948 2026-06-18T07:18:55.952Z|00036|connmgr|INFO|br-ex: added service controller "punix:/var/run/openvswitch/br-ex.mgmt" 2026-06-18T07:19:05.438Z|00037|memory|INFO|199736 kB peak resident set size after 10.2 seconds 2026-06-18T07:19:05.438Z|00038|memory|INFO|handlers:16 idl-cells-Open_vSwitch:199 ofconns:4 ports:2 revalidators:5 rules:26 2026-06-18T07:19:05.638Z|00001|ofproto_dpif_upcall(revalidator18)|WARN|Spent an unreasonably long 2595ms dumping flows 2026-06-18T07:19:09.544Z|00039|connmgr|INFO|br-int<->unix#1: 18 flow_mods 10 s ago (17 adds, 1 deletes) 2026-06-18T07:19:38.772Z|00040|bridge|INFO|bridge br-int: added interface patch-br-int-to-provnet-43a981f1-a460-436d-84a6-dbe2de6c6bad on port 1 2026-06-18T07:19:38.772Z|00041|bridge|INFO|bridge br-ex: added interface patch-provnet-43a981f1-a460-436d-84a6-dbe2de6c6bad-to-br-int on port 1 2026-06-18T07:20:09.543Z|00042|connmgr|INFO|br-int<->unix#1: 554 flow_mods in the 5 s starting 30 s ago (539 adds, 8 deletes, 7 modifications) 2026-06-18T07:24:21.712Z|00043|bridge|INFO|bridge br-int: added interface tap6548b539-a2 on port 2 2026-06-18T07:24:24.292Z|00044|bridge|INFO|bridge br-int: added interface tap9743b869-b0 on port 3 2026-06-18T07:24:31.773Z|00045|connmgr|INFO|br-int<->unix#1: 159 flow_mods in the 2 s starting 10 s ago (157 adds, 2 deletes) 2026-06-18T07:25:31.773Z|00046|connmgr|INFO|br-int<->unix#1: 460 flow_mods in the 13 s starting 34 s ago (444 adds, 12 deletes, 4 modifications) 2026-06-18T07:26:21.768Z|00047|bridge|WARN|could not open network device tapca65a0bd-c4 (No such device) 2026-06-18T07:26:23.344Z|00048|bridge|INFO|bridge br-int: added interface tapca65a0bd-c4 on port 4 2026-06-18T07:26:23.863Z|00049|bridge|INFO|bridge br-int: added interface tapeca1864c-20 on port 5 2026-06-18T07:26:31.774Z|00050|connmgr|INFO|br-int<->unix#1: 214 flow_mods in the 58 s starting 59 s ago (200 adds, 10 deletes, 4 modifications) 2026-06-18T07:27:31.772Z|00051|connmgr|INFO|br-int<->unix#1: 12 flow_mods in the 3 s starting 35 s ago (8 adds, 4 deletes) 2026-06-18T07:28:50.204Z|00052|connmgr|INFO|br-int<->unix#1: 22 flow_mods in the 4 s starting 10 s ago (18 adds, 4 deletes) 2026-06-18T07:28:54.547Z|00053|bridge|WARN|could not open network device tap1ebcf604-a2 (No such device) 2026-06-18T07:28:56.356Z|00054|bridge|INFO|bridge br-int: added interface tap1ebcf604-a2 on port 6 2026-06-18T07:28:57.496Z|00055|bridge|WARN|could not open network device tap82396ab0-28 (No such device) 2026-06-18T07:28:59.080Z|00056|bridge|INFO|bridge br-int: added interface tap82396ab0-28 on port 7 2026-06-18T07:29:50.204Z|00057|connmgr|INFO|br-int<->unix#1: 1018 flow_mods in the 45 s starting 53 s ago (743 adds, 275 deletes) 2026-06-18T07:40:17.663Z|00001|timeval(revalidator21)|WARN|Unreasonably long 2328ms poll interval (0ms user, 0ms system) 2026-06-18T07:40:17.663Z|00002|timeval(revalidator21)|WARN|context switches: 1 voluntary, 0 involuntary 2026-06-18T07:40:17.664Z|00003|coverage(revalidator21)|INFO|Event coverage, avg rate over last: 5 seconds, last minute, last hour, hash=8d5a078f: 2026-06-18T07:40:17.664Z|00004|coverage(revalidator21)|INFO|nln_changed 0.0/sec 0.000/sec 0.0283/sec total: 102 2026-06-18T07:40:17.664Z|00005|coverage(revalidator21)|INFO|route_table_dump 0.0/sec 0.000/sec 0.0161/sec total: 58 2026-06-18T07:40:17.664Z|00006|coverage(revalidator21)|INFO|netlink_sent 21.6/sec 18.350/sec 6.7769/sec total: 24447 2026-06-18T07:40:17.664Z|00007|coverage(revalidator21)|INFO|netlink_recv_jumbo 2.8/sec 3.000/sec 1.0956/sec total: 3952 2026-06-18T07:40:17.664Z|00008|coverage(revalidator21)|INFO|netlink_received 21.0/sec 19.533/sec 7.5597/sec total: 27264 2026-06-18T07:40:17.664Z|00009|coverage(revalidator21)|INFO|netdev_set_ethtool 0.0/sec 0.000/sec 0.0014/sec total: 5 2026-06-18T07:40:17.664Z|00010|coverage(revalidator21)|INFO|netdev_get_ethtool 0.0/sec 0.000/sec 0.0078/sec total: 28 2026-06-18T07:40:17.664Z|00011|coverage(revalidator21)|INFO|netdev_set_hwaddr 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:40:17.664Z|00012|coverage(revalidator21)|INFO|netdev_set_policing 0.0/sec 0.000/sec 0.0081/sec total: 29 2026-06-18T07:40:17.664Z|00013|coverage(revalidator21)|INFO|vconn_sent 0.2/sec 0.183/sec 0.0958/sec total: 345 2026-06-18T07:40:17.664Z|00014|coverage(revalidator21)|INFO|vconn_received 0.4/sec 0.283/sec 0.8089/sec total: 2912 2026-06-18T07:40:17.664Z|00015|coverage(revalidator21)|INFO|util_xalloc 763.8/sec 715.050/sec 258.0464/sec total: 930520 2026-06-18T07:40:17.664Z|00016|coverage(revalidator21)|INFO|stream_open 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:40:17.664Z|00017|coverage(revalidator21)|INFO|pstream_open 0.0/sec 0.000/sec 0.0014/sec total: 5 2026-06-18T07:40:17.664Z|00018|coverage(revalidator21)|INFO|seq_change 1076.0/sec 1074.417/sec 384.0086/sec total: 1384139 2026-06-18T07:40:17.664Z|00019|coverage(revalidator21)|INFO|rconn_sent 0.2/sec 0.183/sec 0.0947/sec total: 341 2026-06-18T07:40:17.664Z|00020|coverage(revalidator21)|INFO|rconn_queued 0.2/sec 0.183/sec 0.0947/sec total: 341 2026-06-18T07:40:17.664Z|00021|coverage(revalidator21)|INFO|poll_zero_timeout 5.0/sec 3.367/sec 0.9053/sec total: 3265 2026-06-18T07:40:17.664Z|00022|coverage(revalidator21)|INFO|poll_create_node 206.6/sec 191.700/sec 68.2381/sec total: 245884 2026-06-18T07:40:17.664Z|00023|coverage(revalidator21)|INFO|txn_success 0.2/sec 0.200/sec 0.0569/sec total: 205 2026-06-18T07:40:17.664Z|00024|coverage(revalidator21)|INFO|txn_incomplete 0.2/sec 0.217/sec 0.0672/sec total: 243 2026-06-18T07:40:17.664Z|00025|coverage(revalidator21)|INFO|txn_unchanged 0.0/sec 0.000/sec 0.0497/sec total: 179 2026-06-18T07:40:17.664Z|00026|coverage(revalidator21)|INFO|netdev_get_stats 2.0/sec 2.000/sec 0.5519/sec total: 1997 2026-06-18T07:40:17.664Z|00027|coverage(revalidator21)|INFO|mac_learning_expired 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:40:17.664Z|00028|coverage(revalidator21)|INFO|mac_learning_learned 0.0/sec 0.000/sec 0.0008/sec total: 3 2026-06-18T07:40:17.664Z|00029|coverage(revalidator21)|INFO|hmap_expand 23.0/sec 20.400/sec 7.6858/sec total: 27699 2026-06-18T07:40:17.664Z|00030|coverage(revalidator21)|INFO|hmap_pathological 0.0/sec 0.000/sec 0.0033/sec total: 12 2026-06-18T07:40:17.664Z|00031|coverage(revalidator21)|INFO|hindex_expand 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-06-18T07:40:17.664Z|00032|coverage(revalidator21)|INFO|hindex_pathological 0.0/sec 0.000/sec 0.0011/sec total: 4 2026-06-18T07:40:17.664Z|00033|coverage(revalidator21)|INFO|miniflow_malloc 0.0/sec 0.300/sec 2.1244/sec total: 7648 2026-06-18T07:40:17.664Z|00034|coverage(revalidator21)|INFO|flow_extract 5.4/sec 3.200/sec 0.8225/sec total: 2976 2026-06-18T07:40:17.664Z|00035|coverage(revalidator21)|INFO|dpif_port_add 0.0/sec 0.000/sec 0.0019/sec total: 7 2026-06-18T07:40:17.664Z|00036|coverage(revalidator21)|INFO|dpif_flow_put_error 0.0/sec 0.067/sec 0.0744/sec total: 268 2026-06-18T07:40:17.664Z|00037|coverage(revalidator21)|INFO|dpif_flow_put 4.8/sec 3.050/sec 0.7450/sec total: 2690 2026-06-18T07:40:17.664Z|00038|coverage(revalidator21)|INFO|dpif_flow_get 0.0/sec 0.000/sec 0.0069/sec total: 25 2026-06-18T07:40:17.664Z|00039|coverage(revalidator21)|INFO|dpif_flow_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:40:17.664Z|00040|coverage(revalidator21)|INFO|dpif_flow_del 2.0/sec 2.883/sec 0.6456/sec total: 2328 2026-06-18T07:40:17.664Z|00041|coverage(revalidator21)|INFO|dpif_execute_with_help 0.2/sec 0.050/sec 0.0186/sec total: 68 2026-06-18T07:40:17.664Z|00042|coverage(revalidator21)|INFO|dpif_execute_error 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:40:17.664Z|00043|coverage(revalidator21)|INFO|dpif_execute 5.6/sec 3.317/sec 0.8525/sec total: 3085 2026-06-18T07:40:17.664Z|00044|coverage(revalidator21)|INFO|cmap_shrink 0.0/sec 0.000/sec 0.3194/sec total: 1150 2026-06-18T07:40:17.664Z|00045|coverage(revalidator21)|INFO|cmap_expand 0.0/sec 0.000/sec 0.4858/sec total: 1750 2026-06-18T07:40:17.664Z|00046|coverage(revalidator21)|INFO|ccmap_shrink 0.0/sec 0.000/sec 0.0378/sec total: 136 2026-06-18T07:40:17.664Z|00047|coverage(revalidator21)|INFO|ccmap_expand 0.0/sec 0.000/sec 0.0078/sec total: 28 2026-06-18T07:40:17.664Z|00048|coverage(revalidator21)|INFO|xlate_actions 8.2/sec 5.083/sec 1.4425/sec total: 5210 2026-06-18T07:40:17.664Z|00049|coverage(revalidator21)|INFO|upcall_ukey_replace 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:40:17.664Z|00050|coverage(revalidator21)|INFO|upcall_flow_limit_scaled 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:40:17.664Z|00051|coverage(revalidator21)|INFO|upcall_flow_limit_reduced 0.0/sec 0.000/sec 0.0008/sec total: 3 2026-06-18T07:40:17.664Z|00052|coverage(revalidator21)|INFO|upcall_flow_limit_grew 0.0/sec 0.000/sec 0.0608/sec total: 219 2026-06-18T07:40:17.664Z|00053|coverage(revalidator21)|INFO|revalidate_missed_dp_flow 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:40:17.664Z|00054|coverage(revalidator21)|INFO|handler_duplicate_upcall 0.2/sec 0.017/sec 0.0514/sec total: 192 2026-06-18T07:40:17.664Z|00055|coverage(revalidator21)|INFO|rev_mac_learning 0.0/sec 0.000/sec 0.0011/sec total: 4 2026-06-18T07:40:17.664Z|00056|coverage(revalidator21)|INFO|rev_flow_table 0.0/sec 0.000/sec 0.0103/sec total: 37 2026-06-18T07:40:17.664Z|00057|coverage(revalidator21)|INFO|rev_port_toggled 0.0/sec 0.000/sec 0.0017/sec total: 6 2026-06-18T07:40:17.664Z|00058|coverage(revalidator21)|INFO|rev_reconfigure 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-06-18T07:40:17.664Z|00059|coverage(revalidator21)|INFO|ofproto_update_port 0.0/sec 0.000/sec 0.0117/sec total: 42 2026-06-18T07:40:17.664Z|00060|coverage(revalidator21)|INFO|ofproto_recv_openflow 0.4/sec 0.283/sec 0.8078/sec total: 2908 2026-06-18T07:40:17.664Z|00061|coverage(revalidator21)|INFO|ofproto_packet_out 0.4/sec 0.200/sec 0.0492/sec total: 177 2026-06-18T07:40:17.664Z|00062|coverage(revalidator21)|INFO|ofproto_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:40:17.664Z|00063|coverage(revalidator21)|INFO|bridge_reconfigure 0.0/sec 0.000/sec 0.0175/sec total: 63 2026-06-18T07:40:17.664Z|00064|coverage(revalidator21)|INFO|111 events never hit 2026-06-18T07:40:17.668Z|00002|ofproto_dpif_upcall(revalidator18)|WARN|Spent an unreasonably long 3661ms dumping flows 2026-06-18T07:47:01.007Z|00003|ofproto_dpif_upcall(revalidator18)|WARN|Spent an unreasonably long 2228ms dumping flows 2026-06-18T07:47:04.577Z|00004|timeval(revalidator18)|WARN|Unreasonably long 1066ms poll interval (0ms user, 0ms system) 2026-06-18T07:47:04.579Z|00005|timeval(revalidator18)|WARN|context switches: 2 voluntary, 0 involuntary 2026-06-18T07:47:04.579Z|00001|timeval(revalidator19)|WARN|Unreasonably long 1066ms poll interval (0ms user, 0ms system) 2026-06-18T07:47:04.579Z|00002|timeval(revalidator19)|WARN|context switches: 2 voluntary, 0 involuntary 2026-06-18T07:47:04.579Z|00003|coverage(revalidator19)|INFO|Skipping details of duplicate event coverage for hash=e75411eb 2026-06-18T07:47:04.580Z|00006|coverage(revalidator18)|INFO|Event coverage, avg rate over last: 5 seconds, last minute, last hour, hash=e75411eb: 2026-06-18T07:47:04.580Z|00007|coverage(revalidator18)|INFO|nln_changed 0.0/sec 0.000/sec 0.0283/sec total: 102 2026-06-18T07:47:04.580Z|00008|coverage(revalidator18)|INFO|route_table_dump 0.0/sec 0.000/sec 0.0161/sec total: 58 2026-06-18T07:47:04.580Z|00009|coverage(revalidator18)|INFO|netlink_sent 24.2/sec 20.550/sec 8.8706/sec total: 32005 2026-06-18T07:47:04.580Z|00010|coverage(revalidator18)|INFO|netlink_recv_jumbo 4.0/sec 3.183/sec 1.4392/sec total: 5187 2026-06-18T07:47:04.580Z|00011|coverage(revalidator18)|INFO|netlink_received 26.6/sec 22.900/sec 9.8103/sec total: 35377 2026-06-18T07:47:04.580Z|00012|coverage(revalidator18)|INFO|netdev_set_ethtool 0.0/sec 0.000/sec 0.0014/sec total: 5 2026-06-18T07:47:04.580Z|00013|coverage(revalidator18)|INFO|netdev_get_ethtool 0.0/sec 0.000/sec 0.0078/sec total: 28 2026-06-18T07:47:04.580Z|00014|coverage(revalidator18)|INFO|netdev_set_hwaddr 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:47:04.580Z|00015|coverage(revalidator18)|INFO|netdev_set_policing 0.0/sec 0.000/sec 0.0081/sec total: 29 2026-06-18T07:47:04.580Z|00016|coverage(revalidator18)|INFO|vconn_sent 0.2/sec 0.200/sec 0.1175/sec total: 424 2026-06-18T07:47:04.580Z|00017|coverage(revalidator18)|INFO|vconn_received 0.0/sec 0.283/sec 0.8414/sec total: 3032 2026-06-18T07:47:04.580Z|00018|coverage(revalidator18)|INFO|util_xalloc 824.2/sec 749.850/sec 337.6422/sec total: 1217515 2026-06-18T07:47:04.580Z|00019|coverage(revalidator18)|INFO|long_poll_interval 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:47:04.580Z|00020|coverage(revalidator18)|INFO|stream_open 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:47:04.580Z|00021|coverage(revalidator18)|INFO|pstream_open 0.0/sec 0.000/sec 0.0014/sec total: 5 2026-06-18T07:47:04.580Z|00022|coverage(revalidator18)|INFO|seq_change 1054.4/sec 1073.500/sec 503.9572/sec total: 1817906 2026-06-18T07:47:04.580Z|00023|coverage(revalidator18)|INFO|rconn_sent 0.2/sec 0.200/sec 0.1164/sec total: 420 2026-06-18T07:47:04.580Z|00024|coverage(revalidator18)|INFO|rconn_queued 0.2/sec 0.200/sec 0.1164/sec total: 420 2026-06-18T07:47:04.580Z|00025|coverage(revalidator18)|INFO|poll_zero_timeout 3.8/sec 3.733/sec 1.2878/sec total: 4657 2026-06-18T07:47:04.580Z|00026|coverage(revalidator18)|INFO|poll_create_node 218.0/sec 213.933/sec 89.9061/sec total: 324404 2026-06-18T07:47:04.580Z|00027|coverage(revalidator18)|INFO|txn_success 0.2/sec 0.200/sec 0.0792/sec total: 286 2026-06-18T07:47:04.580Z|00028|coverage(revalidator18)|INFO|txn_incomplete 0.6/sec 0.233/sec 0.0903/sec total: 326 2026-06-18T07:47:04.580Z|00029|coverage(revalidator18)|INFO|txn_unchanged 0.0/sec 0.000/sec 0.0497/sec total: 179 2026-06-18T07:47:04.580Z|00030|coverage(revalidator18)|INFO|netdev_get_stats 4.0/sec 2.167/sec 0.7769/sec total: 2797 2026-06-18T07:47:04.580Z|00031|coverage(revalidator18)|INFO|mac_learning_expired 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:47:04.580Z|00032|coverage(revalidator18)|INFO|mac_learning_learned 0.0/sec 0.000/sec 0.0008/sec total: 3 2026-06-18T07:47:04.580Z|00033|coverage(revalidator18)|INFO|hmap_expand 26.4/sec 23.850/sec 10.0381/sec total: 36211 2026-06-18T07:47:04.580Z|00034|coverage(revalidator18)|INFO|hmap_pathological 0.0/sec 0.000/sec 0.0033/sec total: 12 2026-06-18T07:47:04.580Z|00035|coverage(revalidator18)|INFO|hindex_expand 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-06-18T07:47:04.580Z|00036|coverage(revalidator18)|INFO|hindex_pathological 0.0/sec 0.000/sec 0.0011/sec total: 4 2026-06-18T07:47:04.580Z|00037|coverage(revalidator18)|INFO|miniflow_malloc 0.0/sec 0.300/sec 2.1619/sec total: 7789 2026-06-18T07:47:04.580Z|00038|coverage(revalidator18)|INFO|flow_extract 3.6/sec 3.350/sec 1.1822/sec total: 4279 2026-06-18T07:47:04.580Z|00039|coverage(revalidator18)|INFO|dpif_port_add 0.0/sec 0.000/sec 0.0019/sec total: 7 2026-06-18T07:47:04.580Z|00040|coverage(revalidator18)|INFO|dpif_flow_put_error 0.0/sec 0.000/sec 0.0772/sec total: 278 2026-06-18T07:47:04.580Z|00041|coverage(revalidator18)|INFO|dpif_flow_put 3.6/sec 3.150/sec 1.0806/sec total: 3912 2026-06-18T07:47:04.580Z|00042|coverage(revalidator18)|INFO|dpif_flow_get 0.0/sec 0.000/sec 0.0069/sec total: 25 2026-06-18T07:47:04.580Z|00043|coverage(revalidator18)|INFO|dpif_flow_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:47:04.580Z|00044|coverage(revalidator18)|INFO|dpif_flow_del 3.2/sec 3.250/sec 0.9847/sec total: 3552 2026-06-18T07:47:04.580Z|00045|coverage(revalidator18)|INFO|dpif_execute_with_help 0.0/sec 0.033/sec 0.0236/sec total: 85 2026-06-18T07:47:04.580Z|00046|coverage(revalidator18)|INFO|dpif_execute_error 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:47:04.580Z|00047|coverage(revalidator18)|INFO|dpif_execute 3.6/sec 3.483/sec 1.2281/sec total: 4445 2026-06-18T07:47:04.580Z|00048|coverage(revalidator18)|INFO|cmap_shrink 0.0/sec 0.033/sec 0.3231/sec total: 1163 2026-06-18T07:47:04.580Z|00049|coverage(revalidator18)|INFO|cmap_expand 0.0/sec 0.033/sec 0.4889/sec total: 1760 2026-06-18T07:47:04.580Z|00050|coverage(revalidator18)|INFO|ccmap_shrink 0.0/sec 0.000/sec 0.0378/sec total: 136 2026-06-18T07:47:04.580Z|00051|coverage(revalidator18)|INFO|ccmap_expand 0.0/sec 0.000/sec 0.0078/sec total: 28 2026-06-18T07:47:04.580Z|00052|coverage(revalidator18)|INFO|xlate_actions 3.6/sec 5.250/sec 2.0128/sec total: 7278 2026-06-18T07:47:04.580Z|00053|coverage(revalidator18)|INFO|upcall_ukey_replace 0.0/sec 0.000/sec 0.0008/sec total: 3 2026-06-18T07:47:04.580Z|00054|coverage(revalidator18)|INFO|upcall_flow_limit_scaled 0.0/sec 0.000/sec 0.0006/sec total: 3 2026-06-18T07:47:04.580Z|00055|coverage(revalidator18)|INFO|upcall_flow_limit_reduced 0.0/sec 0.000/sec 0.0008/sec total: 3 2026-06-18T07:47:04.580Z|00056|coverage(revalidator18)|INFO|upcall_flow_limit_grew 0.0/sec 0.067/sec 0.0764/sec total: 277 2026-06-18T07:47:04.580Z|00057|coverage(revalidator18)|INFO|revalidate_missed_dp_flow 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:47:04.580Z|00058|coverage(revalidator18)|INFO|handler_duplicate_upcall 0.0/sec 0.100/sec 0.0650/sec total: 234 2026-06-18T07:47:04.580Z|00059|coverage(revalidator18)|INFO|rev_mac_learning 0.0/sec 0.000/sec 0.0011/sec total: 4 2026-06-18T07:47:04.582Z|00060|coverage(revalidator18)|INFO|rev_flow_table 0.0/sec 0.000/sec 0.0103/sec total: 37 2026-06-18T07:47:04.582Z|00061|coverage(revalidator18)|INFO|rev_port_toggled 0.0/sec 0.000/sec 0.0017/sec total: 6 2026-06-18T07:47:04.582Z|00062|coverage(revalidator18)|INFO|rev_reconfigure 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-06-18T07:47:04.582Z|00063|coverage(revalidator18)|INFO|ofproto_update_port 0.0/sec 0.000/sec 0.0117/sec total: 42 2026-06-18T07:47:04.582Z|00064|coverage(revalidator18)|INFO|ofproto_recv_openflow 0.0/sec 0.283/sec 0.8403/sec total: 3028 2026-06-18T07:47:04.582Z|00065|coverage(revalidator18)|INFO|ofproto_packet_out 0.0/sec 0.200/sec 0.0714/sec total: 259 2026-06-18T07:47:04.582Z|00066|coverage(revalidator18)|INFO|ofproto_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-06-18T07:47:04.582Z|00067|coverage(revalidator18)|INFO|bridge_reconfigure 0.0/sec 0.000/sec 0.0175/sec total: 63 2026-06-18T07:47:04.582Z|00068|coverage(revalidator18)|INFO|110 events never hit