2026-04-02T03:55:00.713Z|00001|vlog|INFO|opened log file /var/log/openvswitch/ovs-vswitchd.log 2026-04-02T03:55:00.724Z|00002|ovs_numa|INFO|Discovered 16 CPU cores on NUMA node 0 2026-04-02T03:55:00.724Z|00003|ovs_numa|INFO|Discovered 1 NUMA nodes and 16 CPU cores 2026-04-02T03:55:00.724Z|00004|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connecting... 2026-04-02T03:55:00.724Z|00005|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connected 2026-04-02T03:55:00.730Z|00006|bridge|INFO|ovs-vswitchd (Open vSwitch) 3.3.4 2026-04-02T03:55:06.670Z|00007|dpif_netlink|INFO|Datapath dispatch mode: per-cpu 2026-04-02T03:55:06.671Z|00008|ofproto_dpif|INFO|system@ovs-system: Datapath supports recirculation 2026-04-02T03:55:06.671Z|00009|ofproto_dpif|INFO|system@ovs-system: VLAN header stack length probed as 2 2026-04-02T03:55:06.672Z|00010|ofproto_dpif|INFO|system@ovs-system: MPLS label stack length probed as 3 2026-04-02T03:55:06.672Z|00011|ofproto_dpif|INFO|system@ovs-system: Datapath supports truncate action 2026-04-02T03:55:06.672Z|00012|ofproto_dpif|INFO|system@ovs-system: Datapath supports unique flow ids 2026-04-02T03:55:06.672Z|00013|ofproto_dpif|INFO|system@ovs-system: Datapath supports clone action 2026-04-02T03:55:06.672Z|00014|ofproto_dpif|INFO|system@ovs-system: Max sample nesting level probed as 10 2026-04-02T03:55:06.672Z|00015|ofproto_dpif|INFO|system@ovs-system: Datapath supports eventmask in conntrack action 2026-04-02T03:55:06.672Z|00016|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_clear action 2026-04-02T03:55:06.673Z|00017|ofproto_dpif|INFO|system@ovs-system: Max dp_hash algorithm probed to be 1 2026-04-02T03:55:06.673Z|00018|ofproto_dpif|INFO|system@ovs-system: Datapath supports check_pkt_len action 2026-04-02T03:55:06.673Z|00019|ofproto_dpif|INFO|system@ovs-system: Datapath supports timeout policy in conntrack action 2026-04-02T03:55:06.673Z|00020|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zero_snat 2026-04-02T03:55:06.673Z|00021|ofproto_dpif|INFO|system@ovs-system: Datapath supports add_mpls action 2026-04-02T03:55:06.673Z|00022|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state 2026-04-02T03:55:06.673Z|00023|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zone 2026-04-02T03:55:06.673Z|00024|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_mark 2026-04-02T03:55:06.673Z|00025|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_label 2026-04-02T03:55:06.673Z|00026|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state_nat 2026-04-02T03:55:06.673Z|00027|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple 2026-04-02T03:55:06.673Z|00028|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple6 2026-04-02T03:55:06.674Z|00029|ofproto_dpif|INFO|system@ovs-system: Datapath does not support IPv6 ND Extensions 2026-04-02T03:55:06.674Z|00030|ofproto_dpif_upcall|INFO|Overriding n-handler-threads to 16, setting n-revalidator-threads to 5 2026-04-02T03:55:06.674Z|00031|ofproto_dpif_upcall|INFO|Starting 21 threads 2026-04-02T03:55:06.799Z|00032|bridge|INFO|bridge br-int: added interface br-int on port 65534 2026-04-02T03:55:06.800Z|00033|bridge|INFO|bridge br-int: using datapath ID 00000ad63f1b7418 2026-04-02T03:55:06.800Z|00034|connmgr|INFO|br-int: added service controller "punix:/var/run/openvswitch/br-int.mgmt" 2026-04-02T03:55:10.807Z|00035|memory|INFO|199152 kB peak resident set size after 10.1 seconds 2026-04-02T03:55:10.807Z|00036|memory|INFO|handlers:16 idl-cells-Open_vSwitch:101 ports:1 revalidators:5 rules:4 2026-04-02T04:01:59.376Z|00001|timeval(revalidator22)|WARN|Unreasonably long 1875ms poll interval (0ms user, 0ms system) 2026-04-02T04:01:59.377Z|00002|timeval(revalidator22)|WARN|context switches: 2 voluntary, 0 involuntary 2026-04-02T04:01:59.377Z|00003|coverage(revalidator22)|INFO|Event coverage, avg rate over last: 5 seconds, last minute, last hour, hash=c735e072: 2026-04-02T04:01:59.377Z|00004|coverage(revalidator22)|INFO|nln_changed 0.0/sec 0.000/sec 0.0031/sec total: 11 2026-04-02T04:01:59.377Z|00005|coverage(revalidator22)|INFO|route_table_dump 0.0/sec 0.000/sec 0.0017/sec total: 6 2026-04-02T04:01:59.377Z|00006|coverage(revalidator22)|INFO|netlink_sent 4.8/sec 5.933/sec 0.8497/sec total: 3059 2026-04-02T04:01:59.377Z|00007|coverage(revalidator22)|INFO|netlink_recv_jumbo 0.0/sec 0.000/sec 0.0183/sec total: 66 2026-04-02T04:01:59.377Z|00008|coverage(revalidator22)|INFO|netlink_received 6.4/sec 7.850/sec 1.0739/sec total: 3866 2026-04-02T04:01:59.377Z|00009|coverage(revalidator22)|INFO|netdev_set_hwaddr 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:01:59.377Z|00010|coverage(revalidator22)|INFO|netdev_set_policing 0.0/sec 0.000/sec 0.0006/sec total: 2 2026-04-02T04:01:59.377Z|00011|coverage(revalidator22)|INFO|util_xalloc 218.8/sec 246.850/sec 33.7808/sec total: 121611 2026-04-02T04:01:59.377Z|00012|coverage(revalidator22)|INFO|stream_open 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:01:59.377Z|00013|coverage(revalidator22)|INFO|pstream_open 0.0/sec 0.000/sec 0.0008/sec total: 3 2026-04-02T04:01:59.377Z|00014|coverage(revalidator22)|INFO|seq_change 953.4/sec 1010.717/sec 120.0808/sec total: 432291 2026-04-02T04:01:59.377Z|00015|coverage(revalidator22)|INFO|poll_zero_timeout 0.4/sec 0.683/sec 0.0703/sec total: 253 2026-04-02T04:01:59.377Z|00016|coverage(revalidator22)|INFO|poll_create_node 116.6/sec 129.250/sec 15.6128/sec total: 56206 2026-04-02T04:01:59.377Z|00017|coverage(revalidator22)|INFO|txn_success 0.0/sec 0.000/sec 0.0011/sec total: 4 2026-04-02T04:01:59.377Z|00018|coverage(revalidator22)|INFO|txn_incomplete 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-04-02T04:01:59.377Z|00019|coverage(revalidator22)|INFO|txn_unchanged 0.0/sec 0.183/sec 0.0253/sec total: 91 2026-04-02T04:01:59.377Z|00020|coverage(revalidator22)|INFO|netdev_get_stats 0.0/sec 0.183/sec 0.0231/sec total: 83 2026-04-02T04:01:59.377Z|00021|coverage(revalidator22)|INFO|hmap_expand 10.8/sec 12.400/sec 1.6828/sec total: 6058 2026-04-02T04:01:59.377Z|00022|coverage(revalidator22)|INFO|hmap_pathological 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:01:59.377Z|00023|coverage(revalidator22)|INFO|miniflow_malloc 0.0/sec 0.000/sec 0.0450/sec total: 162 2026-04-02T04:01:59.377Z|00024|coverage(revalidator22)|INFO|flow_extract 0.0/sec 0.000/sec 0.0011/sec total: 4 2026-04-02T04:01:59.377Z|00025|coverage(revalidator22)|INFO|dpif_port_add 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:01:59.377Z|00026|coverage(revalidator22)|INFO|dpif_flow_put 0.0/sec 0.000/sec 0.0069/sec total: 25 2026-04-02T04:01:59.377Z|00027|coverage(revalidator22)|INFO|dpif_flow_get 0.0/sec 0.000/sec 0.0069/sec total: 25 2026-04-02T04:01:59.377Z|00028|coverage(revalidator22)|INFO|dpif_flow_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:01:59.377Z|00029|coverage(revalidator22)|INFO|dpif_flow_del 0.0/sec 0.000/sec 0.0069/sec total: 25 2026-04-02T04:01:59.378Z|00030|coverage(revalidator22)|INFO|dpif_execute_error 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:01:59.378Z|00031|coverage(revalidator22)|INFO|dpif_execute 0.0/sec 0.000/sec 0.0017/sec total: 6 2026-04-02T04:01:59.378Z|00032|coverage(revalidator22)|INFO|cmap_shrink 0.0/sec 0.000/sec 0.0111/sec total: 40 2026-04-02T04:01:59.378Z|00033|coverage(revalidator22)|INFO|cmap_expand 0.0/sec 0.000/sec 0.0156/sec total: 56 2026-04-02T04:01:59.378Z|00034|coverage(revalidator22)|INFO|rev_reconfigure 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:01:59.378Z|00035|coverage(revalidator22)|INFO|ofproto_update_port 0.0/sec 0.000/sec 0.0006/sec total: 2 2026-04-02T04:01:59.378Z|00036|coverage(revalidator22)|INFO|bridge_reconfigure 0.0/sec 0.000/sec 0.0017/sec total: 6 2026-04-02T04:01:59.378Z|00037|coverage(revalidator22)|INFO|138 events never hit 2026-04-02T04:05:22.916Z|00037|bridge|INFO|bridge br-int: deleted interface br-int on port 65534 2026-04-02T04:05:24.097Z|00001|vlog|INFO|opened log file /var/log/openvswitch/ovs-vswitchd.log 2026-04-02T04:05:24.107Z|00002|ovs_numa|INFO|Discovered 16 CPU cores on NUMA node 0 2026-04-02T04:05:24.107Z|00003|ovs_numa|INFO|Discovered 1 NUMA nodes and 16 CPU cores 2026-04-02T04:05:24.107Z|00004|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connecting... 2026-04-02T04:05:24.107Z|00005|fatal_signal|WARN|terminating with signal 15 (Terminated) 2026-04-02T04:05:24.214Z|00001|vlog|INFO|opened log file /var/log/openvswitch/ovs-vswitchd.log 2026-04-02T04:05:24.220Z|00002|ovs_numa|INFO|Discovered 16 CPU cores on NUMA node 0 2026-04-02T04:05:24.220Z|00003|ovs_numa|INFO|Discovered 1 NUMA nodes and 16 CPU cores 2026-04-02T04:05:24.220Z|00004|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connecting... 2026-04-02T04:05:24.220Z|00005|reconnect|INFO|unix:/var/run/openvswitch/db.sock: connected 2026-04-02T04:05:24.229Z|00006|ofproto_dpif|INFO|system@ovs-system: Datapath supports recirculation 2026-04-02T04:05:24.229Z|00007|ofproto_dpif|INFO|system@ovs-system: VLAN header stack length probed as 2 2026-04-02T04:05:24.229Z|00008|ofproto_dpif|INFO|system@ovs-system: MPLS label stack length probed as 3 2026-04-02T04:05:24.229Z|00009|ofproto_dpif|INFO|system@ovs-system: Datapath supports truncate action 2026-04-02T04:05:24.229Z|00010|ofproto_dpif|INFO|system@ovs-system: Datapath supports unique flow ids 2026-04-02T04:05:24.229Z|00011|ofproto_dpif|INFO|system@ovs-system: Datapath supports clone action 2026-04-02T04:05:24.229Z|00012|ofproto_dpif|INFO|system@ovs-system: Max sample nesting level probed as 10 2026-04-02T04:05:24.229Z|00013|ofproto_dpif|INFO|system@ovs-system: Datapath supports eventmask in conntrack action 2026-04-02T04:05:24.229Z|00014|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_clear action 2026-04-02T04:05:24.229Z|00015|ofproto_dpif|INFO|system@ovs-system: Max dp_hash algorithm probed to be 1 2026-04-02T04:05:24.229Z|00016|ofproto_dpif|INFO|system@ovs-system: Datapath supports check_pkt_len action 2026-04-02T04:05:24.230Z|00017|ofproto_dpif|INFO|system@ovs-system: Datapath supports timeout policy in conntrack action 2026-04-02T04:05:24.230Z|00018|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zero_snat 2026-04-02T04:05:24.230Z|00019|ofproto_dpif|INFO|system@ovs-system: Datapath supports add_mpls action 2026-04-02T04:05:24.230Z|00020|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state 2026-04-02T04:05:24.230Z|00021|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_zone 2026-04-02T04:05:24.230Z|00022|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_mark 2026-04-02T04:05:24.230Z|00023|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_label 2026-04-02T04:05:24.230Z|00024|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_state_nat 2026-04-02T04:05:24.230Z|00025|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple 2026-04-02T04:05:24.230Z|00026|ofproto_dpif|INFO|system@ovs-system: Datapath supports ct_orig_tuple6 2026-04-02T04:05:24.230Z|00027|ofproto_dpif|INFO|system@ovs-system: Datapath does not support IPv6 ND Extensions 2026-04-02T04:05:24.230Z|00028|ofproto_dpif_upcall|INFO|Overriding n-handler-threads to 16, setting n-revalidator-threads to 5 2026-04-02T04:05:24.230Z|00029|ofproto_dpif_upcall|INFO|Starting 21 threads 2026-04-02T04:05:24.350Z|00030|bridge|INFO|bridge br-int: added interface br-int on port 65534 2026-04-02T04:05:24.350Z|00031|bridge|INFO|bridge br-int: using datapath ID 00000ad63f1b7418 2026-04-02T04:05:24.350Z|00032|connmgr|INFO|br-int: added service controller "punix:/var/run/openvswitch/br-int.mgmt" 2026-04-02T04:05:24.351Z|00033|bridge|INFO|ovs-vswitchd (Open vSwitch) 3.3.4 2026-04-02T04:05:24.807Z|00034|bridge|INFO|bridge br-ex: added interface br-ex on port 65534 2026-04-02T04:05:24.807Z|00035|bridge|INFO|bridge br-ex: using datapath ID 0000b21b64f6f14e 2026-04-02T04:05:24.808Z|00036|connmgr|INFO|br-ex: added service controller "punix:/var/run/openvswitch/br-ex.mgmt" 2026-04-02T04:05:27.956Z|00037|connmgr|INFO|br-int<->unix#1: 18 flow_mods in the last 0 s (17 adds, 1 deletes) 2026-04-02T04:05:34.365Z|00038|memory|INFO|199792 kB peak resident set size after 10.2 seconds 2026-04-02T04:05:34.366Z|00039|memory|INFO|handlers:16 idl-cells-Open_vSwitch:199 ofconns:4 ports:2 revalidators:5 rules:26 2026-04-02T04:05:38.175Z|00040|connmgr|INFO|br-int<->unix#5: 18 flow_mods 10 s ago (17 adds, 1 deletes) 2026-04-02T04:06:05.015Z|00041|bridge|INFO|bridge br-int: added interface patch-br-int-to-provnet-129a1b25-7500-4e42-ac8a-b0c16d160709 on port 1 2026-04-02T04:06:05.015Z|00042|bridge|INFO|bridge br-ex: added interface patch-provnet-129a1b25-7500-4e42-ac8a-b0c16d160709-to-br-int on port 1 2026-04-02T04:06:38.175Z|00043|connmgr|INFO|br-int<->unix#5: 554 flow_mods in the 4 s starting 33 s ago (539 adds, 8 deletes, 7 modifications) 2026-04-02T04:09:53.815Z|00044|bridge|INFO|bridge br-int: added interface tap7e6fa8f7-fe on port 2 2026-04-02T04:09:55.970Z|00045|bridge|INFO|bridge br-int: added interface tap8edf2747-e0 on port 3 2026-04-02T04:10:03.878Z|00046|connmgr|INFO|br-int<->unix#5: 159 flow_mods in the 2 s starting 10 s ago (157 adds, 2 deletes) 2026-04-02T04:11:03.878Z|00047|connmgr|INFO|br-int<->unix#5: 479 flow_mods in the 16 s starting 38 s ago (454 adds, 21 deletes, 4 modifications) 2026-04-02T04:11:24.963Z|00048|bridge|WARN|could not open network device tap8f4a2b12-08 (No such device) 2026-04-02T04:11:26.536Z|00049|bridge|INFO|bridge br-int: added interface tap8f4a2b12-08 on port 4 2026-04-02T04:11:26.927Z|00050|bridge|INFO|bridge br-int: added interface tap1e6adc3f-10 on port 5 2026-04-02T04:12:03.878Z|00051|connmgr|INFO|br-int<->unix#5: 213 flow_mods in the 20 s starting 37 s ago (199 adds, 10 deletes, 4 modifications) 2026-04-02T04:13:03.878Z|00052|connmgr|INFO|br-int<->unix#5: 8 flow_mods 49 s ago (4 adds, 4 deletes) 2026-04-02T04:14:03.878Z|00053|connmgr|INFO|br-int<->unix#5: 22 flow_mods in the last 29 s (18 adds, 4 deletes) 2026-04-02T04:14:14.702Z|00054|bridge|WARN|could not open network device tap339f310c-c4 (No such device) 2026-04-02T04:14:16.269Z|00055|bridge|INFO|bridge br-int: added interface tap339f310c-c4 on port 6 2026-04-02T04:14:16.409Z|00056|bridge|WARN|could not open network device tap2dab2685-d3 (No such device) 2026-04-02T04:14:16.474Z|00057|bridge|WARN|could not open network device tap2dab2685-d3 (No such device) 2026-04-02T04:14:17.973Z|00058|bridge|INFO|bridge br-int: added interface tap2dab2685-d3 on port 7 2026-04-02T04:15:03.878Z|00059|connmgr|INFO|br-int<->unix#5: 1000 flow_mods in the 1 s starting 47 s ago (734 adds, 266 deletes) 2026-04-02T04:16:14.370Z|00060|connmgr|INFO|br-int<->unix#5: 18 flow_mods 10 s ago (9 adds, 9 deletes) 2026-04-02T04:22:04.585Z|00001|timeval(revalidator19)|WARN|Unreasonably long 3519ms poll interval (0ms user, 0ms system) 2026-04-02T04:22:04.585Z|00002|timeval(revalidator19)|WARN|context switches: 2 voluntary, 0 involuntary 2026-04-02T04:22:04.585Z|00003|coverage(revalidator19)|INFO|Event coverage, avg rate over last: 5 seconds, last minute, last hour, hash=8b56a251: 2026-04-02T04:22:04.585Z|00004|coverage(revalidator19)|INFO|nln_changed 0.0/sec 0.000/sec 0.0278/sec total: 100 2026-04-02T04:22:04.585Z|00005|coverage(revalidator19)|INFO|route_table_dump 0.0/sec 0.000/sec 0.0197/sec total: 71 2026-04-02T04:22:04.585Z|00006|coverage(revalidator19)|INFO|netlink_sent 14.6/sec 20.167/sec 5.8892/sec total: 21208 2026-04-02T04:22:04.585Z|00007|coverage(revalidator19)|INFO|netlink_recv_jumbo 3.0/sec 2.833/sec 0.9722/sec total: 3502 2026-04-02T04:22:04.585Z|00008|coverage(revalidator19)|INFO|netlink_received 17.2/sec 20.633/sec 6.5378/sec total: 23545 2026-04-02T04:22:04.585Z|00009|coverage(revalidator19)|INFO|netdev_set_ethtool 0.0/sec 0.000/sec 0.0014/sec total: 5 2026-04-02T04:22:04.585Z|00010|coverage(revalidator19)|INFO|netdev_get_ethtool 0.0/sec 0.000/sec 0.0081/sec total: 29 2026-04-02T04:22:04.585Z|00011|coverage(revalidator19)|INFO|netdev_set_hwaddr 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.585Z|00012|coverage(revalidator19)|INFO|netdev_set_policing 0.0/sec 0.000/sec 0.0083/sec total: 30 2026-04-02T04:22:04.585Z|00013|coverage(revalidator19)|INFO|vconn_sent 0.2/sec 0.183/sec 0.0958/sec total: 345 2026-04-02T04:22:04.585Z|00014|coverage(revalidator19)|INFO|vconn_received 0.4/sec 0.283/sec 0.8131/sec total: 2927 2026-04-02T04:22:04.585Z|00015|coverage(revalidator19)|INFO|util_xalloc 610.0/sec 725.900/sec 213.1583/sec total: 767647 2026-04-02T04:22:04.585Z|00016|coverage(revalidator19)|INFO|stream_open 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.585Z|00017|coverage(revalidator19)|INFO|pstream_open 0.0/sec 0.000/sec 0.0014/sec total: 5 2026-04-02T04:22:04.585Z|00018|coverage(revalidator19)|INFO|seq_change 1093.6/sec 1071.917/sec 301.9217/sec total: 1087985 2026-04-02T04:22:04.585Z|00019|coverage(revalidator19)|INFO|rconn_sent 0.2/sec 0.183/sec 0.0936/sec total: 337 2026-04-02T04:22:04.585Z|00020|coverage(revalidator19)|INFO|rconn_queued 0.2/sec 0.183/sec 0.0936/sec total: 337 2026-04-02T04:22:04.585Z|00021|coverage(revalidator19)|INFO|poll_zero_timeout 1.8/sec 4.183/sec 0.7494/sec total: 2701 2026-04-02T04:22:04.585Z|00022|coverage(revalidator19)|INFO|poll_create_node 199.0/sec 192.400/sec 54.3556/sec total: 195832 2026-04-02T04:22:04.585Z|00023|coverage(revalidator19)|INFO|txn_success 0.2/sec 0.200/sec 0.0436/sec total: 157 2026-04-02T04:22:04.585Z|00024|coverage(revalidator19)|INFO|txn_incomplete 0.2/sec 0.200/sec 0.0536/sec total: 193 2026-04-02T04:22:04.585Z|00025|coverage(revalidator19)|INFO|txn_unchanged 0.0/sec 0.000/sec 0.0469/sec total: 169 2026-04-02T04:22:04.585Z|00026|coverage(revalidator19)|INFO|netdev_get_stats 2.0/sec 2.000/sec 0.4200/sec total: 1512 2026-04-02T04:22:04.585Z|00027|coverage(revalidator19)|INFO|mac_learning_expired 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.585Z|00028|coverage(revalidator19)|INFO|mac_learning_learned 0.0/sec 0.000/sec 0.0008/sec total: 3 2026-04-02T04:22:04.585Z|00029|coverage(revalidator19)|INFO|hmap_expand 21.4/sec 20.383/sec 6.2617/sec total: 22554 2026-04-02T04:22:04.585Z|00030|coverage(revalidator19)|INFO|hmap_pathological 0.0/sec 0.000/sec 0.0033/sec total: 12 2026-04-02T04:22:04.585Z|00031|coverage(revalidator19)|INFO|hindex_expand 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-04-02T04:22:04.585Z|00032|coverage(revalidator19)|INFO|hindex_pathological 0.0/sec 0.000/sec 0.0017/sec total: 6 2026-04-02T04:22:04.585Z|00033|coverage(revalidator19)|INFO|miniflow_malloc 0.0/sec 0.300/sec 2.2578/sec total: 8128 2026-04-02T04:22:04.585Z|00034|coverage(revalidator19)|INFO|flow_extract 1.6/sec 3.967/sec 0.6889/sec total: 2480 2026-04-02T04:22:04.585Z|00035|coverage(revalidator19)|INFO|dpif_port_add 0.0/sec 0.000/sec 0.0019/sec total: 7 2026-04-02T04:22:04.585Z|00036|coverage(revalidator19)|INFO|dpif_flow_put_error 0.0/sec 0.083/sec 0.0906/sec total: 326 2026-04-02T04:22:04.585Z|00037|coverage(revalidator19)|INFO|dpif_flow_put 1.6/sec 3.867/sec 0.6119/sec total: 2203 2026-04-02T04:22:04.585Z|00038|coverage(revalidator19)|INFO|dpif_flow_get 0.0/sec 0.000/sec 0.0069/sec total: 25 2026-04-02T04:22:04.585Z|00039|coverage(revalidator19)|INFO|dpif_flow_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.585Z|00040|coverage(revalidator19)|INFO|dpif_flow_del 2.0/sec 3.017/sec 0.4978/sec total: 1793 2026-04-02T04:22:04.585Z|00041|coverage(revalidator19)|INFO|dpif_execute_with_help 0.2/sec 0.067/sec 0.0172/sec total: 62 2026-04-02T04:22:04.585Z|00042|coverage(revalidator19)|INFO|dpif_execute_error 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.585Z|00043|coverage(revalidator19)|INFO|dpif_execute 2.2/sec 4.117/sec 0.7061/sec total: 2542 2026-04-02T04:22:04.585Z|00044|coverage(revalidator19)|INFO|cmap_shrink 0.0/sec 0.033/sec 0.3408/sec total: 1227 2026-04-02T04:22:04.585Z|00045|coverage(revalidator19)|INFO|cmap_expand 0.0/sec 0.017/sec 0.5078/sec total: 1828 2026-04-02T04:22:04.585Z|00046|coverage(revalidator19)|INFO|ccmap_shrink 0.0/sec 0.000/sec 0.0378/sec total: 136 2026-04-02T04:22:04.585Z|00047|coverage(revalidator19)|INFO|ccmap_expand 0.0/sec 0.000/sec 0.0078/sec total: 28 2026-04-02T04:22:04.585Z|00048|coverage(revalidator19)|INFO|xlate_actions 3.8/sec 6.533/sec 1.2686/sec total: 4567 2026-04-02T04:22:04.585Z|00049|coverage(revalidator19)|INFO|upcall_ukey_replace 0.0/sec 0.000/sec 0.0006/sec total: 2 2026-04-02T04:22:04.585Z|00050|coverage(revalidator19)|INFO|upcall_flow_limit_grew 0.0/sec 0.000/sec 0.0383/sec total: 138 2026-04-02T04:22:04.585Z|00051|coverage(revalidator19)|INFO|handler_duplicate_upcall 0.0/sec 0.000/sec 0.0472/sec total: 170 2026-04-02T04:22:04.585Z|00052|coverage(revalidator19)|INFO|rev_mac_learning 0.0/sec 0.000/sec 0.0011/sec total: 4 2026-04-02T04:22:04.585Z|00053|coverage(revalidator19)|INFO|rev_flow_table 0.0/sec 0.000/sec 0.0106/sec total: 38 2026-04-02T04:22:04.585Z|00054|coverage(revalidator19)|INFO|rev_port_toggled 0.0/sec 0.000/sec 0.0017/sec total: 6 2026-04-02T04:22:04.585Z|00055|coverage(revalidator19)|INFO|rev_reconfigure 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-04-02T04:22:04.585Z|00056|coverage(revalidator19)|INFO|ofproto_update_port 0.0/sec 0.000/sec 0.0119/sec total: 43 2026-04-02T04:22:04.585Z|00057|coverage(revalidator19)|INFO|ofproto_recv_openflow 0.4/sec 0.283/sec 0.8108/sec total: 2919 2026-04-02T04:22:04.585Z|00058|coverage(revalidator19)|INFO|ofproto_packet_out 0.4/sec 0.200/sec 0.0458/sec total: 165 2026-04-02T04:22:04.585Z|00059|coverage(revalidator19)|INFO|ofproto_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.585Z|00060|coverage(revalidator19)|INFO|bridge_reconfigure 0.0/sec 0.000/sec 0.0181/sec total: 65 2026-04-02T04:22:04.585Z|00061|coverage(revalidator19)|INFO|114 events never hit 2026-04-02T04:22:04.586Z|00001|ofproto_dpif_upcall(revalidator18)|WARN|Spent an unreasonably long 3521ms dumping flows 2026-04-02T04:22:04.586Z|00002|timeval(revalidator18)|WARN|Unreasonably long 3521ms poll interval (0ms user, 1ms system) 2026-04-02T04:22:04.586Z|00003|timeval(revalidator18)|WARN|context switches: 1 voluntary, 0 involuntary 2026-04-02T04:22:04.586Z|00004|coverage(revalidator18)|INFO|Event coverage, avg rate over last: 5 seconds, last minute, last hour, hash=68c2b1f2: 2026-04-02T04:22:04.586Z|00005|coverage(revalidator18)|INFO|nln_changed 0.0/sec 0.000/sec 0.0278/sec total: 100 2026-04-02T04:22:04.586Z|00006|coverage(revalidator18)|INFO|route_table_dump 0.0/sec 0.000/sec 0.0197/sec total: 71 2026-04-02T04:22:04.586Z|00007|coverage(revalidator18)|INFO|netlink_sent 14.6/sec 20.167/sec 5.8892/sec total: 21226 2026-04-02T04:22:04.586Z|00008|coverage(revalidator18)|INFO|netlink_recv_jumbo 3.0/sec 2.833/sec 0.9722/sec total: 3508 2026-04-02T04:22:04.586Z|00009|coverage(revalidator18)|INFO|netlink_received 17.2/sec 20.633/sec 6.5378/sec total: 23564 2026-04-02T04:22:04.586Z|00010|coverage(revalidator18)|INFO|netdev_set_ethtool 0.0/sec 0.000/sec 0.0014/sec total: 5 2026-04-02T04:22:04.586Z|00011|coverage(revalidator18)|INFO|netdev_get_ethtool 0.0/sec 0.000/sec 0.0081/sec total: 29 2026-04-02T04:22:04.586Z|00012|coverage(revalidator18)|INFO|netdev_set_hwaddr 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.586Z|00013|coverage(revalidator18)|INFO|netdev_set_policing 0.0/sec 0.000/sec 0.0083/sec total: 30 2026-04-02T04:22:04.586Z|00014|coverage(revalidator18)|INFO|vconn_sent 0.2/sec 0.183/sec 0.0958/sec total: 349 2026-04-02T04:22:04.586Z|00015|coverage(revalidator18)|INFO|vconn_received 0.4/sec 0.283/sec 0.8131/sec total: 2930 2026-04-02T04:22:04.586Z|00016|coverage(revalidator18)|INFO|util_xalloc 610.0/sec 725.900/sec 213.1583/sec total: 768492 2026-04-02T04:22:04.586Z|00017|coverage(revalidator18)|INFO|stream_open 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.586Z|00018|coverage(revalidator18)|INFO|pstream_open 0.0/sec 0.000/sec 0.0014/sec total: 5 2026-04-02T04:22:04.586Z|00019|coverage(revalidator18)|INFO|seq_change 1093.6/sec 1071.917/sec 301.9217/sec total: 1088098 2026-04-02T04:22:04.586Z|00020|coverage(revalidator18)|INFO|rconn_sent 0.2/sec 0.183/sec 0.0936/sec total: 341 2026-04-02T04:22:04.586Z|00021|coverage(revalidator18)|INFO|rconn_queued 0.2/sec 0.183/sec 0.0936/sec total: 341 2026-04-02T04:22:04.586Z|00022|coverage(revalidator18)|INFO|poll_zero_timeout 1.8/sec 4.183/sec 0.7494/sec total: 2701 2026-04-02T04:22:04.586Z|00023|coverage(revalidator18)|INFO|poll_create_node 199.0/sec 192.400/sec 54.3556/sec total: 195884 2026-04-02T04:22:04.586Z|00024|coverage(revalidator18)|INFO|txn_success 0.2/sec 0.200/sec 0.0436/sec total: 157 2026-04-02T04:22:04.586Z|00025|coverage(revalidator18)|INFO|txn_incomplete 0.2/sec 0.200/sec 0.0536/sec total: 194 2026-04-02T04:22:04.586Z|00026|coverage(revalidator18)|INFO|txn_unchanged 0.0/sec 0.000/sec 0.0469/sec total: 169 2026-04-02T04:22:04.586Z|00027|coverage(revalidator18)|INFO|netdev_get_stats 2.0/sec 2.000/sec 0.4200/sec total: 1522 2026-04-02T04:22:04.586Z|00028|coverage(revalidator18)|INFO|mac_learning_expired 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.586Z|00029|coverage(revalidator18)|INFO|mac_learning_learned 0.0/sec 0.000/sec 0.0008/sec total: 3 2026-04-02T04:22:04.586Z|00030|coverage(revalidator18)|INFO|hmap_expand 21.4/sec 20.383/sec 6.2617/sec total: 22569 2026-04-02T04:22:04.586Z|00031|coverage(revalidator18)|INFO|hmap_pathological 0.0/sec 0.000/sec 0.0033/sec total: 12 2026-04-02T04:22:04.586Z|00032|coverage(revalidator18)|INFO|hindex_expand 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-04-02T04:22:04.586Z|00033|coverage(revalidator18)|INFO|hindex_pathological 0.0/sec 0.000/sec 0.0017/sec total: 6 2026-04-02T04:22:04.586Z|00034|coverage(revalidator18)|INFO|miniflow_malloc 0.0/sec 0.300/sec 2.2578/sec total: 8134 2026-04-02T04:22:04.586Z|00035|coverage(revalidator18)|INFO|flow_extract 1.6/sec 3.967/sec 0.6889/sec total: 2480 2026-04-02T04:22:04.586Z|00036|coverage(revalidator18)|INFO|dpif_port_add 0.0/sec 0.000/sec 0.0019/sec total: 7 2026-04-02T04:22:04.586Z|00037|coverage(revalidator18)|INFO|dpif_flow_put_error 0.0/sec 0.083/sec 0.0906/sec total: 326 2026-04-02T04:22:04.586Z|00038|coverage(revalidator18)|INFO|dpif_flow_put 1.6/sec 3.867/sec 0.6119/sec total: 2203 2026-04-02T04:22:04.586Z|00039|coverage(revalidator18)|INFO|dpif_flow_get 0.0/sec 0.000/sec 0.0069/sec total: 25 2026-04-02T04:22:04.586Z|00040|coverage(revalidator18)|INFO|dpif_flow_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.586Z|00041|coverage(revalidator18)|INFO|dpif_flow_del 2.0/sec 3.017/sec 0.4978/sec total: 1795 2026-04-02T04:22:04.586Z|00042|coverage(revalidator18)|INFO|dpif_execute_with_help 0.2/sec 0.067/sec 0.0172/sec total: 62 2026-04-02T04:22:04.586Z|00043|coverage(revalidator18)|INFO|dpif_execute_error 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.586Z|00044|coverage(revalidator18)|INFO|dpif_execute 2.2/sec 4.117/sec 0.7061/sec total: 2542 2026-04-02T04:22:04.586Z|00045|coverage(revalidator18)|INFO|cmap_shrink 0.0/sec 0.033/sec 0.3408/sec total: 1227 2026-04-02T04:22:04.586Z|00046|coverage(revalidator18)|INFO|cmap_expand 0.0/sec 0.017/sec 0.5078/sec total: 1828 2026-04-02T04:22:04.586Z|00047|coverage(revalidator18)|INFO|ccmap_shrink 0.0/sec 0.000/sec 0.0378/sec total: 136 2026-04-02T04:22:04.586Z|00048|coverage(revalidator18)|INFO|ccmap_expand 0.0/sec 0.000/sec 0.0078/sec total: 28 2026-04-02T04:22:04.586Z|00049|coverage(revalidator18)|INFO|xlate_actions 3.8/sec 6.533/sec 1.2686/sec total: 4567 2026-04-02T04:22:04.586Z|00050|coverage(revalidator18)|INFO|upcall_ukey_replace 0.0/sec 0.000/sec 0.0006/sec total: 2 2026-04-02T04:22:04.586Z|00051|coverage(revalidator18)|INFO|upcall_flow_limit_scaled 0.0/sec 0.000/sec 0.0000/sec total: 1 2026-04-02T04:22:04.586Z|00052|coverage(revalidator18)|INFO|upcall_flow_limit_grew 0.0/sec 0.000/sec 0.0383/sec total: 138 2026-04-02T04:22:04.586Z|00053|coverage(revalidator18)|INFO|handler_duplicate_upcall 0.0/sec 0.000/sec 0.0472/sec total: 170 2026-04-02T04:22:04.586Z|00054|coverage(revalidator18)|INFO|rev_mac_learning 0.0/sec 0.000/sec 0.0011/sec total: 4 2026-04-02T04:22:04.586Z|00055|coverage(revalidator18)|INFO|rev_flow_table 0.0/sec 0.000/sec 0.0106/sec total: 38 2026-04-02T04:22:04.586Z|00056|coverage(revalidator18)|INFO|rev_port_toggled 0.0/sec 0.000/sec 0.0017/sec total: 6 2026-04-02T04:22:04.586Z|00057|coverage(revalidator18)|INFO|rev_reconfigure 0.0/sec 0.000/sec 0.0022/sec total: 8 2026-04-02T04:22:04.586Z|00058|coverage(revalidator18)|INFO|ofproto_update_port 0.0/sec 0.000/sec 0.0119/sec total: 43 2026-04-02T04:22:04.586Z|00059|coverage(revalidator18)|INFO|ofproto_recv_openflow 0.4/sec 0.283/sec 0.8108/sec total: 2922 2026-04-02T04:22:04.586Z|00060|coverage(revalidator18)|INFO|ofproto_packet_out 0.4/sec 0.200/sec 0.0458/sec total: 165 2026-04-02T04:22:04.586Z|00061|coverage(revalidator18)|INFO|ofproto_flush 0.0/sec 0.000/sec 0.0003/sec total: 1 2026-04-02T04:22:04.586Z|00062|coverage(revalidator18)|INFO|bridge_reconfigure 0.0/sec 0.000/sec 0.0181/sec total: 65 2026-04-02T04:22:04.586Z|00063|coverage(revalidator18)|INFO|113 events never hit 2026-04-02T04:31:45.433Z|00064|ofproto_dpif_upcall(revalidator18)|WARN|Spent an unreasonably long 2680ms dumping flows 2026-04-02T04:41:05.271Z|00065|ofproto_dpif_upcall(revalidator18)|WARN|Spent an unreasonably long 5916ms dumping flows