search

Ysurac / openmptcprouter

OpenMPTCProuter is an open source solution to aggregate multiple internet connections using Multipath TCP (MPTCP) on OpenWrt
https://www.openmptcprouter.com/
GNU General Public License v3.0
1.8k stars 258 forks source link

Shadowsocks not stable. #736

Closed bournehlm closed 4 years ago

bournehlm commented 4 years ago

Expected Behavior

Sometimes shadowsocks not stable, must restart shadowsocks to get back to work.

Actual Behavior

Steps to Reproduce the Problem

1.PC connect to RPI3 lan port. 2.After some time, PC can't connect to internet. 3.PC ping RPI3 (192.168.100.1), OK 4.RPI3 ping 8.8.8.8, OK. 5.PC ping 8.8.8.8, FAIL. 6.Restart shadowsocks, PC ping 8.8.8.8, OK.

Here is the log before restart shadowsocks. Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.267231] usbcore: registered new interface driver r8712u Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.275679] usbcore: registered new interface driver rndis_host Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.283739] usbcore: registered new interface driver rtl8150 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.292874] usbcore: registered new interface driver sierra_net Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.300848] usbcore: registered new interface driver sr9700 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.309753] usbcore: registered new interface driver usb_gigaset Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.316865] usb_gigaset: USB Driver for Gigaset 307x using M105 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.326680] usbcore: registered new interface driver usbhid Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.333402] usbhid: USB HID core driver Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.342109] usbcore: registered new interface driver usbserial_generic Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.349961] usbserial: USB Serial support registered for generic Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.358202] usbcore: registered new interface driver visor Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.364923] usbserial: USB Serial support registered for Handspring Visor / Palm OS Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.374896] usbserial: USB Serial support registered for Sony Clie 5.0 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.382734] usbserial: USB Serial support registered for Sony Clie 3.5 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.518127] xt_ndpi v1.2 ndpi 2.8.0 IPv6=YES debug_message=no Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.518127] BT: hash_size 0k, hash_expiation 0 sec, log_size 128kb Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.518127] sizeof hash_ip4p_node=44 id_struct=296 PATRICIA_MAXBITS=128 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.518127] flow_struct=2064 packet_struct=1400 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.518127] flow_tcp_struct=42 flow_udp_struct=27 int_one_line_struct=16 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.518127] ndpi_ip_addr_t=16 ndpi_protocol=8 nf_ct_ext_ndpi=176 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.518127] spinlock_t=4 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.518127] NF_EXT_ID 7 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.568880] xt_ndpi: MAX_PROTOCOLS 320 LAST_PROTOCOL 243 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.575443] xt_ndpi: flow acctounting OFF Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.592530] xt_time: kernel timezone is -0000 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.599254] usbcore: registered new interface driver ark3116 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.606422] usbserial: USB Serial support registered for ark3116 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.616793] usbcore: registered new interface driver bas_gigaset Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.624203] bas_gigaset: USB Driver for Gigaset 307x Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.631589] usbcore: registered new interface driver belkin_sa Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.638862] usbserial: USB Serial support registered for Belkin / Peracom / GoHubs USB Serial Adapter Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.652275] usbcore: registered new interface driver cdc_mbim Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.702356] usbcore: registered new interface driver ch341 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.709287] usbserial: USB Serial support registered for ch341-uart Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.718185] usbcore: registered new interface driver cp210x Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.725221] usbserial: USB Serial support registered for cp210x Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.733862] usbcore: registered new interface driver cypress_m8 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.741191] usbserial: USB Serial support registered for DeLorme Earthmate USB Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.749861] usbserial: USB Serial support registered for HID->COM RS232 Adapter Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.758579] usbserial: USB Serial support registered for Nokia CA-42 V2 Adapter Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.771573] usbcore: registered new interface driver ftdi_sio Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.778739] usbserial: USB Serial support registered for FTDI USB Serial Device Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.788832] usbcore: registered new interface driver garmin_gps Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.796281] usbserial: USB Serial support registered for Garmin GPS usb/tty Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.809698] usbcore: registered new interface driver keyspan Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.816896] usbserial: USB Serial support registered for Keyspan - (without firmware) Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.827587] usbserial: USB Serial support registered for Keyspan 1 port adapter Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.836508] usbserial: USB Serial support registered for Keyspan 2 port adapter Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.845361] usbserial: USB Serial support registered for Keyspan 4 port adapter Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.916995] usbcore: registered new interface driver mct_u232 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.924177] usbserial: USB Serial support registered for MCT U232 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.933706] usbcore: registered new interface driver mos7720 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.940732] usbserial: USB Serial support registered for Moschip 2 port adapter Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.952789] usbcore: registered new interface driver mt7601u Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.964558] usbcore: registered new interface driver oti6858 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.971648] usbserial: USB Serial support registered for oti6858 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.980138] usbcore: registered new interface driver pl2303 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 10.987124] usbserial: USB Serial support registered for pl2303 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.012510] usbcore: registered new interface driver rtl8187 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.024984] usbcore: registered new interface driver rtl8xxxu Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.045529] usbcore: registered new interface driver sierra Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.052402] usbserial: USB Serial support registered for Sierra USB modem Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.062116] usbcore: registered new interface driver ti_usb_3410_5052 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.069923] usbserial: USB Serial support registered for TI USB 3410 1 port adapter Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.080092] usbserial: USB Serial support registered for TI USB 5052 2 port adapter Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.091181] usbcore: registered new interface driver usb_serial_simple Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.099190] usbserial: USB Serial support registered for carelink Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.106734] usbserial: USB Serial support registered for zio Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.113794] usbserial: USB Serial support registered for funsoft Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.121191] usbserial: USB Serial support registered for flashloader Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.128894] usbserial: USB Serial support registered for google Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.136029] usbserial: USB Serial support registered for libtransistor Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.143764] usbserial: USB Serial support registered for vivopay Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.151003] usbserial: USB Serial support registered for moto_modem Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.158478] usbserial: USB Serial support registered for motorola_tetra Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.166193] usbserial: USB Serial support registered for novatel_gps Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.173666] usbserial: USB Serial support registered for hp4x Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.180475] usbserial: USB Serial support registered for suunto Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.187483] usbserial: USB Serial support registered for siemens_mpi Wed Nov 20 01:40:34 2019 kern.debug kernel: [ 11.216560] brcmfmac 1-1.1:1.0: no of_node; not parsing pinctrl DT Wed Nov 20 01:40:34 2019 kern.info kernel: [ 11.220603] brcmfmac: brcmf_fw_alloc_request: using brcm/brcmfmac43236b for chip BCM43236/3 Wed Nov 20 01:40:34 2019 kern.err kernel: [ 13.328747] firmware brcm!brcmfmac43236b.clm_blob: firmware_loading_store: map pages failed Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.339434] brcmfmac: brcmf_c_process_clm_blob: no clm_blob available (err=-11), device may have limited channels available Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.353274] brcmfmac: brcmf_c_preinit_dcmds: Firmware: BCM43236/3 wl0: Nov 30 2011 17:33:42 version 5.90.188.22 Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.401102] usbcore: registered new interface driver brcmfmac Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.409131] usbcore: registered new interface driver ipw Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.415806] usbserial: USB Serial support registered for IPWireless converter Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.425793] usbcore: registered new interface driver option Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.432849] usbserial: USB Serial support registered for GSM modem (1-port) Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.442775] usbcore: registered new interface driver qcserial Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.449973] usbserial: USB Serial support registered for Qualcomm USB modem Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.475376] usbcore: registered new interface driver rt2800usb Wed Nov 20 01:40:34 2019 kern.info kernel: [ 13.497819] usbcore: registered new interface driver rtl8192cu Wed Nov 20 01:40:34 2019 user.info kernel: [ 13.505409] kmodloader: done loading kernel modules from /etc/modules.d/* Wed Nov 20 01:40:34 2019 user.notice dnsmasq: DNS rebinding protection is active, will discard upstream RFC1918 responses! Wed Nov 20 01:40:34 2019 user.notice dnsmasq: Allowing 127.0.0.0/8 responses Wed Nov 20 01:40:34 2019 user.notice dnsmasq: Allowing RFC1918 responses for domain plex.direct Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: started, version 2.80 cachesize 150 Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: DNS service limited to local subnets Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: compile time options: IPv6 GNU-getopt no-DBus no-i18n no-IDN DHCP DHCPv6 no-Lua TFTP conntrack ipset auth DNSSEC no-ID loop-detect inotify dumpfile Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: using local addresses only for domain test Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: using local addresses only for domain onion Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: using local addresses only for domain localhost Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: using local addresses only for domain local Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: using local addresses only for domain invalid Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: using local addresses only for domain bind Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: using nameserver 127.0.0.1#5353 Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: using local addresses only for domain lan Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: read /etc/hosts - 4 addresses Wed Nov 20 01:40:34 2019 daemon.info dnsmasq[1996]: read /tmp/hosts/dhcp.cfg01411c - 0 addresses Wed Nov 20 01:40:34 2019 authpriv.info dropbear[2029]: Not backgrounding Wed Nov 20 01:40:34 2019 user.notice Shadowsocks: Rules UP Wed Nov 20 01:40:35 2019 user.notice Shadowsocks: Reload omr-bypass rules Wed Nov 20 01:40:35 2019 user.notice : Added device handler type: 8021ad Wed Nov 20 01:40:35 2019 user.notice : Added device handler type: 8021q Wed Nov 20 01:40:35 2019 user.notice : Added device handler type: macvlan Wed Nov 20 01:40:35 2019 user.notice : Added device handler type: veth Wed Nov 20 01:40:35 2019 user.notice : Added device handler type: bridge Wed Nov 20 01:40:35 2019 user.notice : Added device handler type: Network device Wed Nov 20 01:40:35 2019 user.notice : Added device handler type: tunnel Wed Nov 20 01:40:35 2019 daemon.err rngd[2362]: Wed Nov 20 01:40:35 2019 daemon.err rngd[2362]: Initalizing available sources Wed Nov 20 01:40:35 2019 daemon.err rngd[2362]: Wed Nov 20 01:40:35 2019 daemon.err rngd[2362]: Initalizing entropy source hwrng Wed Nov 20 01:40:35 2019 daemon.err rngd[2362]: Wed Nov 20 01:40:36 2019 cron.err crond[2504]: crond (busybox 1.31.0) started, log level 5 Wed Nov 20 01:40:36 2019 kern.info kernel: [ 16.194824] br-lan: port 1(eth0) entered blocking state Wed Nov 20 01:40:36 2019 kern.info kernel: [ 16.201699] br-lan: port 1(eth0) entered disabled state Wed Nov 20 01:40:36 2019 kern.info kernel: [ 16.209713] IPv6: ADDRCONF(NETDEV_UP): br-lan: link is not ready Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'lan' is enabled Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'lan' is setting up now Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'lan' is now up Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'loopback' is enabled Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'loopback' is setting up now Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'loopback' is now up Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'omr6in4' is setting up now Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'wan1' is enabled Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'wan2' is enabled Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'wan3' is enabled Wed Nov 20 01:40:36 2019 daemon.notice netifd: Network device 'lo' link is up Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'loopback' has link connectivity Wed Nov 20 01:40:36 2019 daemon.notice netifd: Network device 'eth2' link is up Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'wan2' has link connectivity Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'wan2' is setting up now Wed Nov 20 01:40:36 2019 daemon.notice netifd: Network device 'eth3' link is up Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'wan3' has link connectivity Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'wan3' is setting up now Wed Nov 20 01:40:36 2019 daemon.notice netifd: wan2 (2913): udhcpc: started, v1.31.0 Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'omr6in4' is now up Wed Nov 20 01:40:36 2019 daemon.notice netifd: tunnel '6in4-omr6in4' link is up Wed Nov 20 01:40:36 2019 daemon.notice netifd: wan3 (2992): udhcpc: started, v1.31.0 Wed Nov 20 01:40:36 2019 daemon.notice netifd: radio0 (2874): command failed: No error information (-524) Wed Nov 20 01:40:36 2019 user.notice mac80211: Failed command: iw dev wlan0 del Wed Nov 20 01:40:36 2019 daemon.notice netifd: wan2 (2913): udhcpc: sending discover Wed Nov 20 01:40:36 2019 daemon.notice netifd: wan3 (2992): udhcpc: sending discover Wed Nov 20 01:40:36 2019 kern.info kernel: [ 16.452460] asix 1-1.2:1.0 eth0: link up, 100Mbps, full-duplex, lpa 0xC1E1 Wed Nov 20 01:40:36 2019 kern.info kernel: [ 16.479256] br-lan: port 1(eth0) entered blocking state Wed Nov 20 01:40:36 2019 kern.info kernel: [ 16.486101] br-lan: port 1(eth0) entered forwarding state Wed Nov 20 01:40:36 2019 daemon.notice netifd: Network device 'eth0' link is up Wed Nov 20 01:40:36 2019 kern.info kernel: [ 16.494405] IPv6: ADDRCONF(NETDEV_CHANGE): br-lan: link becomes ready Wed Nov 20 01:40:36 2019 daemon.notice netifd: bridge 'br-lan' link is up Wed Nov 20 01:40:36 2019 daemon.notice netifd: Interface 'lan' has link connectivity Wed Nov 20 01:40:37 2019 user.notice firewall: Reloading firewall due to ifup of lan (br-lan) Wed Nov 20 01:40:37 2019 daemon.notice netifd: wan3 (2992): udhcpc: sending select for 192.168.8.131 Wed Nov 20 01:40:37 2019 daemon.notice netifd: wan2 (2913): udhcpc: sending select for 192.168.8.161 Wed Nov 20 01:40:37 2019 daemon.notice netifd: wan3 (2992): udhcpc: lease of 192.168.8.131 obtained, lease time 86400 Wed Nov 20 01:40:37 2019 daemon.notice netifd: Interface 'wan3' is now up Wed Nov 20 01:40:37 2019 daemon.notice netifd: wan2 (2913): udhcpc: lease of 192.168.8.161 obtained, lease time 86400 Wed Nov 20 01:40:37 2019 daemon.notice netifd: Interface 'wan2' is now up Wed Nov 20 01:40:37 2019 daemon.notice procd: /etc/rc.d/S5openmptcprouter: sed: /etc/sysctl.conf: No such file or directory Wed Nov 20 01:40:37 2019 daemon.notice procd: /etc/rc.d/S5openmptcprouter: sed: /etc/sysctl.d/10-default.conf: No such file or directory Wed Nov 20 01:40:37 2019 user.notice mptcp: Reloading mptcp config due to ifup of lan (br-lan) Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/network reload dependency on /etc/config/dhcp Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/network reload dependency on /etc/config/radvd Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/network reload dependency on /etc/config/glorytun Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/network reload dependency on /etc/config/dsvpn Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/network reload dependency on /etc/config/macvlan Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/network reload dependency on /etc/config/omr6in4 Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/network reload dependency on /etc/config/mptcp Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/network reload dependency on /etc/config/omr-quota Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/network reload dependency on /etc/config/omr-tracker Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/network reload dependency on /etc/config/openmptcprouter Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/wireless reload dependency on /etc/config/network Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/firewall reload dependency on /etc/config/luci-splash Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/firewall reload dependency on /etc/config/qos Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/firewall reload dependency on /etc/config/miniupnpd Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/firewall reload dependency on /etc/config/sqm Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/dhcp reload dependency on /etc/config/odhcpd Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up non-init /etc/config/fstab reload handler: /sbin/block mount Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/system reload trigger for non-procd /etc/init.d/led Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/system reload dependency on /etc/config/luci_statistics Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/system reload dependency on /etc/config/dhcp Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/glorytun reload dependency on /etc/config/glorytun-udp Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/glorytun reload dependency on /etc/config/openmptcprouter-vps Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/upnpd reload trigger for non-procd /etc/init.d/miniupnpd Wed Nov 20 01:40:37 2019 user.notice mptcp: Reloading mptcp config due to ifup of loopback (lo) Wed Nov 20 01:40:37 2019 user.notice ucitrack: Setting up /etc/config/shadowsocks-libev reload dependency on /etc/config/omr-tracker Wed Nov 20 01:40:38 2019 user.notice mac80211: Failed command: iw phy phy0 set antenna 0xffffffff 0xffffffff Wed Nov 20 01:40:38 2019 daemon.notice netifd: radio0 (2874): command failed: Not supported (-95) Wed Nov 20 01:40:38 2019 user.notice mac80211: Failed command: iw phy phy0 set antenna_gain 0 Wed Nov 20 01:40:38 2019 daemon.notice netifd: radio0 (2874): command failed: I/O error (-5) Wed Nov 20 01:40:38 2019 user.notice mac80211: Failed command: iw phy phy0 set distance 0 Wed Nov 20 01:40:38 2019 daemon.notice netifd: radio0 (2874): sh: out of range Wed Nov 20 01:40:38 2019 daemon.notice netifd: radio0 (2874): command failed: Too many open files in system (-23) Wed Nov 20 01:40:38 2019 user.notice mac80211: Failed command: iw phy phy0 interface add wlan0 type __ap Wed Nov 20 01:40:38 2019 daemon.err hostapd: Configuration file: /var/run/hostapd-phy0.conf Wed Nov 20 01:40:38 2019 daemon.err hostapd: HT (IEEE 802.11n) with WPA/WPA2 requires CCMP/GCMP to be enabled, disabling HT capabilities Wed Nov 20 01:40:38 2019 kern.info kernel: [ 17.698025] IPv6: ADDRCONF(NETDEV_UP): wlan0: link is not ready Wed Nov 20 01:40:38 2019 kern.info kernel: [ 17.706877] br-lan: port 2(wlan0) entered blocking state Wed Nov 20 01:40:38 2019 kern.info kernel: [ 17.713656] br-lan: port 2(wlan0) entered disabled state Wed Nov 20 01:40:38 2019 kern.info kernel: [ 17.720549] br-lan: port 2(wlan0) entered blocking state Wed Nov 20 01:40:38 2019 kern.info kernel: [ 17.727100] br-lan: port 2(wlan0) entered forwarding state Wed Nov 20 01:40:38 2019 daemon.notice hostapd: wlan0: interface state UNINITIALIZED->COUNTRY_UPDATE Wed Nov 20 01:40:38 2019 kern.info kernel: [ 17.734314] br-lan: port 2(wlan0) entered disabled state Wed Nov 20 01:40:38 2019 daemon.notice hostapd: wlan0: interface state COUNTRY_UPDATE->HT_SCAN Wed Nov 20 01:40:38 2019 user.notice firewall: Reloading firewall due to ifup of omr6in4 (6in4-omr6in4) Wed Nov 20 01:40:38 2019 daemon.warn hostapd: wlan0: Could not connect to kernel driver Wed Nov 20 01:40:38 2019 daemon.err hostapd: Using interface wlan0 with hwaddr f4:28:53:0a:3d:e0 and ssid "Router-03" Wed Nov 20 01:40:38 2019 daemon.info glorytun: starting glorytun vpn instance vpn Wed Nov 20 01:40:38 2019 daemon.notice netifd: Interface 'omrvpn' is enabled Wed Nov 20 01:40:38 2019 daemon.info glorytun[4434]: INITIALIZED tun0 Wed Nov 20 01:40:38 2019 daemon.notice netifd: Network device 'tun0' link is up Wed Nov 20 01:40:38 2019 daemon.notice netifd: Interface 'omrvpn' has link connectivity Wed Nov 20 01:40:38 2019 daemon.notice netifd: Interface 'omrvpn' is setting up now Wed Nov 20 01:40:38 2019 daemon.notice netifd: Interface 'omrvpn' is now up Wed Nov 20 01:40:38 2019 kern.info kernel: [ 18.301644] IPv6: ADDRCONF(NETDEV_CHANGE): wlan0: link becomes ready Wed Nov 20 01:40:38 2019 kern.info kernel: [ 18.309519] br-lan: port 2(wlan0) entered blocking state Wed Nov 20 01:40:38 2019 kern.info kernel: [ 18.316105] br-lan: port 2(wlan0) entered forwarding state Wed Nov 20 01:40:38 2019 daemon.notice hostapd: wlan0: interface state HT_SCAN->ENABLED Wed Nov 20 01:40:38 2019 daemon.notice hostapd: wlan0: AP-ENABLED Wed Nov 20 01:40:38 2019 daemon.notice netifd: Network device 'wlan0' link is up Wed Nov 20 01:40:39 2019 daemon.notice procd: /etc/rc.d/S90mptcp: Cannot change rx-checksumming Wed Nov 20 01:40:39 2019 daemon.notice procd: /etc/rc.d/S90mptcp: Cannot change tx-checksumming Wed Nov 20 01:40:39 2019 user.notice mptcp: Reloading mptcp config due to ifup of omr6in4 (6in4-omr6in4) Wed Nov 20 01:40:39 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: connected Wed Nov 20 01:40:39 2019 user.notice firewall: Reloading firewall due to ifup of wan3 (eth3) Wed Nov 20 01:40:40 2019 user.notice Shadowsocks: Rules UP Wed Nov 20 01:40:40 2019 user.notice Shadowsocks: Reload omr-bypass rules Wed Nov 20 01:40:40 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 01:40:41 2019 user.notice omr-tracker: Launching... Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[1996]: exiting on receipt of SIGTERM Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: started, version 2.80 cachesize 150 Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: DNS service limited to local subnets Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: compile time options: IPv6 GNU-getopt no-DBus no-i18n no-IDN DHCP DHCPv6 no-Lua TFTP conntrack ipset auth DNSSEC no-ID loop-detect inotify dumpfile Wed Nov 20 01:40:41 2019 daemon.info dnsmasq-dhcp[6001]: DHCP, IP range 192.168.100.100 -- 192.168.100.249, lease time 12h Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: using local addresses only for domain test Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: using local addresses only for domain onion Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: using local addresses only for domain localhost Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: using local addresses only for domain local Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: using local addresses only for domain invalid Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: using local addresses only for domain bind Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: using nameserver 127.0.0.1#5353 Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: using local addresses only for domain lan Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: read /etc/hosts - 4 addresses Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 01:40:41 2019 daemon.info dnsmasq-dhcp[6001]: read /etc/ethers - 0 addresses Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: read /etc/hosts - 4 addresses Wed Nov 20 01:40:41 2019 daemon.info dnsmasq[6001]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 01:40:41 2019 daemon.info dnsmasq-dhcp[6001]: read /etc/ethers - 0 addresses Wed Nov 20 01:40:41 2019 user.notice omr-tracker: Launched Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.173977] pinctrl-bcm2835 3f200000.gpio: request pin 40 (gpio40) for pinctrl-bcm2835:40 Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.184461] pinctrl-bcm2835 3f200000.gpio: get 24200000 (40 => gpio_in) Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.193002] pinctrl-bcm2835 3f200000.gpio: read 24200000 (40 => gpio_in) Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.200964] pinctrl-bcm2835 3f200000.gpio: write 24200001 (40 <= gpio_out) Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.209453] pinctrl-bcm2835 3f200000.gpio: request pin 42 (gpio42) for pinctrl-bcm2835:42 Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.220007] pinctrl-bcm2835 3f200000.gpio: get 24200001 (42 => gpio_in) Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.228437] pinctrl-bcm2835 3f200000.gpio: read 24200001 (42 => gpio_in) Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.236559] pinctrl-bcm2835 3f200000.gpio: write 24200041 (42 <= gpio_out) Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.245001] pinctrl-bcm2835 3f200000.gpio: request pin 43 (gpio43) for pinctrl-bcm2835:43 Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.255569] pinctrl-bcm2835 3f200000.gpio: get 24200041 (43 => gpio_in) Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.263918] pinctrl-bcm2835 3f200000.gpio: read 24200041 (43 => gpio_in) Wed Nov 20 01:40:41 2019 kern.debug kernel: [ 21.271949] pinctrl-bcm2835 3f200000.gpio: write 24200241 (43 <= gpio_out) Wed Nov 20 01:40:41 2019 user.err vnstat_backup: cannot restore, backup file does not exist (yet) Wed Nov 20 01:40:41 2019 user.notice adb-enablemodem: INFO: waiting for device Wed Nov 20 01:40:42 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 01:40:42 2019 daemon.notice procd: /etc/rc.d/S99omr-bypass: 0+5 records in Wed Nov 20 01:40:42 2019 daemon.notice procd: /etc/rc.d/S99omr-bypass: 0+5 records out Wed Nov 20 01:40:42 2019 user.notice unbound: default memory configuration Wed Nov 20 01:40:42 2019 daemon.info dnsmasq-dhcp[6001]: DHCPREQUEST(br-lan) 192.168.100.189 e0:d5:5e:a8:38:4c Wed Nov 20 01:40:42 2019 daemon.info dnsmasq-dhcp[6001]: DHCPACK(br-lan) 192.168.100.189 e0:d5:5e:a8:38:4c DESKTOP-FE6BS6P Wed Nov 20 01:40:42 2019 daemon.notice unbound: [6942:0] notice: init module 0: iterator Wed Nov 20 01:40:42 2019 daemon.info unbound: [6942:0] info: start of service (unbound 1.9.3). Wed Nov 20 01:40:42 2019 user.notice omr-bypass: Restart dnsmasq... Wed Nov 20 01:40:43 2019 daemon.info dnsmasq[6001]: exiting on receipt of SIGTERM Wed Nov 20 01:40:43 2019 user.notice dnsmasq: DNS rebinding protection is active, will discard upstream RFC1918 responses! Wed Nov 20 01:40:43 2019 user.notice dnsmasq: Allowing 127.0.0.0/8 responses Wed Nov 20 01:40:43 2019 user.notice dnsmasq: Allowing RFC1918 responses for domain plex.direct Wed Nov 20 01:40:44 2019 user.notice omr-bypass: Restart dnsmasq... Wed Nov 20 01:40:44 2019 daemon.notice procd: /etc/rc.d/S99omr-bypass: Command failed: Not found Wed Nov 20 01:40:44 2019 user.notice dnsmasq: DNS rebinding protection is active, will discard upstream RFC1918 responses! Wed Nov 20 01:40:44 2019 user.notice dnsmasq: Allowing 127.0.0.0/8 responses Wed Nov 20 01:40:44 2019 user.notice dnsmasq: Allowing RFC1918 responses for domain plex.direct Wed Nov 20 01:40:44 2019 daemon.notice procd: /etc/rc.d/S99omr-bypass: udhcpc: started, v1.31.0 Wed Nov 20 01:40:44 2019 daemon.notice procd: /etc/rc.d/S99omr-bypass: udhcpc: sending discover Wed Nov 20 01:40:45 2019 daemon.err uhttpd[3167]: luci: accepted login on /admin for root from 192.168.100.189 Wed Nov 20 01:40:45 2019 user.notice post-tracking-post-tracking: omrvpn down. Replace default route by 192.168.8.1 dev eth3 Wed Nov 20 01:40:45 2019 user.notice post-tracking-post-tracking: omrvpn down Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: started, version 2.80 cachesize 150 Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: DNS service limited to local subnets Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: compile time options: IPv6 GNU-getopt no-DBus no-i18n no-IDN DHCP DHCPv6 no-Lua TFTP conntrack ipset auth DNSSEC no-ID loop-detect inotify dumpfile Wed Nov 20 01:40:46 2019 daemon.info dnsmasq-dhcp[8560]: DHCP, IP range 192.168.100.100 -- 192.168.100.249, lease time 12h Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: using local addresses only for domain test Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: using local addresses only for domain onion Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: using local addresses only for domain localhost Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: using local addresses only for domain local Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: using local addresses only for domain invalid Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: using local addresses only for domain bind Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: using nameserver 127.0.0.1#5353 Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: using local addresses only for domain lan Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: read /etc/hosts - 4 addresses Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: read /tmp/hosts/dhcp.cfg01411c.8247 - 0 addresses Wed Nov 20 01:40:46 2019 daemon.info dnsmasq[8560]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 01:40:46 2019 daemon.info dnsmasq-dhcp[8560]: read /etc/ethers - 0 addresses Wed Nov 20 01:40:46 2019 user.notice omr-bypass: OMR-ByPass is running Wed Nov 20 01:40:46 2019 user.notice mptcp: Reloading mptcp config due to ifup of wan3 (eth3) Wed Nov 20 01:40:46 2019 user.notice post-tracking-post-tracking: eth1 switched off Wed Nov 20 01:40:46 2019 user.notice post-tracking-post-tracking: Delete vps (101.37.66.246) route via dev eth1 Wed Nov 20 01:40:46 2019 user.notice firewall: Reloading firewall due to ifup of wan2 (eth2) Wed Nov 20 01:40:46 2019 daemon.err omr-tracker-ss[6156]: Failed to establish connection Wed Nov 20 01:40:47 2019 user.notice mptcp: Reloading mptcp config due to ifup of wan2 (eth2) Wed Nov 20 01:40:47 2019 user.notice firewall: Reloading firewall due to ifup of omrvpn (tun0) Wed Nov 20 01:40:47 2019 user.notice omr-tracker: Can't create route to 4.2.2.1 via 192.168.8.1 dev eth2 src 192.168.8.161. waiting... Wed Nov 20 01:40:47 2019 user.notice mptcp: Reloading mptcp config due to ifup of omrvpn (tun0) Wed Nov 20 01:40:48 2019 daemon.notice procd: /etc/rc.d/S99omr-bypass: udhcpc: no lease, failing Wed Nov 20 01:40:48 2019 user.notice omr-bypass: OMR-ByPass is running Wed Nov 20 01:40:49 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: key exchange failed Wed Nov 20 01:40:49 2019 daemon.info glorytun[4434]: STOPPED tun0 Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-local[9684]: using tcp fast open Wed Nov 20 01:40:50 2019 user.info : using tcp fast open Wed Nov 20 01:40:50 2019 user.info : using tcp fast open Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-local[9684]: enable TCP no-delay Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9688]: enable TCP no-delay Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9686]: enable TCP no-delay Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9686]: resolving hostname to IPv6 address first Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-local[9684]: initializing ciphers... aes-256-gcm Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9688]: initializing ciphers... aes-256-gcm Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9686]: initializing ciphers... aes-256-gcm Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9686]: listening at 0.0.0.0:1100 Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9688]: listening at 0.0.0.0:1100 Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-local[9684]: listening at 127.0.0.1:1111 Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9688]: tcp port reuse enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9686]: tcp port reuse enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-local[9684]: tcp port reuse enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9688]: UDP relay enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9686]: UDP relay enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-local[9684]: udprelay enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9686]: udp port reuse enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9688]: udp port reuse enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-local[9684]: udp port reuse enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-local[9684]: running from root user Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9688]: running from root user Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9686]: running from root user Wed Nov 20 01:40:50 2019 user.info : using tcp fast open Wed Nov 20 01:40:50 2019 user.info : using tcp fast open Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9687]: enable TCP no-delay Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9685]: enable TCP no-delay Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9685]: resolving hostname to IPv6 address first Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9685]: initializing ciphers... aes-256-gcm Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9687]: initializing ciphers... aes-256-gcm Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9687]: listening at 0.0.0.0:1100 Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9685]: listening at 0.0.0.0:1100 Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9685]: tcp port reuse enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9687]: tcp port reuse enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9687]: UDP relay enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9685]: UDP relay enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9687]: udp port reuse enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9685]: udp port reuse enabled Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9687]: running from root user Wed Nov 20 01:40:50 2019 daemon.info /usr/bin/ss-redir[9685]: running from root user Wed Nov 20 01:40:50 2019 user.notice post-tracking-post-tracking: Set server vps (101.37.66.246) route via 192.168.8.1 metric 4 Wed Nov 20 01:40:50 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Wed Nov 20 01:40:50 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: connected Wed Nov 20 01:40:50 2019 daemon.info procd: - init complete - Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: No interfaces found in database, adding available interfaces... Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "ifb0" added with 1000 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "tun0" added with 10 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "wlan0" added with 1000 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "6in4-omr6in4" added with 1000 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "eth3" added with 1000 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "ifb1" added with 1000 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "eth0" added with 100 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "teql0" added with 1000 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "eth2" added with 1000 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "eth1" added with 10 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Interface "br-lan" added with 1000 Mbit bandwidth limit. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: -> 11 new interfaces found. Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Limits can be modified using the configuration file. See "man vnstat.conf". Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Unwanted interfaces can be removed from monitoring with "vnstat --remove". Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Info: vnStat daemon 2.4 started. (pid:9788 uid:0 gid:0 64-bit) Wed Nov 20 01:40:51 2019 daemon.info vnstatd[9788]: Info: Monitoring (11): wlan0 (1000 Mbit) tun0 (10 Mbit) teql0 (1000 Mbit) ifb1 (1000 Mbit) ifb0 (1000 Mbit) eth3 (1000 Mbit) eth2 (1000 Mbit) eth1 (10 Mbit) eth0 (100 Mbit) br-lan (1000 Mbit) 6in4-omr6in4 (1000 Mbit) Wed Nov 20 01:40:52 2019 daemon.info omr-tracker-ss: Shadowsocks is up (can contact 1.0.0.1) Wed Nov 20 01:40:53 2019 user.notice post-tracking-post-tracking: Set server vps (101.37.66.246) route via 192.168.8.1 metric 5 Wed Nov 20 01:41:31 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: key exchange failed Wed Nov 20 01:41:31 2019 daemon.info glorytun[4434]: STOPPED tun0 Wed Nov 20 01:41:33 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: connected Wed Nov 20 01:41:43 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: key exchange failed Wed Nov 20 01:41:43 2019 daemon.info glorytun[4434]: STOPPED tun0 Wed Nov 20 01:41:45 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: connected Wed Nov 20 01:41:54 2019 daemon.err /usr/bin/ss-redir[9688]: remote recv: Operation timed out Wed Nov 20 01:41:54 2019 daemon.err /usr/bin/ss-redir[9687]: remote recv: Operation timed out Wed Nov 20 01:41:54 2019 daemon.err /usr/bin/ss-redir[9686]: remote recv: Operation timed out Wed Nov 20 01:41:54 2019 daemon.err /usr/bin/ss-redir[9687]: remote recv: Operation timed out Wed Nov 20 01:41:54 2019 daemon.err /usr/bin/ss-redir[9686]: remote recv: Operation timed out Wed Nov 20 01:41:54 2019 daemon.err /usr/bin/ss-redir[9687]: remote recv: Operation timed out Wed Nov 20 01:41:54 2019 daemon.err /usr/bin/ss-redir[9685]: remote recv: Operation timed out Wed Nov 20 01:41:54 2019 daemon.err /usr/bin/ss-redir[9685]: remote recv: Operation timed out Wed Nov 20 01:41:54 2019 daemon.err /usr/bin/ss-redir[9686]: remote recv: Operation timed out Wed Nov 20 01:41:55 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: key exchange failed Wed Nov 20 01:41:55 2019 daemon.info glorytun[4434]: STOPPED tun0 Wed Nov 20 01:42:03 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: connected Wed Nov 20 01:42:09 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Done Wed Nov 20 01:42:13 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: key exchange failed Wed Nov 20 01:42:13 2019 daemon.info glorytun[4434]: STOPPED tun0 Wed Nov 20 01:42:14 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: connected Wed Nov 20 01:42:24 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: key exchange failed Wed Nov 20 01:42:24 2019 daemon.info glorytun[4434]: STOPPED tun0 Wed Nov 20 01:42:25 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: connected Wed Nov 20 01:42:28 2019 user.notice post-tracking-post-tracking: Change master interface from wan2 (213 ms) to wan3 (22 ms) Wed Nov 20 01:42:35 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: key exchange failed Wed Nov 20 01:42:35 2019 daemon.info glorytun[4434]: STOPPED tun0 Wed Nov 20 01:42:36 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: connected Wed Nov 20 01:42:46 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: key exchange failed Wed Nov 20 01:42:46 2019 daemon.info glorytun[4434]: STOPPED tun0 Wed Nov 20 01:42:48 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: connected Wed Nov 20 01:42:58 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: key exchange failed Wed Nov 20 01:42:58 2019 daemon.info glorytun[4434]: STOPPED tun0 Wed Nov 20 01:43:15 2019 daemon.err /usr/bin/ss-local[9684]: getpeername: Socket not connected Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: service stopped (unbound 1.9.3). Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: server stats for thread 0: 286 queries, 4 answers from cache, 282 recursions, 0 prefetch, 0 rejected by ip ratelimiting Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: server stats for thread 0: requestlist max 20 avg 5.62411 exceeded 0 jostled 0 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: average recursion processing time 1.929361 sec Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: histogram of recursion processing times Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: [25%]=0.395088 median[50%]=1.31667 [75%]=3.3209 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: lower(secs) upper(secs) recursions Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 0.002048 0.004096 1 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 0.008192 0.016384 1 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 0.016384 0.032768 5 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 0.032768 0.065536 8 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 0.065536 0.131072 13 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 0.131072 0.262144 19 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 0.262144 0.524288 35 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 0.524288 1.000000 38 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 1.000000 2.000000 30 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 2.000000 4.000000 67 Wed Nov 20 01:43:36 2019 daemon.info unbound: [6942:0] info: 4.000000 8.000000 42 Wed Nov 20 01:43:36 2019 daemon.notice unbound: [12112:0] notice: init module 0: iterator Wed Nov 20 01:43:36 2019 daemon.info unbound: [12112:0] info: start of service (unbound 1.9.3). Wed Nov 20 01:43:40 2019 user.notice post-tracking-post-tracking: eth2 switched off because ping from 192.168.8.161 error (4.2.2.1,8.8.8.8,8.8.4.4) Wed Nov 20 01:43:40 2019 user.notice post-tracking-post-tracking: Delete vps (101.37.66.246) route via 192.168.8.1 dev eth2 Wed Nov 20 01:43:40 2019 user.notice post-tracking-post-tracking: wan2 down. Replace default route by 192.168.8.1 dev eth3 Wed Nov 20 01:43:49 2019 user.notice post-tracking-post-tracking: Multipath eth2 switched to on Wed Nov 20 01:43:49 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Wed Nov 20 01:44:02 2019 user.notice post-tracking-post-tracking: eth3 switched off because ping from 192.168.8.131 error (9.9.9.9,1.1.1.1,1.0.0.1) Wed Nov 20 01:44:02 2019 user.notice post-tracking-post-tracking: Delete vps (101.37.66.246) route via 192.168.8.1 dev eth3 Wed Nov 20 01:44:02 2019 user.notice post-tracking-post-tracking: wan3 down. Replace default route by 192.168.8.1 dev eth2 Wed Nov 20 01:44:07 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Failed Wed Nov 20 01:44:07 2019 user.notice post-tracking-post-tracking: Change master interface from wan3 (1000 ms) to wan2 (204 ms) Wed Nov 20 01:44:16 2019 user.notice post-tracking-post-tracking: Multipath eth3 switched to on Wed Nov 20 01:44:16 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Wed Nov 20 01:44:23 2019 user.notice post-tracking-post-tracking: Set server vps (101.37.66.246) route via 192.168.8.1 metric 5 Wed Nov 20 01:44:59 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Done Wed Nov 20 01:45:15 2019 daemon.notice netifd: Network device 'eth1' link is up Wed Nov 20 01:45:15 2019 daemon.notice netifd: Interface 'wan1' has link connectivity Wed Nov 20 01:45:15 2019 daemon.notice netifd: Interface 'wan1' is setting up now Wed Nov 20 01:45:15 2019 kern.info kernel: [ 264.295411] asix 1-1.3:1.0 eth1: link up, 100Mbps, full-duplex, lpa 0xC1E1 Wed Nov 20 01:45:15 2019 daemon.notice netifd: wan1 (14022): udhcpc: started, v1.31.0 Wed Nov 20 01:45:15 2019 daemon.notice netifd: wan1 (14022): udhcpc: sending discover Wed Nov 20 01:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: sending select for 192.168.0.114 Wed Nov 20 01:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: lease of 192.168.0.114 obtained, lease time 7200 Wed Nov 20 01:45:16 2019 daemon.notice netifd: Interface 'wan1' is now up Wed Nov 20 01:45:16 2019 user.notice firewall: Reloading firewall due to ifup of wan1 (eth1) Wed Nov 20 01:45:16 2019 user.notice mptcp: Reloading mptcp config due to ifup of wan1 (eth1) Wed Nov 20 01:45:19 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 01:45:21 2019 user.notice omr-bypass: Restart dnsmasq... Wed Nov 20 01:45:21 2019 daemon.info dnsmasq[8560]: exiting on receipt of SIGTERM Wed Nov 20 01:45:21 2019 user.notice dnsmasq: DNS rebinding protection is active, will discard upstream RFC1918 responses! Wed Nov 20 01:45:21 2019 user.notice dnsmasq: Allowing 127.0.0.0/8 responses Wed Nov 20 01:45:21 2019 user.notice dnsmasq: Allowing RFC1918 responses for domain plex.direct Wed Nov 20 01:45:24 2019 user.notice post-tracking-post-tracking: Set server vps (101.37.66.246) route via 192.168.0.1 metric 3 Wed Nov 20 01:45:24 2019 user.notice post-tracking-post-tracking: Get status and settings for wan1... Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: started, version 2.80 cachesize 150 Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: DNS service limited to local subnets Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: compile time options: IPv6 GNU-getopt no-DBus no-i18n no-IDN DHCP DHCPv6 no-Lua TFTP conntrack ipset auth DNSSEC no-ID loop-detect inotify dumpfile Wed Nov 20 01:45:24 2019 daemon.info dnsmasq-dhcp[15508]: DHCP, IP range 192.168.100.100 -- 192.168.100.249, lease time 12h Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: using local addresses only for domain test Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: using local addresses only for domain onion Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: using local addresses only for domain localhost Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: using local addresses only for domain local Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: using local addresses only for domain invalid Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: using local addresses only for domain bind Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: using nameserver 127.0.0.1#5353 Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: using local addresses only for domain lan Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: read /etc/hosts - 4 addresses Wed Nov 20 01:45:24 2019 daemon.info dnsmasq[15508]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 01:45:24 2019 daemon.info dnsmasq-dhcp[15508]: read /etc/ethers - 0 addresses Wed Nov 20 01:45:24 2019 user.notice omr-bypass: OMR-ByPass is running Wed Nov 20 01:45:25 2019 daemon.info omr-tracker-ss: Shadowsocks is down (can't contact 151.101.129.164, 1.1.1.1, 1.0.0.1) Wed Nov 20 01:45:25 2019 user.notice Shadowsocks: Rules DOWN Wed Nov 20 01:45:26 2019 user.notice Shadowsocks: Rules UP Wed Nov 20 01:45:26 2019 user.notice Shadowsocks: Reload omr-bypass rules Wed Nov 20 01:45:26 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 01:45:28 2019 user.notice omr-bypass: Reload dnsmasq... Wed Nov 20 01:45:28 2019 daemon.info dnsmasq[15508]: read /etc/hosts - 4 addresses Wed Nov 20 01:45:28 2019 daemon.info dnsmasq[15508]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 01:45:28 2019 daemon.info dnsmasq-dhcp[15508]: read /etc/ethers - 0 addresses Wed Nov 20 01:45:28 2019 user.notice omr-bypass: OMR-ByPass is running Wed Nov 20 01:45:31 2019 daemon.err /usr/bin/ss-local[9684]: getpeername: Socket not connected Wed Nov 20 01:45:31 2019 user.notice post-tracking-post-tracking: Set server vps (101.37.66.246) route via 192.168.8.1 metric 4 Wed Nov 20 01:45:37 2019 daemon.info omr-tracker-ss: Server (101.37.66.246) seems down, no answer to ping Wed Nov 20 01:45:43 2019 daemon.info omr-tracker-ss: Shadowsocks is up (can contact 212.27.48.10) Wed Nov 20 01:46:00 2019 daemon.info vnstatd[9788]: Info: Detected bandwidth limit for "eth1" changed from 10 Mbit to 100 Mbit. Wed Nov 20 01:47:12 2019 user.notice post-tracking-post-tracking: eth3 switched off because ping from 192.168.8.131 error (8.8.4.4,9.9.9.9,1.1.1.1) Wed Nov 20 01:47:12 2019 user.notice post-tracking-post-tracking: Delete vps (101.37.66.246) route via 192.168.8.1 dev eth3 Wed Nov 20 01:47:12 2019 user.notice post-tracking-post-tracking: wan3 down. Replace default route by 192.168.0.1 dev eth1 Wed Nov 20 01:47:23 2019 user.notice post-tracking-post-tracking: Master up : Replace default route by 192.168.8.1 dev eth2 Wed Nov 20 01:47:23 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Wed Nov 20 01:47:26 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Done Wed Nov 20 01:47:28 2019 user.notice post-tracking-post-tracking: Multipath eth3 switched to on Wed Nov 20 01:47:28 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Wed Nov 20 01:48:09 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Done Wed Nov 20 01:48:27 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Wed Nov 20 01:49:17 2019 user.notice post-tracking-post-tracking: eth3 switched off because ping from 192.168.8.131 error (80.67.169.40,4.2.2.1,8.8.8.8) Wed Nov 20 01:49:17 2019 user.notice post-tracking-post-tracking: Delete vps (101.37.66.246) route via 192.168.8.1 dev eth3 Wed Nov 20 01:49:17 2019 user.notice post-tracking-post-tracking: wan3 down. Replace default route by 192.168.0.1 dev eth1 Wed Nov 20 01:49:27 2019 user.notice post-tracking-post-tracking: Multipath eth3 switched to on Wed Nov 20 01:49:27 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Wed Nov 20 01:50:09 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Done Wed Nov 20 01:50:27 2019 daemon.err glorytun[4434]: 101.37.66.246.65001: connected Wed Nov 20 01:50:28 2019 daemon.info glorytun[4434]: STARTED tun0 Wed Nov 20 01:50:31 2019 user.notice post-tracking-post-tracking: Get status and settings for wan1... Done Wed Nov 20 01:50:35 2019 user.notice post-tracking-post-tracking: Tunnel up : Replace default route by 10.255.255.1 dev tun0 Wed Nov 20 01:50:41 2019 user.notice post-tracking-post-tracking: Set server vps (101.37.66.246) route via 192.168.8.1 metric 4 Wed Nov 20 01:50:50 2019 user.notice post-tracking-post-tracking: Change master interface from wan2 (192 ms) to wan1 (11 ms) Wed Nov 20 01:51:05 2019 user.notice post-tracking-post-tracking: Set server vps (101.37.66.246) default route via 192.168.0.1 Wed Nov 20 01:54:22 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Done Wed Nov 20 01:55:16 2019 daemon.info omr-tracker-ss: Shadowsocks is down (can't contact 151.101.129.164, 1.1.1.1, 1.0.0.1) Wed Nov 20 01:55:16 2019 user.notice Shadowsocks: Rules DOWN Wed Nov 20 01:55:31 2019 daemon.info omr-tracker-ss: Server (101.37.66.246) seems down, no answer to ping Wed Nov 20 01:55:47 2019 daemon.info omr-tracker-ss: Shadowsocks is up (can contact 104.16.1.1) Wed Nov 20 01:55:47 2019 daemon.info omr-tracker-ss: Reload Shadowsocks rules Wed Nov 20 01:55:47 2019 user.notice Shadowsocks: Rules UP Wed Nov 20 01:55:47 2019 user.notice Shadowsocks: Reload omr-bypass rules Wed Nov 20 01:55:47 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 01:55:49 2019 user.notice omr-bypass: Reload dnsmasq... Wed Nov 20 01:55:49 2019 daemon.info dnsmasq[15508]: read /etc/hosts - 4 addresses Wed Nov 20 01:55:49 2019 daemon.info dnsmasq[15508]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 01:55:49 2019 daemon.info dnsmasq-dhcp[15508]: read /etc/ethers - 0 addresses Wed Nov 20 01:55:49 2019 user.notice omr-bypass: OMR-ByPass is running Wed Nov 20 02:00:00 2019 cron.err crond[2504]: USER root pid 3147 cmd /etc/init.d/vnstat_backup backup Wed Nov 20 02:00:01 2019 user.notice omr-tracker: Can't create route to 80.67.169.40 via 192.168.0.1 dev eth1 src 192.168.0.114. waiting... Wed Nov 20 02:00:44 2019 daemon.info omr-tracker-ss: Shadowsocks is down (can't contact 198.27.92.1, 88.191.250.176, 151.101.129.164) Wed Nov 20 02:00:44 2019 user.notice Shadowsocks: Rules DOWN Wed Nov 20 02:00:59 2019 daemon.info omr-tracker-ss: Server (101.37.66.246) seems down, no answer to ping Wed Nov 20 02:12:57 2019 daemon.info omr-tracker-ss: Shadowsocks is up (can contact 103.224.182.242) Wed Nov 20 02:12:57 2019 daemon.info omr-tracker-ss: Reload Shadowsocks rules Wed Nov 20 02:12:57 2019 user.notice Shadowsocks: Rules UP Wed Nov 20 02:12:57 2019 user.notice Shadowsocks: Reload omr-bypass rules Wed Nov 20 02:12:57 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 02:12:59 2019 user.notice omr-bypass: Reload dnsmasq... Wed Nov 20 02:12:59 2019 daemon.info dnsmasq[15508]: read /etc/hosts - 4 addresses Wed Nov 20 02:12:59 2019 daemon.info dnsmasq[15508]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 02:12:59 2019 daemon.info dnsmasq-dhcp[15508]: read /etc/ethers - 0 addresses Wed Nov 20 02:12:59 2019 user.notice omr-bypass: OMR-ByPass is running Wed Nov 20 02:15:43 2019 user.notice omr-tracker: Can't create route to 80.67.169.12 via 192.168.8.1 dev eth3 src 192.168.8.131. waiting... Wed Nov 20 02:41:54 2019 user.notice omr-tracker: Can't create route to 1.0.0.1 via 192.168.8.1 dev eth3 src 192.168.8.131. waiting... Wed Nov 20 02:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: sending renew to 192.168.0.1 Wed Nov 20 02:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: lease of 192.168.0.114 obtained, lease time 7200 Wed Nov 20 02:45:28 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.8.1 dev eth2 src 192.168.8.161. waiting... Wed Nov 20 02:49:58 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Wed Nov 20 02:50:09 2019 user.notice post-tracking-post-tracking: Get status and settings for wan1... Wed Nov 20 02:50:39 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Done Wed Nov 20 02:53:52 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Wed Nov 20 02:55:19 2019 user.notice post-tracking-post-tracking: Get status and settings for wan1... Done Wed Nov 20 02:59:45 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Done Wed Nov 20 03:05:23 2019 daemon.info omr-tracker-ss: Shadowsocks is down (can't contact 151.101.129.164, 1.1.1.1, 1.0.0.1) Wed Nov 20 03:05:23 2019 user.notice Shadowsocks: Rules DOWN Wed Nov 20 03:05:38 2019 daemon.info omr-tracker-ss: Server (101.37.66.246) seems down, no answer to ping Wed Nov 20 03:10:11 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.0.1 dev eth1 src 192.168.0.114. waiting... Wed Nov 20 03:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: sending renew to 192.168.0.1 Wed Nov 20 03:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: lease of 192.168.0.114 obtained, lease time 7200 Wed Nov 20 03:50:28 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Wed Nov 20 03:51:09 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Done Wed Nov 20 03:51:31 2019 daemon.info omr-tracker-ss: Shadowsocks is up (can contact 1.0.0.1) Wed Nov 20 03:51:31 2019 daemon.info omr-tracker-ss: Reload Shadowsocks rules Wed Nov 20 03:51:31 2019 user.notice Shadowsocks: Rules UP Wed Nov 20 03:51:31 2019 user.notice Shadowsocks: Reload omr-bypass rules Wed Nov 20 03:51:31 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 03:51:33 2019 user.notice omr-bypass: Reload dnsmasq... Wed Nov 20 03:51:33 2019 daemon.info dnsmasq[15508]: read /etc/hosts - 4 addresses Wed Nov 20 03:51:33 2019 daemon.info dnsmasq[15508]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 03:51:33 2019 daemon.info dnsmasq-dhcp[15508]: read /etc/ethers - 0 addresses Wed Nov 20 03:51:33 2019 user.notice omr-bypass: OMR-ByPass is running Wed Nov 20 03:55:01 2019 user.notice post-tracking-post-tracking: Get status and settings for wan1... Wed Nov 20 03:55:24 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.8.1 dev eth3 src 192.168.8.131. waiting... Wed Nov 20 03:57:15 2019 daemon.warn dnsmasq[15508]: possible DNS-rebind attack detected: groupclient.qq.com Wed Nov 20 03:59:22 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Wed Nov 20 04:00:00 2019 cron.err crond[2504]: USER root pid 29555 cmd /etc/init.d/vnstat_backup backup Wed Nov 20 04:00:17 2019 user.notice post-tracking-post-tracking: Get status and settings for wan1... Done Wed Nov 20 04:05:12 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.0.1 dev eth1 src 192.168.0.114. waiting... Wed Nov 20 04:05:16 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Done Wed Nov 20 04:10:39 2019 daemon.info omr-tracker-ss: Shadowsocks is down (can't contact 198.27.92.1, 88.191.250.176, 151.101.129.164) Wed Nov 20 04:10:39 2019 user.notice Shadowsocks: Rules DOWN Wed Nov 20 04:10:54 2019 daemon.info omr-tracker-ss: Server (101.37.66.246) seems down, no answer to ping Wed Nov 20 04:14:37 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.8.1 dev eth2 src 192.168.8.161. waiting... Wed Nov 20 04:15:37 2019 user.notice omr-tracker: Can't create route to 8.8.8.8 via 192.168.8.1 dev eth3 src 192.168.8.131. waiting... Wed Nov 20 04:17:09 2019 user.notice omr-tracker: Can't create route to 4.2.2.1 via 192.168.8.1 dev eth3 src 192.168.8.131. waiting... Wed Nov 20 04:19:47 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.8.1 dev eth2 src 192.168.8.161. waiting... Wed Nov 20 04:21:49 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.0.1 dev eth1 src 192.168.0.114. waiting... Wed Nov 20 04:23:36 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.8.1 dev eth2 src 192.168.8.161. waiting... Wed Nov 20 04:30:39 2019 user.notice omr-tracker: Can't create route to 9.9.9.9 via 192.168.0.1 dev eth1 src 192.168.0.114. waiting... Wed Nov 20 04:36:57 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.0.1 dev eth1 src 192.168.0.114. waiting... Wed Nov 20 04:38:31 2019 daemon.info omr-tracker-ss: Shadowsocks is up (can contact 212.27.48.10) Wed Nov 20 04:38:31 2019 daemon.info omr-tracker-ss: Reload Shadowsocks rules Wed Nov 20 04:38:31 2019 user.notice Shadowsocks: Rules UP Wed Nov 20 04:38:31 2019 user.notice Shadowsocks: Reload omr-bypass rules Wed Nov 20 04:38:31 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 04:38:33 2019 user.notice omr-bypass: Reload dnsmasq... Wed Nov 20 04:38:33 2019 daemon.info dnsmasq[15508]: read /etc/hosts - 4 addresses Wed Nov 20 04:38:33 2019 daemon.info dnsmasq[15508]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 04:38:33 2019 daemon.info dnsmasq-dhcp[15508]: read /etc/ethers - 0 addresses Wed Nov 20 04:38:33 2019 user.notice omr-bypass: OMR-ByPass is running Wed Nov 20 04:43:05 2019 daemon.warn dnsmasq[15508]: possible DNS-rebind attack detected: groupclient.qq.com Wed Nov 20 04:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: sending renew to 192.168.0.1 Wed Nov 20 04:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: lease of 192.168.0.114 obtained, lease time 7200 Wed Nov 20 04:46:28 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.0.1 dev eth1 src 192.168.0.114. waiting... Wed Nov 20 04:51:01 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Wed Nov 20 04:51:49 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Done Wed Nov 20 04:52:28 2019 user.notice omr-tracker: Can't create route to 8.8.4.4 via 192.168.8.1 dev eth3 src 192.168.8.131. waiting... Wed Nov 20 04:59:57 2019 user.notice post-tracking-post-tracking: Get status and settings for wan1... Wed Nov 20 05:02:33 2019 user.notice omr-tracker: Can't create route to 1.1.1.1 via 192.168.8.1 dev eth2 src 192.168.8.161. waiting... Wed Nov 20 05:05:09 2019 user.notice post-tracking-post-tracking: Get status and settings for wan1... Done Wed Nov 20 05:05:21 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Wed Nov 20 05:11:15 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Done Wed Nov 20 05:16:03 2019 daemon.info omr-tracker-ss: Shadowsocks is down (can't contact 151.101.129.164, 1.1.1.1, 1.0.0.1) Wed Nov 20 05:16:03 2019 user.notice Shadowsocks: Rules DOWN Wed Nov 20 05:16:19 2019 daemon.info omr-tracker-ss: Server (101.37.66.246) seems down, no answer to ping Wed Nov 20 05:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: sending renew to 192.168.0.1 Wed Nov 20 05:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: lease of 192.168.0.114 obtained, lease time 7200 Wed Nov 20 05:47:41 2019 daemon.err uhttpd[3167]: luci: accepted login on / for root from 192.168.100.189 Wed Nov 20 05:50:56 2019 user.notice omr-tracker: Can't create route to 80.67.169.12 via 192.168.0.1 dev eth1 src 192.168.0.114. waiting... Wed Nov 20 05:51:24 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Wed Nov 20 05:52:09 2019 user.notice post-tracking-post-tracking: Get status and settings for wan3... Done Wed Nov 20 05:52:17 2019 daemon.info omr-tracker-ss: Shadowsocks is up (can contact 212.27.48.10) Wed Nov 20 05:52:17 2019 daemon.info omr-tracker-ss: Reload Shadowsocks rules Wed Nov 20 05:52:17 2019 user.notice Shadowsocks: Rules UP Wed Nov 20 05:52:17 2019 user.notice Shadowsocks: Reload omr-bypass rules Wed Nov 20 05:52:17 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 05:52:19 2019 user.notice omr-bypass: Reload dnsmasq... Wed Nov 20 05:52:19 2019 daemon.info dnsmasq[15508]: read /etc/hosts - 4 addresses Wed Nov 20 05:52:19 2019 daemon.info dnsmasq[15508]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 05:52:19 2019 daemon.info dnsmasq-dhcp[15508]: read /etc/ethers - 0 addresses Wed Nov 20 05:52:19 2019 user.notice omr-bypass: OMR-ByPass is running Wed Nov 20 05:55:33 2019 daemon.warn dnsmasq[15508]: possible DNS-rebind attack detected: canaryeastasia1.eastasia.cloudapp.azure.com Wed Nov 20 06:00:00 2019 cron.err crond[2504]: USER root pid 17469 cmd /etc/init.d/vnstat_backup backup Wed Nov 20 06:04:43 2019 user.notice post-tracking-post-tracking: Get status and settings for wan1... Wed Nov 20 06:09:45 2019 daemon.warn dnsmasq[15508]: possible DNS-rebind attack detected: groupclient.qq.com Wed Nov 20 06:09:56 2019 user.notice post-tracking-post-tracking: Get status and settings for wan1... Done Wed Nov 20 06:10:16 2019 daemon.info hostapd: wlan0: STA 48:a1:95:13:dd:3b IEEE 802.11: associated Wed Nov 20 06:10:16 2019 daemon.notice hostapd: wlan0: AP-STA-CONNECTED 48:a1:95:13:dd:3b Wed Nov 20 06:10:16 2019 daemon.info hostapd: wlan0: STA 48:a1:95:13:dd:3b WPA: pairwise key handshake completed (RSN) Wed Nov 20 06:10:16 2019 daemon.info dnsmasq-dhcp[15508]: DHCPREQUEST(br-lan) 192.168.100.199 48:a1:95:13:dd:3b Wed Nov 20 06:10:16 2019 daemon.info dnsmasq-dhcp[15508]: DHCPACK(br-lan) 192.168.100.199 48:a1:95:13:dd:3b naga Wed Nov 20 06:11:09 2019 daemon.info hostapd: wlan0: STA 48:a1:95:13:dd:3b WPA: group key handshake completed (RSN) Wed Nov 20 06:11:17 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Wed Nov 20 06:17:11 2019 user.notice post-tracking-post-tracking: Get status and settings for wan2... Done Wed Nov 20 06:20:56 2019 daemon.info omr-tracker-ss: Shadowsocks is down (can't contact 151.101.129.164, 1.1.1.1, 1.0.0.1) Wed Nov 20 06:20:56 2019 user.notice Shadowsocks: Rules DOWN Wed Nov 20 06:21:09 2019 daemon.info hostapd: wlan0: STA 48:a1:95:13:dd:3b WPA: group key handshake completed (RSN) Wed Nov 20 06:21:12 2019 daemon.info omr-tracker-ss: Server (101.37.66.246) seems down, no answer to ping Wed Nov 20 06:25:44 2019 daemon.err uhttpd[3167]: luci: accepted login on / for root from 192.168.100.189 Wed Nov 20 06:27:48 2019 authpriv.info dropbear[28557]: Child connection from 192.168.100.189:62536 Wed Nov 20 06:27:56 2019 authpriv.notice dropbear[28557]: Password auth succeeded for 'root' from 192.168.100.189:62536 Wed Nov 20 06:31:10 2019 daemon.info hostapd: wlan0: STA 48:a1:95:13:dd:3b WPA: group key handshake completed (RSN) Wed Nov 20 06:41:10 2019 daemon.info hostapd: wlan0: STA 48:a1:95:13:dd:3b WPA: group key handshake completed (RSN) Wed Nov 20 06:43:48 2019 daemon.info hostapd: wlan0: STA 88:6b:6e:40:f9:ef IEEE 802.11: associated Wed Nov 20 06:43:48 2019 daemon.notice hostapd: wlan0: AP-STA-CONNECTED 88:6b:6e:40:f9:ef Wed Nov 20 06:43:48 2019 daemon.info hostapd: wlan0: STA 88:6b:6e:40:f9:ef WPA: pairwise key handshake completed (RSN) Wed Nov 20 06:43:52 2019 daemon.info dnsmasq-dhcp[15508]: DHCPDISCOVER(br-lan) 88:6b:6e:40:f9:ef Wed Nov 20 06:43:52 2019 daemon.info dnsmasq-dhcp[15508]: DHCPOFFER(br-lan) 192.168.100.229 88:6b:6e:40:f9:ef Wed Nov 20 06:43:52 2019 daemon.info dnsmasq-dhcp[15508]: DHCPDISCOVER(br-lan) 88:6b:6e:40:f9:ef Wed Nov 20 06:43:52 2019 daemon.info dnsmasq-dhcp[15508]: DHCPOFFER(br-lan) 192.168.100.229 88:6b:6e:40:f9:ef Wed Nov 20 06:43:53 2019 daemon.info dnsmasq-dhcp[15508]: DHCPREQUEST(br-lan) 192.168.100.229 88:6b:6e:40:f9:ef Wed Nov 20 06:43:53 2019 daemon.info dnsmasq-dhcp[15508]: DHCPACK(br-lan) 192.168.100.229 88:6b:6e:40:f9:ef Bourne-iPhone Wed Nov 20 06:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: sending renew to 192.168.0.1 Wed Nov 20 06:45:16 2019 daemon.notice netifd: wan1 (14022): udhcpc: lease of 192.168.0.114 obtained, lease time 7200

Here is the log after restart shadowsocks. Wed Nov 20 06:48:13 2019 user.notice Shadowsocks: Rules UP Wed Nov 20 06:48:13 2019 user.notice Shadowsocks: Reload omr-bypass rules Wed Nov 20 06:48:13 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 06:48:14 2019 daemon.info omr-tracker-ss: Shadowsocks is down (can't contact 151.101.129.164, 1.1.1.1, 1.0.0.1, 212.27.48.10, 104.16.1.1, 103.224.182.242, 198.27.92.1, 88.191.250.176, 151.101.129.164, 1.1.1.1, 1.0.0.1, 212.27.48.10, 104.16.1.1, 103.224.182.242, 198.27.92.1, 88.191.250.176, 151.101.129.164, 1.1.1.1, 1.0.0.1, 212.27.48.10, 104.16.1.1, 103.224.182.242, 198.27.92.1, 88.191.250.176, 151.101.129.164, 1.1.1.1, 1.0.0.1, 212.27.48.10, 104.16.1.1, 103.224.182.242, 198.27.92.1, 88.191.250.176, 151.101.129.164, 1.1.1.1, 1.0.0.1, 212.27.48.10, 104.16.1.1, 103.224.182.242, 198.27.92.1, 88.191.250.176, 151.101.129.164, 1.1.1.1, 1.0.0.1, 212.27.48.10, 104.16.1.1, 103.224.182.242, 198.27.92.1, 88.191.250.176, 151.101.129.164, 1.1.1.1, 1.0.0.1, 212.27.48.10, 104.16.1.1, 103.224.182.242, 198.27.92.1, 88.191.250.176, 151.101.129.164, 1.1.1.1, 1.0.0.1, 212.27.48.10, 104.16.1.1, 103.224.182.242, 198.27.92.1, 88.191.250.176, 151.101.129.164, 1.1.1.1, 1.0.0.1, 212.27.48.10, 104.16.1.1, 103.224.182.242, 198.27.92.1, 88.19 Wed Nov 20 06:48:15 2019 user.notice omr-bypass: Reload dnsmasq... Wed Nov 20 06:48:15 2019 daemon.info dnsmasq[15508]: read /etc/hosts - 4 addresses Wed Nov 20 06:48:15 2019 daemon.info dnsmasq[15508]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 06:48:15 2019 daemon.info dnsmasq-dhcp[15508]: read /etc/ethers - 0 addresses Wed Nov 20 06:48:15 2019 user.notice omr-bypass: OMR-ByPass is running Wed Nov 20 06:48:15 2019 user.info : using tcp fast open Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7430]: enable TCP no-delay Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7430]: resolving hostname to IPv6 address first Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7430]: initializing ciphers... chacha20 Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7430]: listening at 0.0.0.0:1100 Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7430]: tcp port reuse enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7430]: UDP relay enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7430]: udp port reuse enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7430]: running from root user Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-local[7429]: using tcp fast open Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-local[7429]: enable TCP no-delay Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-local[7429]: initializing ciphers... chacha20 Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-local[7429]: listening at 127.0.0.1:1111 Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-local[7429]: tcp port reuse enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-local[7429]: udprelay enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-local[7429]: udp port reuse enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-local[7429]: running from root user Wed Nov 20 06:48:15 2019 user.info : using tcp fast open Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7433]: enable TCP no-delay Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7433]: initializing ciphers... chacha20 Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7433]: listening at 0.0.0.0:1100 Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7433]: tcp port reuse enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7433]: UDP relay enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7433]: udp port reuse enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7433]: running from root user Wed Nov 20 06:48:15 2019 user.info : using tcp fast open Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7432]: enable TCP no-delay Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7432]: initializing ciphers... chacha20 Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7432]: listening at 0.0.0.0:1100 Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7432]: tcp port reuse enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7432]: UDP relay enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7432]: udp port reuse enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7432]: running from root user Wed Nov 20 06:48:15 2019 user.info : using tcp fast open Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7431]: enable TCP no-delay Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7431]: resolving hostname to IPv6 address first Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7431]: initializing ciphers... chacha20 Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7431]: listening at 0.0.0.0:1100 Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7431]: tcp port reuse enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7431]: UDP relay enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7431]: udp port reuse enabled Wed Nov 20 06:48:15 2019 daemon.info /usr/bin/ss-redir[7431]: running from root user Wed Nov 20 06:48:15 2019 user.notice Shadowsocks: Rules DOWN Wed Nov 20 06:48:15 2019 user.notice omr-tracker: Launching... Wed Nov 20 06:48:15 2019 user.notice omr-tracker: Launched Wed Nov 20 06:48:32 2019 daemon.info omr-tracker-ss: Shadowsocks is up (can contact 1.0.0.1) Wed Nov 20 06:48:32 2019 daemon.info omr-tracker-ss: Reload Shadowsocks rules Wed Nov 20 06:48:32 2019 user.notice Shadowsocks: Rules UP Wed Nov 20 06:48:33 2019 user.notice Shadowsocks: Reload omr-bypass rules Wed Nov 20 06:48:33 2019 user.notice omr-bypass: Starting OMR-ByPass... Wed Nov 20 06:48:34 2019 user.notice omr-bypass: Reload dnsmasq... Wed Nov 20 06:48:34 2019 daemon.info dnsmasq[15508]: read /etc/hosts - 4 addresses Wed Nov 20 06:48:34 2019 daemon.info dnsmasq[15508]: read /tmp/hosts/dhcp.cfg01411c - 2 addresses Wed Nov 20 06:48:34 2019 daemon.info dnsmasq-dhcp[15508]: read /etc/ethers - 0 addresses Wed Nov 20 06:48:34 2019 user.notice omr-bypass: OMR-ByPass is running

Specifications

Ysurac commented 4 years ago

The problem is: "omr-tracker-ss: Server (101.37.66.246) seems down, no answer to ping". Ping doesn't use Shadowsocks but the VPN, Shadowsocks is only used for TCP. You can check the master route and set it to a better connection if possible (and set it as fixed in System->OpenMPTCProuter->Advanced parameters tab). You can also check VPS logs.

bournehlm commented 4 years ago

I'm sorry, You are right, Ping doesn't use Shadowsocks but the VPN, Shadowsocks is only used for TCP. So, ignore the ping steps, just consider PC can't connect to internet. Because after I restart shadowsock, PC can connect to internet again. I haven't do anything with the VPS server. Cloud you please tell me where is the VPS logs location? thank you!

Ysurac commented 4 years ago

If it's a debian, you can look at /var/log/daemon.log