Back UPS 1500 issues

[katit]

Hello!

My new FreeNAS box finally works and I happy to report success.
Now I got my APC connected and configured and I see following in logs:

Code:

Sep 23 00:00:00 HOME-NAS newsyslog[36349]: logfile turned over due to size>100K
Sep 23 00:00:00 HOME-NAS syslog-ng[1902]: Configuration reload request received, reloading configuration;
Sep 23 03:03:16 HOME-NAS upsd[2566]: Data for UPS [ups] is stale - check driver
Sep 23 03:03:18 HOME-NAS upsd[2566]: UPS [ups] data is no longer stale
Sep 23 03:09:40 HOME-NAS upsd[2566]: Data for UPS [ups] is stale - check driver
Sep 23 03:09:41 HOME-NAS upsmon[2574]: Poll UPS [ups] failed - Data stale
Sep 23 03:09:41 HOME-NAS upsmon[2574]: Communications with UPS ups lost
Sep 23 03:09:42 HOME-NAS upsd[2566]: UPS [ups] data is no longer stale
Sep 23 03:09:46 HOME-NAS upsmon[2574]: Communications with UPS ups established
Sep 23 03:42:46 HOME-NAS upsd[2566]: Data for UPS [ups] is stale - check driver
Sep 23 03:42:51 HOME-NAS upsmon[2574]: Poll UPS [ups] failed - Data stale
Sep 23 03:42:51 HOME-NAS upsmon[2574]: Communications with UPS ups lost
Sep 23 03:42:54 HOME-NAS upsd[2566]: UPS [ups] data is no longer stale
Sep 23 03:42:56 HOME-NAS upsmon[2574]: Communications with UPS ups established
Sep 23 04:09:56 HOME-NAS upsd[2566]: Data for UPS [ups] is stale - check driver
Sep 23 04:09:57 HOME-NAS upsmon[2574]: Poll UPS [ups] failed - Data stale
Sep 23 04:09:57 HOME-NAS upsmon[2574]: Communications with UPS ups lost
Sep 23 04:10:02 HOME-NAS upsd[2566]: UPS [ups] data is no longer stale
Sep 23 04:10:02 HOME-NAS upsmon[2574]: Communications with UPS ups established
Sep 23 04:14:46 HOME-NAS upsd[2566]: Data for UPS [ups] is stale - check driver
Sep 23 04:14:47 HOME-NAS upsmon[2574]: Poll UPS [ups] failed - Data stale
Sep 23 04:14:47 HOME-NAS upsmon[2574]: Communications with UPS ups lost
Sep 23 04:14:50 HOME-NAS upsd[2566]: UPS [ups] data is no longer stale
Sep 23 04:14:52 HOME-NAS upsmon[2574]: Communications with UPS ups established
Sep 23 04:26:32 HOME-NAS upsd[2566]: Data for UPS [ups] is stale - check driver
Sep 23 04:26:37 HOME-NAS upsmon[2574]: Poll UPS [ups] failed - Data stale
Sep 23 04:26:37 HOME-NAS upsmon[2574]: Communications with UPS ups lost
Sep 23 04:26:38 HOME-NAS upsd[2566]: UPS [ups] data is no longer stale
Sep 23 04:26:42 HOME-NAS upsmon[2574]: Communications with UPS ups established

This is how config looks like. Not sure what is wrong?

 

[dlavigne]

Which build of FreeNAS (from System -> Information)?

What is the exact model of UPS and is it USB or serial?

 

[katit]

Latest build:
S-9.3-STABLE-201509220011
It's USB connection (from RJ45 on UPS to USB on FreeNAS)

It's Back-UPS Pro 1500
And I use this driver: "APC ups 2 Back-UPS Pro USB USB (usbhid-ups)"

 

[dlavigne]

Interesting. According to https://forums.freenas.org/index.php?threads/ups-recomendations.23298/#post-194000 it should work...

 

[katit]

It works, I guess. But those warnings occasionaly pollute console output

 

[tvsjr]

In auxiliary parameters, try adding:
MAXAGE=30

I don't have experience directly with this on FreeNAS, but have seen similar threads related to pfSense. Basically, the UPS isn't getting polled fast enough to keep NUT happy (at least with default config). This switch should allow 30 seconds before the data is marked stale, which should still be plenty fast enough to detect a power loss and shut down your NAS cleanly (if not, you need a bigger UPS!)

 

[katit]

Tried that, but after service restart I started to get those messages:

Code:

psmon[11371]: Poll UPS [ups] failed - Driver not connected
Sep 26 11:08:43 HOME-NAS upsmon[11371]: Poll UPS [ups] failed - Driver not connected
Sep 26 11:08:48 HOME-NAS upsmon[11371]: Poll UPS [ups] failed - Driver not connected
Sep 26 11:08:53 HOME-NAS upsmon[11371]: Poll UPS [ups] failed - Driver not connected
Sep 26 11:08:58 HOME-NAS upsmon[11371]: Poll UPS [ups] failed - Driver not connected

 

[BigDave]

In auxiliary parameters, try adding:
MAXAGE=30

I don't have experience directly with this on FreeNAS, but have seen similar threads related to pfSense. Basically, the UPS isn't getting polled fast enough to keep NUT happy (at least with default config). This switch should allow 30 seconds before the data is marked stale, which should still be plenty fast enough to detect a power loss and shut down your NAS cleanly (if not, you need a bigger UPS!)

IIRC that workaround does not survive a re-boot.

 

[BigDave]

I found a reference here.

edit: fixed link to point to relevant post, sorry

 

[katit]

I'm not 100% what is that topic about. So, can I fix this somehow?