DHCP on WAN suddenly started failing
-
Short version: I have pfsense configured behind my work's VPN appliance at home. Pfsense DHCP's an address on its WAN interface from the VPN device. This has been working fine for a long, long time. After upgrading to pfsense 2.0.2 a few days ago, we had a power outage this morning and all my gear rebooted when power came back. After this reboot, pfsense will no longer successfully DHCP from the VPN device (although other devices will DHPC from that VPN device just fine).
More details:
I've been running pfsense for quite a long time (a few years?) and it's been great; many thanks for a wonderful product.
My pfsense box is an old Dell desktop with 2 NICs in it. It sits behind my work VPN hardware appliance (a Cisco 891 VPN router). The upstream/WAN link from pfsense DHCPs from the Cisco 891. This has been working fine for a long, long time.
After the power outage-induced reboot, I couldn't get upstream anymore from the network behind pfsense. However, if I unplugged pfsense from the 891 and plugged a laptop directly into the 891, the laptop is able to DHCP just fine and then get out to the greater VPN/intranet/internet.
After doing some troubleshooting with pfsense, I can see that it is not DHCP'ing successfully from the 891 (see logs, below). If I configure the pfsense WAN interface to be static and give it an IP address in the right range and the correct default gateway route, then everything in works fine (i.e., I can continue using the network behind my pfsense box as I have for a long time).
Here's the system logs from pfsense unsuccessfully trying to DHCP to the Cisco 891 (read from the bottom to the top):
Dec 31 11:28:34 dhclient[23198]: bound: renewal in 2640 seconds.
Dec 31 11:28:34 dhclient: Deleting old routes
Dec 31 11:28:34 miniupnpd[46228]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=15): No route to host
Dec 31 11:28:34 miniupnpd[46228]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=15): No route to host
Dec 31 11:28:23 dhclient: New Routers (sk0): 10.0.2.1
Dec 31 11:28:22 dhclient: New Routers (sk0): 10.0.2.1
Dec 31 11:28:22 dhclient: New Broadcast Address (sk0): 10.0.2.255
Dec 31 11:28:22 dhclient: New Subnet Mask (sk0): 255.255.255.0
Dec 31 11:28:22 dhclient: New IP Address (sk0): 10.0.2.3
Dec 31 11:28:22 miniupnpd[46228]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=15): No route to host
Dec 31 11:28:22 miniupnpd[46228]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=15): No route to host
Dec 31 11:28:22 miniupnpd[46228]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=15): No route to host
Dec 31 11:28:22 miniupnpd[46228]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=15): No route to host
Dec 31 11:28:22 dhclient: ifconfig sk0 inet 10.0.2.3 netmask 255.255.255.0 broadcast 10.0.2.255
Dec 31 11:28:22 dhclient: Starting add_new_address()
Dec 31 11:28:22 dhclient: TIMEOUT
Dec 31 11:28:22 dhclient[23198]: Trying recorded lease 10.0.2.3
Dec 31 11:28:22 dhclient[23198]: No DHCPOFFERS received.
Dec 31 11:28:12 dhclient[23198]: DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 10
Dec 31 11:28:04 sshd[58005]: Accepted keyboard-interactive/pam for admin from 192.168.10.8 port 51430 ssh2
Dec 31 11:28:02 dhclient[23198]: DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 10
Dec 31 11:27:54 dhclient[23198]: DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 8
Dec 31 11:27:44 dhclient[23198]: DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 10
Dec 31 11:27:34 dhclient[23198]: DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 10
Dec 31 11:27:28 dhclient[23198]: DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 6
Dec 31 11:27:23 dhclient[23198]: DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 5
Dec 31 11:27:21 dhclient[23198]: DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 2
Dec 31 11:27:13 dhclient[23198]: DHCPREQUEST on sk0 to 255.255.255.255 port 67
Dec 31 11:27:09 dhclient[23198]: DHCPREQUEST on sk0 to 255.255.255.255 port 67
Dec 31 11:27:09 dhclient[23198]: DHCPREQUEST on sk0 to 255.255.255.255 port 67
Dec 31 11:27:09 miniupnpd[46228]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=15): No route to host
Dec 31 11:27:09 miniupnpd[46228]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=15): No route to host
Dec 31 11:27:09 kernel: sk0: link state changed to UP
Dec 31 11:27:09 dhclient: PREINIT
Dec 31 11:27:07 kernel: sk0: link state changed to DOWN
Dec 31 11:27:07 php: : HOTPLUG: Configuring interface wanNote that 10.0.2.3 is the last IP address that it was able to DHCP, so it seems to fail to DHCP and then say "heck with it, let's try the last DHCP lease IP address that I had before: 10.0.2.3".
But that doesn't even seem to work. Specifically, if I ssh in to the pfsense box and look at the ifconfig for sk0 (my WAN link) from the shell prompt, its IPv4 address is not set:
sk0: flags=8843 <up,broadcast,running,simplex,multicast>metric 0 mtu 1500
options=8000b <rxcsum,txcsum,vlan_mtu,linkstate>ether 00:26:5a:05:aa:82
inet6 fe80::226:5aff:fe05:aa82%sk0 prefixlen 64 scopeid 0x1
nd6 options=43 <performnud,accept_rtadv>media: Ethernet autoselect (100baseTX <full-duplex>)
status: active(and, of course, while it's trying to DHCP, if I "ifconfig sk0", it shows the IPv4 IP/inet address as 0.0.0.0 (which seems normal).)
As I mentioned above, I can physically plug other devices into the Cisco 891 and they will DHCP successfully (e.g., they'll get 10.0.2.4, 10.0.2.5, …etc.). So the 891's DHCP capabilities seem to be working ok. This implies that it may be pfsense that is failing to DHCP properly.
I can certainly run with my pfsense WAN link set to a static IP address, but that's a little less than optimal (e.g., in case the IT guys ever decide to change the DHCP address range on my Cisco 891).
Did something change in 2.0.2 that might cause the DHCP on my WAN link to fail, perchance? Even this would seem like an odd explanation, because after I upgraded to 2.0.2, I rebooted my pfsense box and all was still working fine...</full-duplex></performnud,accept_rtadv></rxcsum,txcsum,vlan_mtu,linkstate></up,broadcast,running,simplex,multicast>
-
Same WAN DHCP woes here - started soon after the upgrade to 2.0.2 as well. I have been running PfSense for years and this specific rig for 140+ days before I updated to 2.0.2 and never an issue.
Two times in the last 3 weeks my WAN connection has gone dead and scanning the logs points to DHCP issues. First time I rebooted and just now simply reset the WAN to DHCP on the console and it fixed it. At the time of failure I find this in the log…
Jan 18 09:53:47 php: : The command '/sbin/dhclient -c /var/etc/dhclient_wan.conf em3 > /tmp/em3_output > /tmp/em3_error_output' returned exit code '15', the output was '' Jan 18 09:53:47 dhclient[37235]: exiting. Jan 18 09:53:47 dhclient[37235]: exiting. Jan 18 09:53:47 dhclient[37235]: connection closed Jan 18 09:53:47 dhclient[37235]: connection closed Jan 18 09:53:47 php: : DEVD Ethernet detached event for wan Jan 18 09:53:47 kernel: em3: link state changed to UP Jan 18 09:53:47 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:46 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:46 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:46 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:46 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:46 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:46 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:46 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:45 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:45 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:45 check_reload_status: Linkup starting em3 Jan 18 09:53:45 kernel: em3: link state changed to DOWN Jan 18 09:53:45 kernel: arpresolve: can't allocate llinfo for 50.129.xxx.x Jan 18 09:53:45 dhclient[36947]: DHCPREQUEST on em3 to 255.255.255.255 port 67
Not sure if going back to 2.0.1 or grabbing a non stable update makes the most sense. Having an unreliable connection on this box is killing me in the interim…
-
DHCP Client is exiting soon after it starts. Perhaps it is reporting why. Please post the output of pfSense shell command```
cat /tmp/em3* -
Bump. Does anyone have any thoughts on the original problem posted in this thread? (it seems like jwu42's problem is different than mine)
-
I had a similar problem in 2.0.2 but I do not have the logs anymore as I rolled back to 2.0.1. What would happen is that when the lease expired from my cable modem it would not renew until I went into the gui and renewed it myself.
It's a shame, because 2.0.2 fixed the upnp issue I had.. but I can't use it because a reliable dhcp lease is more important.
-
You might try a 2.0.3 image:
http://snapshots.pfsense.org/FreeBSD_RELENG_8_1/i386/pfSense_RELENG_2_0/?C=M;O=D
http://snapshots.pfsense.org/FreeBSD_RELENG_8_1/amd64/pfSense_RELENG_2_0/?C=M;O=D -
I'm trying out this guy:
pfSense-Full-Update-2.0.3-PRERELEASE-i386-20130129-0807.tgzI'll let you know if I have any issues. Thanks.
-
FWIW, I don't see anything in https://github.com/bsdperimeter/pfsense/commits/RELENG_2_0?page=1 that would seem to indicate that something has changed with regards to the WAN DHCP client.
Also FWIW, I notice that if I run dhclient myself, it's just not getting anything back:
[2.0.2-RELEASE][admin@pfsense.squyres.com]/(8): dhclient -c /var/etc/dhclient_wan.conf -d sk0 dhclient: PREINIT DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 1 DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 1 DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 2 DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 3 DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 8 DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 13 DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 7 DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 14 DHCPDISCOVER on sk0 to 255.255.255.255 port 67 interval 12 No DHCPOFFERS received. No working leases in persistent database - sleeping.
This tends to imply that it's dhclient itself – or perhaps the driver for my NIC -- that is borked. Not pfsense core/proper.
Is there a way to tell if dhclient or the NIC driver has been updated since 2.0.1? My IP interface is sk0, if that helps identify the driver (sorry, I don't know anything about the BSD OS...).
-
I have the same problem as before in 2.0.3. my link loses the ip address and my internet is down until I renew the IP through the gui.
Below is a tail of my system.logs
Jan 31 02:56:11 pfsense kernel: arpresolve: can't allocate llinfo for 72.208.8.1
Jan 31 02:56:12 pfsense kernel: arpresolve: can't allocate llinfo for 72.208.8.1
Jan 31 02:56:12 pfsense kernel: arpresolve: can't allocate llinfo for 72.208.8.1
Jan 31 02:56:14 pfsense kernel: arpresolve: can't allocate llinfo for 72.208.8.1
Jan 31 02:56:14 pfsense kernel: arpresolve: can't allocate llinfo for 72.208.8.1
Jan 31 02:56:14 pfsense kernel: arpresolve: can't allocate llinfo for 72.208.8.1
Jan 31 02:56:15 pfsense kernel: arpresolve: can't allocate llinfo for 72.208.8.1
Jan 31 02:56:15 pfsense kernel: arpresolve: can't allocate llinfo for 72.208.8.1
Jan 31 02:56:16 pfsense kernel: arpresolve: can't allocate llinfo for 72.208.8.1Note that my internet went down several hours later, at 08:14. I don't think these are significant but i'll let you decide.. If you'd like me to get any other logs please provide me with the log location.
Thanks
Matt -
Start with the rest of the system log, especially at/near the time of the actual failure.
-
Well I'm pretty sure the time of failure was 8 am and the snippet I pasted you was the output from tail, thus the most recent. However given that it is the first thing in the morning I may be mistaken about it actually working.
Here are some other noteworthy logs I saw:
Jan 31 02:52:23 pfsense kernel: rl1: link state changed to DOWN
Jan 31 02:52:23 pfsense check_reload_status: Linkup starting rl1Jan 31 02:52:24 pfsense php: : DEVD Ethernet attached event for wan
Jan 31 02:52:24 pfsense php: : HOTPLUG: Configuring interface wanJan 31 02:52:24 pfsense check_reload_status: Reloading filter
Jan 31 02:52:25 pfsense kernel: rl1: link state changed to UP
Jan 31 02:52:25 pfsense dhclient: PREINITJan 31 02:52:25 pfsense dhclient[21193]: DHCPREQUEST on rl1 to 255.255.255.255 port 67
Jan 31 02:52:26 pfsense dhclient[21193]: DHCPREQUEST on rl1 to 255.255.255.255 port 67Jan 31 02:52:30 pfsense dhclient[21193]: DHCPREQUEST on rl1 to 255.255.255.255 port 67
Jan 31 02:52:30 pfsense php: : DEVD Ethernet detached event for wan
Jan 31 02:52:30 pfsense dhclient[21722]: connection closed
Jan 31 02:52:30 pfsense dhclient[21722]: connection closed
Jan 31 02:52:30 pfsense dhclient[21722]: exiting.
Jan 31 02:52:30 pfsense dhclient[21722]: exiting.
Jan 31 02:52:30 pfsense php: : The command '/sbin/dhclient -c /var/etc/dhclient_wan.conf rl1 > /tmp/rl1_output > /tmp/rl1_error_output' returned exit code '15', the output was ''Note that I have omitted the lines from arpresolve only.
-
And here are the details from ifconfig, so you can see which interface is what:
rl0: flags=8843 <up,broadcast,running,simplex,multicast>metric 0 mtu 1500
options=8 <vlan_mtu>ether 00:01:c0:03:dc:77
inet 192.168.0.254 netmask 0xffffff00 broadcast 192.168.0.255
inet6 fe80::201:c0ff:fe03:dc77%rl0 prefixlen 64 scopeid 0x1
nd6 options=43 <performnud,accept_rtadv>media: Ethernet autoselect (100baseTX <full-duplex>)
status: active
rl1: flags=8843 <up,broadcast,running,simplex,multicast>metric 0 mtu 1500
options=8 <vlan_mtu>ether 00:01:c0:03:d3:dc
inet6 fe80::201:c0ff:fe03:d3dc%rl1 prefixlen 64 scopeid 0x2
inet 72.208.12.250 netmask 0xfffff800 broadcast 72.208.15.255
nd6 options=43 <performnud,accept_rtadv>media: Ethernet autoselect (100baseTX <full-duplex>)
status: active</full-duplex></performnud,accept_rtadv></vlan_mtu></up,broadcast,running,simplex,multicast></full-duplex></performnud,accept_rtadv></vlan_mtu></up,broadcast,running,simplex,multicast> -
Odd that if you look at the log, it appears that the devd events are reversed for what they should be.
Jan 31 02:52:23 pfsense kernel: rl1: link state changed to DOWN Jan 31 02:52:24 pfsense php: : DEVD Ethernet attached event for wan Jan 31 02:52:24 pfsense php: : HOTPLUG: Configuring interface wan Jan 31 02:52:25 pfsense kernel: rl1: link state changed to UP Jan 31 02:52:30 pfsense php: : DEVD Ethernet detached event for wan
Though when I test that on my VM with em NICs, it gets it right.
Can you watch the log and see if when you unplug the NIC it does the same thing each time?
When you unplug it should log an "ethernet detached" event.
When you plug it in, it should log an "ethernet attached" event. -
It's happening to me as well on 2.0.3 (just as it is on 2.1). Log below is in reverse time order:
Feb 3 11:19:21 kernel: arpresolve: can't allocate llinfo for 75.131.112.1 Feb 3 11:19:15 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:15 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:15 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:15 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:15 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:19:15 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:19:14 kernel: em0: link state changed to UP Feb 3 11:19:14 php: : The command '/sbin/dhclient -c /var/etc/dhclient_wan.conf em0 > /tmp/em0_output > /tmp/em0_error_output' returned exit code '15', the output was '' Feb 3 11:19:14 dhclient[40067]: exiting. Feb 3 11:19:14 dhclient[40067]: exiting. Feb 3 11:19:14 dhclient[40067]: connection closed Feb 3 11:19:14 dhclient[40067]: connection closed Feb 3 11:19:14 php: : DEVD Ethernet detached event for wan Feb 3 11:19:12 kernel: em0: link state changed to DOWN Feb 3 11:19:12 check_reload_status: Linkup starting em0 Feb 3 11:19:12 dhclient[39818]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 11:19:10 kernel: arpresolve: can't allocate llinfo for 75.131.112.1 Feb 3 11:19:10 dhclient[39818]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 11:19:10 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:19:10 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:19:10 dhclient: PREINIT Feb 3 11:19:10 php: : HOTPLUG: Configuring interface wan Feb 3 11:19:10 php: : DEVD Ethernet attached event for wan
-
I suspect @swinn:
Feb 3 11:19:14 kernel: em0: link state changed to UP
should have triggered a restart of dhclient. There is no sign of that happening, but that might be because you didn't show enough of the log file.
Because the previous incarnation of dhclient exited and dhclient (apparently) wasn't restarted it appears there is no running dhclient to issue a DHCP request for configuration.
MAYBE there are too many link state transitions in too short a period.
-
Here is the log from the time the interface went down to the time I logged in and pressed the renew dhcp button. This is in reverse order again:
Feb 3 14:21:08 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:21:08 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:21:08 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:21:08 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:13:53 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:13:53 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:13:53 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:13:53 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:13:53 miniupnpd[53901]: upnp_event_recv: recv(): Connection reset by peer Feb 3 14:13:53 miniupnpd[53901]: upnp_event_recv: recv(): Connection reset by peer Feb 3 14:06:47 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:06:47 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:06:47 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:06:47 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:06:46 miniupnpd[53901]: upnp_event_recv: recv(): Connection reset by peer Feb 3 14:06:46 miniupnpd[53901]: upnp_event_recv: recv(): Connection reset by peer Feb 3 14:05:29 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:05:29 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:05:29 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:05:29 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:05:29 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:05:29 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:05:29 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 14:05:29 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:57:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:57:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:57:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:57:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:56:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:56:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:56:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:56:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:56:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:56:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:56:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:56:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:52:52 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:52:52 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:52:52 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:52:52 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:52:12 miniupnpd[53901]: upnp_event_send: send(): Broken pipe Feb 3 13:52:12 miniupnpd[53901]: upnp_event_send: send(): Broken pipe Feb 3 13:52:12 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:52:12 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:52:12 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:52:12 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:51:03 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 13:51:03 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 13:51:02 kernel: em0: link state changed to UP Feb 3 13:51:02 php: : The command '/sbin/dhclient -c /var/etc/dhclient_wan.conf em0 > /tmp/em0_output > /tmp/em0_error_output' returned exit code '15', the output was '' Feb 3 13:51:02 dhclient[50586]: exiting. Feb 3 13:51:02 dhclient[50586]: exiting. Feb 3 13:51:02 dhclient[50586]: connection closed Feb 3 13:51:02 dhclient[50586]: connection closed Feb 3 13:51:02 php: : DEVD Ethernet detached event for wan Feb 3 13:51:00 dhclient[50273]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 13:50:59 kernel: em0: link state changed to DOWN Feb 3 13:50:59 check_reload_status: Linkup starting em0 Feb 3 13:50:59 dhclient[50273]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 13:50:58 dhclient[50273]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 13:50:57 dhclient[50273]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 13:50:57 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 13:50:57 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 13:50:57 dhclient: PREINIT Feb 3 13:50:57 php: : HOTPLUG: Configuring interface wan Feb 3 13:50:57 php: : DEVD Ethernet attached event for wan Feb 3 13:50:55 kernel: em0: link state changed to UP Feb 3 13:50:55 check_reload_status: Linkup starting em0 Feb 3 13:50:44 php: : DEVD Ethernet detached event for wan Feb 3 13:50:42 kernel: em0: link state changed to DOWN Feb 3 13:50:42 check_reload_status: Linkup starting em0 Feb 3 13:47:20 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:47:20 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:47:20 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:47:20 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:38:45 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:38:45 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:38:45 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:38:45 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:38:45 miniupnpd[53901]: upnp_event_recv: recv(): Connection reset by peer Feb 3 13:38:45 miniupnpd[53901]: upnp_event_recv: recv(): Connection reset by peer Feb 3 13:38:33 dnsmasq[37297]: read /etc/hosts - 21 addresses Feb 3 13:32:53 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:32:53 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:32:53 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:32:53 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:32:53 miniupnpd[53901]: upnp_event_recv: recv(): Connection reset by peer Feb 3 13:32:53 miniupnpd[53901]: upnp_event_recv: recv(): Connection reset by peer Feb 3 13:18:16 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:18:16 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:18:16 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:18:16 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:11:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:11:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:11:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:11:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:02:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:02:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:02:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 13:02:04 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:47:55 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:47:55 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:47:55 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:47:55 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:41:35 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:41:35 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:41:35 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:41:35 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:36:14 dnsmasq[37297]: read /etc/hosts - 21 addresses Feb 3 12:32:50 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:32:50 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:32:50 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:32:50 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:30:54 php: : /etc/rc.update_urltables: pfBlockerSpamhausEDrop does not need updated. Feb 3 12:30:54 php: : /etc/rc.update_urltables: pfBlockerBluetackDShield does not need updated. Feb 3 12:30:54 php: : /etc/rc.update_urltables: pfBlockerBluetackHijacked does not need updated. Feb 3 12:30:54 php: : /etc/rc.update_urltables: pfBlockerZeusBlocklist does not need updated. Feb 3 12:30:54 php: : /etc/rc.update_urltables: pfBlockerDShieldAttackers does not need updated. Feb 3 12:30:54 php: : /etc/rc.update_urltables: pfBlockerSpamhausDrop does not need updated. Feb 3 12:30:54 php: : /etc/rc.update_urltables: pfBlockerTopSpammers does not need updated. Feb 3 12:30:54 php: : /etc/rc.update_urltables: pfBlockerEurope does not need updated. Feb 3 12:30:54 php: : /etc/rc.update_urltables: pfBlockerAsia does not need updated. Feb 3 12:30:54 php: : /etc/rc.update_urltables: pfBlockerAfrica does not need updated. Feb 3 12:30:54 php: : /etc/rc.update_urltables: Starting URL table alias updates Feb 3 12:30:00 php: : /etc/rc.update_urltables: Sleeping for 54 seconds. Feb 3 12:30:00 php: : /etc/rc.update_urltables: Starting up. Feb 3 12:28:19 miniupnpd[53901]: HTTP Connection closed unexpectedly Feb 3 12:28:19 miniupnpd[53901]: HTTP Connection closed unexpectedly Feb 3 12:27:08 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:27:08 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:27:08 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 12:27:08 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:47:31 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:47:31 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:47:30 kernel: em0: link state changed to UP Feb 3 11:47:30 php: : The command '/sbin/dhclient -c /var/etc/dhclient_wan.conf em0 > /tmp/em0_output > /tmp/em0_error_output' returned exit code '15', the output was '' Feb 3 11:47:30 dhclient[21788]: exiting. Feb 3 11:47:30 dhclient[21788]: exiting. Feb 3 11:47:30 dhclient[21788]: connection closed Feb 3 11:47:30 dhclient[21788]: connection closed Feb 3 11:47:30 php: : DEVD Ethernet detached event for wan Feb 3 11:47:29 dhclient[21773]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 11:47:28 kernel: em0: link state changed to DOWN Feb 3 11:47:28 check_reload_status: Linkup starting em0 Feb 3 11:47:27 dhclient[21773]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 11:47:26 dhclient[21773]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 11:47:26 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:47:26 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:47:26 dhclient: PREINIT Feb 3 11:47:26 php: : HOTPLUG: Configuring interface wan Feb 3 11:47:26 php: : DEVD Ethernet attached event for wan Feb 3 11:47:23 kernel: em0: link state changed to UP Feb 3 11:47:23 check_reload_status: Linkup starting em0 Feb 3 11:47:12 php: : DEVD Ethernet detached event for wan Feb 3 11:47:10 kernel: em0: link state changed to DOWN Feb 3 11:47:10 check_reload_status: Linkup starting em0 Feb 3 11:36:38 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:36:38 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:36:38 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:36:38 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:36:38 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:36:38 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:30:21 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:30:21 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:30:20 kernel: em0: link state changed to UP Feb 3 11:30:20 php: : The command '/sbin/dhclient -c /var/etc/dhclient_wan.conf em0 > /tmp/em0_output > /tmp/em0_error_output' returned exit code '15', the output was '' Feb 3 11:30:20 dhclient[32235]: exiting. Feb 3 11:30:20 dhclient[32235]: exiting. Feb 3 11:30:20 dhclient[32235]: connection closed Feb 3 11:30:20 dhclient[32235]: connection closed Feb 3 11:30:20 php: : DEVD Ethernet detached event for wan Feb 3 11:30:19 dhclient[31973]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 11:30:18 kernel: em0: link state changed to DOWN Feb 3 11:30:18 check_reload_status: Linkup starting em0 Feb 3 11:30:17 dhclient[31973]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 11:30:16 dhclient[31973]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 11:30:16 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:30:16 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:30:16 dhclient: PREINIT Feb 3 11:30:16 php: : HOTPLUG: Configuring interface wan Feb 3 11:30:16 php: : DEVD Ethernet attached event for wan Feb 3 11:30:13 kernel: em0: link state changed to UP Feb 3 11:30:13 check_reload_status: Linkup starting em0 Feb 3 11:30:03 php: : DEVD Ethernet detached event for wan Feb 3 11:30:00 kernel: em0: link state changed to DOWN Feb 3 11:30:00 check_reload_status: Linkup starting em0 Feb 3 11:25:20 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:24:16 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:23:12 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:22:35 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:22:32 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:22:32 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:22:32 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:22:32 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:22:32 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:22:32 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:22:31 dnsmasq[37297]: read /etc/hosts - 20 addresses Feb 3 11:22:08 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:21:47 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:21:04 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:21:03 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:21:03 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:21:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:21:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:20:59 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:20:14 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:20:11 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:20:10 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:50 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:49 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:36 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:30 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:30 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:26 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:23 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:23 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:22 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:21 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:21 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:21 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:21 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:21 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:21 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:15 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:15 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:15 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:15 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:15 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:19:15 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:19:14 kernel: em0: link state changed to UP Feb 3 11:19:14 php: : The command '/sbin/dhclient -c /var/etc/dhclient_wan.conf em0 > /tmp/em0_output > /tmp/em0_error_output' returned exit code '15', the output was '' Feb 3 11:19:14 dhclient[40067]: exiting. Feb 3 11:19:14 dhclient[40067]: exiting. Feb 3 11:19:14 dhclient[40067]: connection closed Feb 3 11:19:14 dhclient[40067]: connection closed Feb 3 11:19:14 php: : DEVD Ethernet detached event for wan Feb 3 11:19:12 kernel: em0: link state changed to DOWN Feb 3 11:19:12 check_reload_status: Linkup starting em0 Feb 3 11:19:12 dhclient[39818]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 11:19:10 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:19:10 dhclient[39818]: DHCPREQUEST on em0 to 255.255.255.255 port 67 Feb 3 11:19:10 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:19:10 miniupnpd[53901]: SendNATPMPPublicAddressChangeNotification: sendto(s_udp=14): No route to host Feb 3 11:19:10 dhclient: PREINIT Feb 3 11:19:10 php: : HOTPLUG: Configuring interface wan Feb 3 11:19:10 php: : DEVD Ethernet attached event for wan Feb 3 11:19:09 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:09 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:09 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:09 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:08 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:08 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:08 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:08 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:07 kernel: em0: link state changed to UP Feb 3 11:19:07 check_reload_status: Linkup starting em0 Feb 3 11:19:05 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:05 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:05 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:05 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:05 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:05 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:05 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:05 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:03 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:03 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:19:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:19:03 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:18:59 kernel: arpresolve: can't allocate llinfo for 75.131.xxx.xxx Feb 3 11:18:59 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:18:59 miniupnpd[53901]: Failed to get ip address for interface em0 Feb 3 11:18:59 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:18:59 miniupnpd[53901]: ioctl(s, SIOCGIFADDR, ...): Can't assign requested address Feb 3 11:18:56 dhclient[4995]: exiting. Feb 3 11:18:56 dhclient[4995]: exiting. Feb 3 11:18:56 dhclient[4995]: connection closed Feb 3 11:18:56 dhclient[4995]: connection closed Feb 3 11:18:56 php: : DEVD Ethernet detached event for wan Feb 3 11:18:54 kernel: em0: link state changed to DOWN Feb 3 11:18:54 check_reload_status: Linkup starting em0 Feb 3 11:18:47 check_reload_status: Reloading filter Feb 3 11:18:37 apinger: ALARM: WAN(75.131.xxx.xxx) *** down ***
-
I flipped these log entries around because trying to follow the flow of messages in reverse-order logs is bothersome…
Feb 3 11:19:12 kernel: em0: link state changed to DOWN Feb 3 11:19:14 php: : DEVD Ethernet detached event for wan Feb 3 11:19:14 kernel: em0: link state changed to UP
If I had to guess I'd say that the link cycled too fast and either DEVD did not fire the event to bring it back up or the event was lost somewhere in between devd and check_reload_status.
Are you spoofing a MAC on that interface? Or setting any other custom values other than the interface name and setting it for DHCP?
-
No MAC spoofing or anything unusual. It is a very basic home setup.
-
Could be something sketchy happening at the modem then…
Ermal is looking into a fix, I started a ticket here: https://redmine.pfsense.org/issues/2792
-
It looks like anytime the cable goes out or I get a T4 error (causes modem reboot), it happens. It's a Motorola 6120. We had an all out outage yesterday which caused the log I posted above. Sometimes I'll get a T4 error which causes the modem to reboot and pfSense doesn't recover. pfSense 2.0.1 would recover just fine.
I'm actually going to buy a new modem today in hopes it will fix something. If not I'll go back to 2.0.1 but wanted to remain on the newer versions to help fix it. I can't have the wife with no Internet while I'm at work - I get nasty calls :)