Woke up this morning and looks like Delugevpn not working. Any ideas what issue might be?
ErrorWarningSystemArrayLogin
Created by...
___. .__ .__
\_ |__ |__| ____ | |__ ____ ___ ___
| __ \| |/ \| | \_/ __ \\ \/ /
| \_\ \ | | \ Y \ ___/ > <
|___ /__|___| /___| /\___ >__/\_ \
\/ \/ \/ \/ \/
https://hub.docker.com/u/binhex/
2020-01-19 06:12:46.260092 [info] System information Linux 69113bac74f6 4.19.94-Unraid #1 SMP Thu Jan 9 08:20:36 PST 2020 x86_64 GNU/Linux
2020-01-19 06:12:46.280621 [info] PUID defined as '99'
2020-01-19 06:12:46.370744 [info] PGID defined as '100'
2020-01-19 06:12:46.517440 [info] UMASK defined as '000'
2020-01-19 06:12:46.536197 [info] Permissions already set for volume mappings
2020-01-19 06:12:46.557560 [info] DELUGE_DAEMON_LOG_LEVEL defined as 'info'
2020-01-19 06:12:46.576019 [info] DELUGE_WEB_LOG_LEVEL defined as 'info'
2020-01-19 06:12:46.594417 [info] VPN_ENABLED defined as 'yes'
2020-01-19 06:12:46.619170 [info] OpenVPN config file (ovpn extension) is located at /config/openvpn/TorGuard.USA-LOS.ANGELES.ovpn
2020-01-19 06:12:46.655603 [info] VPN remote line defined as 'remote la.west.usa.torguardvpnaccess.com 1912'
2020-01-19 06:12:46.674092 [info] VPN_REMOTE defined as 'la.west.usa.torguardvpnaccess.com'
2020-01-19 06:12:46.693179 [info] VPN_PORT defined as '1912'
2020-01-19 06:12:46.714962 [info] VPN_PROTOCOL defined as 'tcp-client'
2020-01-19 06:12:46.733751 [info] VPN_DEVICE_TYPE defined as 'tun0'
2020-01-19 06:12:46.752640 [info] VPN_PROV defined as 'custom'
2020-01-19 06:12:46.772267 [info] LAN_NETWORK defined as '10.0.1.0/24'
2020-01-19 06:12:46.791969 [info] NAME_SERVERS defined as '209.222.18.222,84.200.69.80,37.235.1.174,1.1.1.1,209.222.18.218,37.235.1.177,84.200.70.40,1.0.0.1'
2020-01-19 06:12:46.810965 [info] VPN_USER defined as '
[email protected]'
2020-01-19 06:12:46.833035 [info] VPN_PASS defined as 'Prodos123!'
2020-01-19 06:12:46.854457 [info] VPN_OPTIONS not defined (via -e VPN_OPTIONS)
2020-01-19 06:12:46.874064 [info] ENABLE_PRIVOXY defined as 'yes'
2020-01-19 06:12:46.898671 [info] Deleting files in /tmp (non recursive)...
2020-01-19 06:12:46.916314 [info] Starting Supervisor...
2020-01-19 06:12:47,070 INFO Included extra file "/etc/supervisor/conf.d/delugevpn.conf" during parsing
2020-01-19 06:12:47,070 INFO Set uid to user 0 succeeded
2020-01-19 06:12:47,073 INFO supervisord started with pid 6
2020-01-19 06:12:48,075 INFO spawned: 'start-script' with pid 163
2020-01-19 06:12:48,075 INFO spawned: 'watchdog-script' with pid 164
2020-01-19 06:12:48,076 INFO reaped unknown pid 7
2020-01-19 06:12:48,080 DEBG 'start-script' stdout output:
[info] VPN is enabled, beginning configuration of VPN
2020-01-19 06:12:48,080 INFO success: start-script entered RUNNING state, process has stayed up for > than 0 seconds (startsecs)
2020-01-19 06:12:48,080 INFO success: watchdog-script entered RUNNING state, process has stayed up for > than 0 seconds (startsecs)
2020-01-19 06:12:48,084 DEBG 'start-script' stdout output:
[warn] Username contains characters which could cause authentication issues, please consider changing this if possible
2020-01-19 06:12:48,086 DEBG 'start-script' stdout output:
[warn] Password contains characters which could cause authentication issues, please consider changing this if possible
2020-01-19 06:12:48,117 DEBG 'start-script' stdout output:
[info] Default route for container is 172.17.0.1
2020-01-19 06:12:48,120 DEBG 'start-script' stdout output:
[info] Adding 209.222.18.222 to /etc/resolv.conf
2020-01-19 06:12:48,122 DEBG 'start-script' stdout output:
[info] Adding 84.200.69.80 to /etc/resolv.conf
2020-01-19 06:12:48,124 DEBG 'start-script' stdout output:
[info] Adding 37.235.1.174 to /etc/resolv.conf
2020-01-19 06:12:48,126 DEBG 'start-script' stdout output:
[info] Adding 1.1.1.1 to /etc/resolv.conf
2020-01-19 06:12:48,128 DEBG 'start-script' stdout output:
[info] Adding 209.222.18.218 to /etc/resolv.conf
2020-01-19 06:12:48,130 DEBG 'start-script' stdout output:
[info] Adding 37.235.1.177 to /etc/resolv.conf
2020-01-19 06:12:48,133 DEBG 'start-script' stdout output:
[info] Adding 84.200.70.40 to /etc/resolv.conf
2020-01-19 06:12:48,135 DEBG 'start-script' stdout output:
[info] Adding 1.0.0.1 to /etc/resolv.conf
2020-01-19 06:12:48,530 DEBG 'start-script' stdout output:
[info] Attempting to load iptable_mangle module...
2020-01-19 06:12:48,531 DEBG 'start-script' stderr output:
modprobe: FATAL: Module iptable_mangle not found in directory /lib/modules/4.19.94-Unraid
2020-01-19 06:12:48,531 DEBG 'start-script' stdout output:
[warn] Unable to load iptable_mangle module using modprobe, trying insmod...
2020-01-19 06:12:48,532 DEBG 'start-script' stderr output:
insmod: ERROR: could not load module /lib/modules/iptable_mangle.ko: No such file or directory
2020-01-19 06:12:48,532 DEBG 'start-script' stdout output:
[warn] Unable to load iptable_mangle module, you will not be able to connect to the applications Web UI or Privoxy outside of your LAN
[info] unRAID/Ubuntu users: Please attempt to load the module by executing the following on your host: '/sbin/modprobe iptable_mangle'
[info] Synology users: Please attempt to load the module by executing the following on your host: 'insmod /lib/modules/iptable_mangle.ko'
2020-01-19 06:12:48,543 DEBG 'start-script' stdout output:
[info] Docker network defined as 172.17.0.0/16
2020-01-19 06:12:48,546 DEBG 'start-script' stdout output:
[info] Adding 10.0.1.0/24 as route via docker eth0
2020-01-19 06:12:48,546 DEBG 'start-script' stdout output:
[info] ip route defined as follows...
--------------------
2020-01-19 06:12:48,547 DEBG 'start-script' stdout output:
default via 172.17.0.1 dev eth0
10.0.1.0/24 via 172.17.0.1 dev eth0
172.17.0.0/16 dev eth0 proto kernel scope link src 172.17.0.2
2020-01-19 06:12:48,547 DEBG 'start-script' stdout output:
--------------------
2020-01-19 06:12:48,574 DEBG 'start-script' stdout output:
[info] iptables defined as follows...
--------------------
2020-01-19 06:12:48,575 DEBG 'start-script' stdout output:
-P INPUT DROP
-P FORWARD DROP
-P OUTPUT DROP
-A INPUT -s 172.17.0.0/16 -d 172.17.0.0/16 -j ACCEPT
-A INPUT -i eth0 -p tcp -m tcp --sport 1912 -j ACCEPT
-A INPUT -i eth0 -p tcp -m tcp --dport 8112 -j ACCEPT
-A INPUT -i eth0 -p tcp -m tcp --sport 8112 -j ACCEPT
-A INPUT -s 10.0.1.0/24 -i eth0 -p tcp -m tcp --dport 58846 -j ACCEPT
-A INPUT -s 10.0.1.0/24 -d 172.17.0.0/16 -i eth0 -p tcp -j ACCEPT
-A INPUT -p icmp -m icmp --icmp-type 0 -j ACCEPT
-A INPUT -i lo -j ACCEPT
-A INPUT -i tun0 -j ACCEPT
-A OUTPUT -s 172.17.0.0/16 -d 172.17.0.0/16 -j ACCEPT
-A OUTPUT -o eth0 -p tcp -m tcp --dport 1912 -j ACCEPT
-A OUTPUT -o eth0 -p tcp -m tcp --dport 8112 -j ACCEPT
-A OUTPUT -o eth0 -p tcp -m tcp --sport 8112 -j ACCEPT
-A OUTPUT -d 10.0.1.0/24 -o eth0 -p tcp -m tcp --sport 58846 -j ACCEPT
-A OUTPUT -s 172.17.0.0/16 -d 10.0.1.0/24 -o eth0 -p tcp -j ACCEPT
-A OUTPUT -p icmp -m icmp --icmp-type 8 -j ACCEPT
-A OUTPUT -o lo -j ACCEPT
-A OUTPUT -o tun0 -j ACCEPT
2020-01-19 06:12:48,576 DEBG 'start-script' stdout output:
--------------------
2020-01-19 06:12:48,578 DEBG 'start-script' stdout output:
[info] Starting OpenVPN...
2020-01-19 06:12:48,588 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:48 2020 WARNING: file 'credentials.conf' is group or others accessible
Sun Jan 19 06:12:48 2020 OpenVPN 2.4.8 [git:makepkg/3976acda9bf10b5e+] x86_64-pc-linux-gnu [SSL (OpenSSL)] [LZO] [LZ4] [EPOLL] [PKCS11] [MH/PKTINFO] [AEAD] built on Oct 30 2019
Sun Jan 19 06:12:48 2020 library versions: OpenSSL 1.1.1d 10 Sep 2019, LZO 2.10
2020-01-19 06:12:48,589 DEBG 'start-script' stdout output:
[info] OpenVPN started
2020-01-19 06:12:48,589 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:48 2020 NOTE: the current --script-security setting may allow this configuration to call user-defined scripts
Sun Jan 19 06:12:48 2020 NOTE: --fast-io is disabled since we are not using UDP
2020-01-19 06:12:48,590 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:48 2020 Outgoing Control Channel Authentication: Using 256 bit message hash 'SHA256' for HMAC authentication
Sun Jan 19 06:12:48 2020 Incoming Control Channel Authentication: Using 256 bit message hash 'SHA256' for HMAC authentication
2020-01-19 06:12:48,591 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:48 2020 TCP/UDP: Preserving recently used remote address: [AF_INET]66.154.116.194:1912
Sun Jan 19 06:12:48 2020 Socket Buffers: R=[87380->786432] S=[65536->786432]
Sun Jan 19 06:12:48 2020 Attempting to establish TCP connection with [AF_INET]66.154.116.194:1912 [nonblock]
2020-01-19 06:12:49,591 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:49 2020 TCP connection established with [AF_INET]66.154.116.194:1912
Sun Jan 19 06:12:49 2020 TCP_CLIENT link local: (not bound)
Sun Jan 19 06:12:49 2020 TCP_CLIENT link remote: [AF_INET]66.154.116.194:1912
2020-01-19 06:12:49,612 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:49 2020 TLS: Initial packet from [AF_INET]66.154.116.194:1912, sid=f973ec9c 0ae5f3c5
2020-01-19 06:12:49,728 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:49 2020 VERIFY OK: depth=1, CN=TG-VPN-CA
2020-01-19 06:12:49,729 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:49 2020 VERIFY KU OK
Sun Jan 19 06:12:49 2020 Validating certificate extended key usage
Sun Jan 19 06:12:49 2020 ++ Certificate has EKU (str) TLS Web Server Authentication, expects TLS Web Server Authentication
Sun Jan 19 06:12:49 2020 VERIFY EKU OK
Sun Jan 19 06:12:49 2020 VERIFY OK: depth=0, CN=server
2020-01-19 06:12:49,985 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:49 2020 WARNING: 'link-mtu' is used inconsistently, local='link-mtu 1584', remote='link-mtu 1571'
Sun Jan 19 06:12:49 2020 WARNING: 'tun-mtu' is used inconsistently, local='tun-mtu 1532', remote='tun-mtu 1500'
Sun Jan 19 06:12:49 2020 WARNING: 'comp-lzo' is present in local config but missing in remote config, local='comp-lzo'
Sun Jan 19 06:12:49 2020 WARNING: 'cipher' is used inconsistently, local='cipher AES-256-GCM', remote='cipher AES-128-CBC'
Sun Jan 19 06:12:49 2020 WARNING: 'auth' is used inconsistently, local='auth [null-digest]', remote='auth SHA256'
Sun Jan 19 06:12:49 2020 WARNING: 'keysize' is used inconsistently, local='keysize 256', remote='keysize 128'
2020-01-19 06:12:49,985 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:49 2020 Control Channel: TLSv1.2, cipher TLSv1.2 DHE-RSA-AES256-GCM-SHA384, 2048 bit RSA
Sun Jan 19 06:12:49 2020 [server] Peer Connection Initiated with [AF_INET]66.154.116.194:1912
2020-01-19 06:12:51,014 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 SENT CONTROL [server]: 'PUSH_REQUEST' (status=1)
2020-01-19 06:12:51,034 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 PUSH: Received control message: 'PUSH_REPLY,redirect-gateway def1,dhcp-option DNS 10.9.0.1,dhcp-option DNS 10.8.0.1,sndbuf 524288,rcvbuf 524288,route 10.34.0.1,topology net30,ping 5,ping-restart 30,socket-flags TCP_NODELAY,compress,ifconfig 10.34.0.6 10.34.0.5,peer-id 0'
2020-01-19 06:12:51,034 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 OPTIONS IMPORT: timers and/or timeouts modified
Sun Jan 19 06:12:51 2020 OPTIONS IMPORT: compression parms modified
Sun Jan 19 06:12:51 2020 OPTIONS IMPORT: --sndbuf/--rcvbuf options modified
Sun Jan 19 06:12:51 2020 Socket Buffers: R=[786432->1048576] S=[786432->1048576]
Sun Jan 19 06:12:51 2020 OPTIONS IMPORT: --socket-flags option modified
Sun Jan 19 06:12:51 2020 Socket flags: TCP_NODELAY=1 succeeded
Sun Jan 19 06:12:51 2020 OPTIONS IMPORT: --ifconfig/up options modified
Sun Jan 19 06:12:51 2020 OPTIONS IMPORT: route options modified
Sun Jan 19 06:12:51 2020 OPTIONS IMPORT: --ip-win32 and/or --dhcp-option options modified
Sun Jan 19 06:12:51 2020 OPTIONS IMPORT: peer-id set
Sun Jan 19 06:12:51 2020 OPTIONS IMPORT: adjusting link_mtu to 1659
Sun Jan 19 06:12:51 2020 Outgoing Data Channel: Cipher 'AES-256-GCM' initialized with 256 bit key
Sun Jan 19 06:12:51 2020 Incoming Data Channel: Cipher 'AES-256-GCM' initialized with 256 bit key
Sun Jan 19 06:12:51 2020 ROUTE_GATEWAY 172.17.0.1/255.255.0.0 IFACE=eth0 HWADDR=02:42:ac:11:00:02
2020-01-19 06:12:51,035 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 TUN/TAP device tun0 opened
Sun Jan 19 06:12:51 2020 TUN/TAP TX queue length set to 100
Sun Jan 19 06:12:51 2020 /usr/bin/ip link set dev tun0 up mtu 1500
2020-01-19 06:12:51,035 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 /usr/bin/ip addr add dev tun0 local 10.34.0.6 peer 10.34.0.5
2020-01-19 06:12:51,038 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 /root/openvpnup.sh tun0 1500 1587 10.34.0.6 10.34.0.5 init
2020-01-19 06:12:51,040 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 /usr/bin/ip route add 66.154.116.194/32 via 172.17.0.1
2020-01-19 06:12:51,041 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 /usr/bin/ip route add 0.0.0.0/1 via 10.34.0.5
2020-01-19 06:12:51,042 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 /usr/bin/ip route add 128.0.0.0/1 via 10.34.0.5
2020-01-19 06:12:51,043 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 /usr/bin/ip route add 10.34.0.1/32 via 10.34.0.5
2020-01-19 06:12:51,044 DEBG 'start-script' stdout output:
Sun Jan 19 06:12:51 2020 Initialization Sequence Completed
2020-01-19 06:12:51,154 DEBG 'start-script' stdout output:
[info] Application does not require port forwarding or VPN provider is != pia, skipping incoming port assignment
2020-01-19 06:12:51,155 DEBG 'start-script' stdout output:
[info] Checking we can resolve name 'www.google.com' to address...
2020-01-19 06:12:51,341 DEBG 'start-script' stdout output:
[info] DNS operational, we can resolve name 'www.google.com' to address '216.239.34.117 216.239.38.117 216.239.32.117 216.239.36.117'
2020-01-19 06:12:51,343 DEBG 'start-script' stdout output:
[info] Attempting to get external IP using Name Server 'ns1.google.com'...
2020-01-19 06:12:51,749 DEBG 'start-script' stdout output:
[info] Successfully retrieved external IP address 66.154.116.194
2020-01-19 06:12:51,825 DEBG 'watchdog-script' stdout output:
[info] Deluge listening interface IP 0.0.0.0 and VPN provider IP 10.34.0.6 different, marking for reconfigure
2020-01-19 06:12:51,827 DEBG 'watchdog-script' stdout output:
[info] Deluge not running
2020-01-19 06:12:51,829 DEBG 'watchdog-script' stdout output:
[info] Deluge Web UI not running
2020-01-19 06:12:51,832 DEBG 'watchdog-script' stdout output:
[info] Privoxy not running
2020-01-19 06:12:51,832 DEBG 'watchdog-script' stdout output:
[info] Attempting to start Deluge...
[info] Removing deluge pid file (if it exists)...
2020-01-19 06:12:51,958 DEBG 'watchdog-script' stdout output:
[info] Deluge key 'listen_interface' currently has a value of '10.34.0.6'
[info] Deluge key 'listen_interface' will have a new value '10.34.0.6'
[info] Writing changes to Deluge config file '/config/core.conf'...
2020-01-19 06:12:52,105 DEBG 'watchdog-script' stdout output:
[info] Deluge key 'outgoing_interface' currently has a value of 'tun0'
[info] Deluge key 'outgoing_interface' will have a new value 'tun0'
[info] Writing changes to Deluge config file '/config/core.conf'...
2020-01-19 06:12:52,340 DEBG 'watchdog-script' stdout output:
[info] Deluge process started
[info] Waiting for Deluge process to start listening on port 58846...
2020-01-19 06:12:52,556 DEBG 'watchdog-script' stdout output:
[info] Deluge process listening on port 58846
2020-01-19 06:12:52,759 DEBG 'watchdog-script' stderr output:
Unable to initialize gettext/locale!
2020-01-19 06:12:52,759 DEBG 'watchdog-script' stderr output:
'ngettext'
Traceback (most recent call last):
File "/usr/lib/python3.8/site-packages/deluge/i18n/util.py", line 118, in setup_translation
builtins.__dict__['_n'] = builtins.__dict__['ngettext']
KeyError: 'ngettext'