Jim Klimov
2023-Sep-04 22:05 UTC
[Nut-upsdev] [Nut-upsuser] PR to test for users of Qx devices (blazer and nutdrv_qx)
Hello all, Had another hard look at the PR for QX device voltage/charge/runtime fixes for some broken use-cases (AND hoping to not introduce problems for cases that were not broken), and hopefully found and rolled back the change which in fact introduced the strangeness found in our winter round of tests. Then the year was busy... As before, the context for this is: * issue https://github.com/networkupstools/nut/issues/1279 * PR https://github.com/networkupstools/nut/pull/1652 * PR source git branch (code to build for tests) https://github.com/jimklimov/nut/tree/issue-1279 * https://github.com/networkupstools/nut/wiki/Building-NUT-for-in%E2%80%90place-upgrades-or-non%E2%80%90disruptive-tests suggests how to quickly build and test a driver The new battery_voltage_reports_one_pack (introduced by the PR) could be used as a flag in ups.conf for devices which report only a smallish ~2V value in their native `battery.voltage` along with an override.battery.packs setting, where needed. The main question for testing is if your old (packaged 2.8.0 or 2.7.4, master-branch custom builds, etc.) NUT driver binaries reported *some reasonable values* (for battery voltages, charge, runtime, maybe packs), and that the tested build would report the same sort of values - e.g. no regression. And if your older NUT drivers did previously report some broken values (such as charges under 100% for well-charged UPSes, bogus "actual" battery voltage, etc.) then that the PR would fix that on its own or possibly in tandem with `ups.conf` options such as `runtimecal` and overrides discussed in that issue and PR on github. Looking forward to data points that would allow me to finally merge this PR (or understand what remains broken, if any) :) Thanks in advance, Jim Klimov On Thu, Jan 19, 2023 at 6:03?AM d tbsky <tbskyd at gmail.com> wrote:> Jim Klimov <jimklimov+nut at gmail.com> > > @tbsky: > > Can you please check if 2.7.4 also reports the huge voltages for the 3kW > and 10kW units, or something around 13.5V? Does it set "battery.packs" to > 20 or 6? > > Namely, I wonder if the new "battery_voltage_reports_one_pack" handling > (and with no such option in your configs) misfires here somehow?.. > > > > Also, can you please re-run the tests with the PR-ed branch build and > higher verbosity (e.g. `./nutdrv_qx -a ftups -DDDDDD -d1`) to help trace > whether values optionally guessed by qx_initbattery() are in fact guessed > or directly provided by respective devices (and subdrivers)?.. > > Hi: > I retest them with 2.7.4 and 2.8.x(with debugging). results below. > I hope they can reveal some information. > > 2.7.4: > 10KV: > >upsc ftups > battery.charge: 100 > battery.packs: 1 > battery.protection: yes > battery.runtime: 600 > battery.voltage: 272.90 > battery.voltage.nominal: 240.0 > device.model: G10K > device.type: ups > driver.name: nutdrv_qx > driver.parameter.bypass_when_off: disabled > driver.parameter.offdelay: 12 > driver.parameter.ondelay: 60 > driver.parameter.pollfreq: 30 > driver.parameter.pollinterval: 10 > driver.parameter.port: auto > driver.parameter.synchronous: yes > driver.version: 2.7.4 > driver.version.data: Voltronic 0.06 > driver.version.internal: 0.28 > input.current.nominal: 45.0 > input.frequency: 60.0 > input.frequency.nominal: 60.0 > input.phases: 1 > input.transfer.high: 231 > input.transfer.high.max: 244 > input.transfer.high.min: 231 > input.transfer.low: 209 > input.transfer.low.max: 209 > input.transfer.low.min: 196 > input.voltage: 218.7 > input.voltage.nominal: 230.0 > outlet.0.switchable: no > output.current: 2.8 > output.current.nominal: 45 > output.frequency: 60.0 > output.frequency.nominal: 60.0 > output.phases: 1 > output.powerfactor: 0.8 > output.voltage: 218.7 > output.voltage.nominal: 220.0 > ups.beeper.status: enabled > ups.delay.shutdown: 12 > ups.delay.start: 60 > ups.firmware: 00077.13 > ups.firmware.aux: P02 > ups.load: 7 > ups.power.nominal: 10000 > ups.productid: 5161 > ups.start.auto: yes > ups.status: OL > ups.temperature: 25.2 > ups.type: online > ups.vendorid: 0665 > > 3KV: > >upsc ftups > Init SSL without certificate database > battery.charge: 100 > battery.energysave: no > battery.packs: 1 > battery.protection: yes > battery.runtime: 2520 > battery.voltage: 82.00 > battery.voltage.nominal: 72.0 > device.model: 3K > device.type: ups > driver.name: nutdrv_qx > driver.parameter.bypass_when_off: disabled > driver.parameter.offdelay: 30 > driver.parameter.ondelay: 60 > driver.parameter.pollfreq: 30 > driver.parameter.pollinterval: 10 > driver.parameter.port: auto > driver.parameter.synchronous: yes > driver.version: 2.7.4 > driver.version.data: Voltronic 0.06 > driver.version.internal: 0.28 > input.current.nominal: 27.0 > input.frequency: 60.0 > input.frequency.nominal: 60.0 > input.phases: 1 > input.transfer.high: 116 > input.transfer.high.max: 122 > input.transfer.high.min: 113 > input.transfer.low: 104 > input.transfer.low.max: 107 > input.transfer.low.min: 98 > input.voltage: 112.6 > input.voltage.nominal: 110.0 > outlet.0.switchable: no > output.current: 5.0 > output.current.nominal: 27 > output.frequency: 60.0 > output.frequency.nominal: 60.0 > output.phases: 1 > output.power.maximum.percent: 19 > output.power.minimum.percent: 18 > output.powerfactor: 0.8 > output.voltage: 109.8 > output.voltage.nominal: 110.0 > ups.beeper.status: enabled > ups.delay.shutdown: 30 > ups.delay.start: 60 > ups.firmware: 00204.06 > ups.firmware.aux: P01 > ups.load: 19 > ups.power.nominal: 3000 > ups.productid: 5161 > ups.start.auto: yes > ups.start.battery: yes > ups.status: OL > ups.temperature: 17.3 > ups.type: online > ups.vendorid: 0665 > > 2KV: > >upsc ftups > battery.charge: 100 > battery.voltage: 13.50 > battery.voltage.high: 13.00 > battery.voltage.low: 10.40 > battery.voltage.nominal: 12.0 > device.type: ups > driver.name: nutdrv_qx > driver.parameter.bypass_when_off: disabled > driver.parameter.offdelay: 30 > driver.parameter.ondelay: 60 > driver.parameter.pollfreq: 30 > driver.parameter.pollinterval: 10 > driver.parameter.port: auto > driver.parameter.synchronous: yes > driver.version: 2.7.4 > driver.version.data: Voltronic-QS 0.07 > driver.version.internal: 0.28 > input.voltage: 120.6 > input.voltage.fault: 120.6 > output.current.nominal: 6.0 > output.frequency: 59.9 > output.frequency.nominal: 60 > output.voltage: 102.3 > output.voltage.nominal: 110 > ups.beeper.status: enabled > ups.delay.shutdown: 30 > ups.delay.start: 60 > ups.firmware.aux: PM-V > ups.load: 32 > ups.productid: 5161 > ups.status: OL TRIM > ups.type: offline / line interactive > ups.vendorid: 0665 > > 2.8.x: > 10KV: > ./nutdrv_qx -a ftups -DDDDDD -d1 > Network UPS Tools - Generic Q* USB/Serial driver 0.33 > (Windows-v2.8.0-alpha3-1252-g757813e) > USB communication driver (libusb 0.1) 0.44 > 0.000000 [D1] debug level is '6' > 0.000192 [D1] Succeeded to become_user(nut): now UID=57 GID=57 > 0.000198 [D5] send_to_all: SETINFO device.type "ups" > 0.000201 [D5] send_to_all: SETINFO driver.state "init.device" > 0.000204 [D1] upsdrv_initups... > 0.001581 [D3] usb_busses=0xf5bef0 > 0.001588 [D2] Checking device (8087/8000) (002/002) > 0.001605 [D1] Failed to open device (8087/8000), skipping: > Permission denied > 0.001611 [D2] Checking device (1D6B/0002) (002/001) > 0.001616 [D1] Failed to open device (1D6B/0002), skipping: > Permission denied > 0.001618 [D2] Checking device (8087/8008) (001/002) > 0.001622 [D1] Failed to open device (8087/8008), skipping: > Permission denied > 0.001625 [D2] Checking device (1D6B/0002) (001/001) > 0.001628 [D1] Failed to open device (1D6B/0002), skipping: > Permission denied > 0.001631 [D2] Checking device (1D6B/0003) (004/001) > 0.001635 [D1] Failed to open device (1D6B/0003), skipping: > Permission denied > 0.001637 [D2] Checking device (9966/0202) (003/003) > 0.001641 [D1] Failed to open device (9966/0202), skipping: > Permission denied > 0.001644 [D2] Checking device (0557/2419) (003/004) > 0.001648 [D1] Failed to open device (0557/2419), skipping: > Permission denied > 0.001650 [D2] Checking device (0557/7000) (003/002) > 0.001654 [D1] Failed to open device (0557/7000), skipping: > Permission denied > 0.001656 [D2] Checking device (0665/5161) (003/008) > 0.004203 [D1] libusb_open get iManufacturer failed, retrying... > 0.006463 [D1] libusb_open get iManufacturer failed, retrying... > 0.008989 [D1] libusb_open get iManufacturer failed, retrying... > 0.011261 [D1] libusb_open get iProduct failed, retrying... > 0.013722 [D1] libusb_open get iProduct failed, retrying... > 0.016049 [D1] libusb_open get iProduct failed, retrying... > 0.016053 [D2] - VendorID: 0665 > 0.016055 [D2] - ProductID: 5161 > 0.016057 [D2] - Manufacturer: unknown > 0.016059 [D2] - Product: unknown > 0.016061 [D2] - Serial Number: unknown > 0.016063 [D2] - Bus: 003 > 0.016065 [D2] - Device: 008 > 0.016067 [D2] - Device release number: 0001 > 0.016069 [D2] Trying to match device > 0.016071 [D3] match_function_regex: matching a device... > 0.016074 [D2] Device matches > 0.016087 [D3] nut_usb_set_altinterface: skipped > usb_set_altinterface(udev, 0) > 0.016091 [D5] send_to_all: SETINFO ups.vendorid "0665" > 0.016094 [D5] send_to_all: SETINFO ups.productid "5161" > 0.017431 [D3] send: QGS > 0.075931 [D5] read [ 0]: (8 bytes) => 28 32 31 36 2e 39 20 36 > 0.107929 [D5] read [ 8]: (8 bytes) => 30 2e 30 20 32 32 30 2e > 0.147930 [D5] read [ 16]: (8 bytes) => 34 20 35 39 2e 39 20 30 > 0.179924 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 > 0.219926 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 > 0.251927 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 > 0.291909 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d > 0.323924 [D5] read [ 56]: (8 bytes) => 20 30 32 35 2e 34 20 31 > 0.355924 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 0.379924 [D5] read [ 72]: (8 bytes) => 30 30 30 0d 20 32 37 32 > 0.379929 [D3] read: (216.9 60.0 220.4 59.9 002.8 007 361.8 > 361.8 272.9 ---.- 025.4 100000000000 > 0.379946 [D5] send_to_all: SETINFO input.voltage "216.9" > 0.381097 [D3] send: QPI > 0.427922 [D5] read [ 0]: (8 bytes) => 28 50 49 30 32 0d 00 00 > 0.427927 [D3] read: (PI02 > 0.427987 [D5] send_to_all: SETINFO ups.firmware.aux "P02" > 0.427990 Using protocol: Voltronic 0.07 > 0.427993 [D5] send_to_all: SETINFO driver.state "init.quiet" > 0.427997 [D5] send_to_all: SETINFO driver.version > "Windows-v2.8.0-alpha3-1252-g757813e" > 0.428000 [D5] send_to_all: SETINFO driver.version.internal "0.33" > 0.428003 [D5] send_to_all: SETINFO driver.name "nutdrv_qx" > 0.428005 [D5] send_to_all: SETINFO driver.state "init.info" > 0.428008 [D1] upsdrv_initinfo... > 0.428011 [D5] send_to_all: SETINFO driver.version.data "Voltronic > 0.07" > 0.429229 [D3] send: QRI > 0.483926 [D5] read [ 0]: (8 bytes) => 28 32 32 30 2e 30 20 30 > 0.523927 [D5] read [ 8]: (8 bytes) => 34 35 20 32 34 30 2e 30 > 0.547926 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 > 0.547931 [D3] read: (220.0 045 240.0 60.0 > 0.547940 [D5] send_to_all: SETINFO output.voltage.nominal "220.0" > 0.547946 [D5] send_to_all: SETINFO output.current.nominal "45" > 0.547950 [D5] send_to_all: SETINFO battery.voltage.nominal "240.0" > 0.547956 [D5] send_to_all: SETINFO output.frequency.nominal "60.0" > 0.549288 [D3] send: QMD > 0.603919 [D5] read [ 0]: (8 bytes) => 28 23 23 23 23 23 23 23 > 0.643924 [D5] read [ 8]: (8 bytes) => 23 23 23 23 47 31 30 4b > 0.675924 [D5] read [ 16]: (8 bytes) => 20 23 23 31 30 30 30 30 > 0.715923 [D5] read [ 24]: (8 bytes) => 20 38 30 20 31 2f 31 20 > 0.747920 [D5] read [ 32]: (8 bytes) => 32 33 30 20 32 33 30 20 > 0.787921 [D5] read [ 40]: (8 bytes) => 32 30 20 31 32 2e 30 0d > 0.787927 [D3] read: (###########G10K ##10000 80 1/1 230 230 20 12.0 > 0.787936 [D5] send_to_all: SETINFO device.model "G10K" > 0.787940 [D5] send_to_all: SETINFO ups.power.nominal "10000" > 0.787946 [D5] send_to_all: SETINFO output.powerfactor "0.8" > 0.787953 [D5] send_to_all: SETINFO input.phases "1" > 0.787957 [D5] send_to_all: SETINFO output.phases "1" > 0.787961 [D5] send_to_all: SETINFO input.voltage.nominal "230.0" > 0.789227 [D3] send: F > 0.835919 [D5] read [ 0]: (8 bytes) => 23 32 32 30 2e 30 20 30 > 0.875923 [D5] read [ 8]: (8 bytes) => 34 35 20 32 34 30 2e 30 > 0.899925 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 > 0.899931 [D3] read: #220.0 045 240.0 60.0 > 0.899939 [D5] send_to_all: SETINFO input.current.nominal "45.0" > 0.899945 [D5] send_to_all: SETINFO input.frequency.nominal "60.0" > 0.901226 [D3] send: QMF > 0.947921 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 0.947927 [D3] read: (NAK > 0.947930 [D2] qx_process_answer: query rejected by the UPS > (device.mfr) > 0.949218 [D3] send: QVFW > 1.011917 [D5] read [ 0]: (8 bytes) => 28 56 45 52 46 57 3a 30 > 1.043922 [D5] read [ 8]: (8 bytes) => 30 30 37 37 2e 31 33 0d > 1.043927 [D3] read: (VERFW:00077.13 > 1.043932 [D5] send_to_all: SETINFO ups.firmware "00077.13" > 1.045155 [D3] send: QID > 1.091916 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 1.091920 [D3] read: (NAK > 1.091923 [D2] qx_process_answer: query rejected by the UPS > (device.serial) > 1.093154 [D3] send: I > 1.139915 [D5] read [ 0]: (8 bytes) => 20 20 20 20 20 20 20 20 > 1.147922 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 > 1.147928 [D3] read: > 1.147930 [D2] qx_process_answer: short reply (device.mfr) > 1.149214 [D3] send: QGS > 1.203920 [D5] read [ 0]: (8 bytes) => 28 32 31 37 2e 38 20 35 > 1.243920 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 32 30 2e > 1.275916 [D5] read [ 16]: (8 bytes) => 34 20 36 30 2e 30 20 30 > 1.315917 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 > 1.347915 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 > 1.379917 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 > 1.419915 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d > 1.451914 [D5] read [ 56]: (8 bytes) => 20 30 32 35 2e 32 20 31 > 1.491911 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.507915 [D5] read [ 72]: (8 bytes) => 30 30 30 0d 20 32 37 32 > 1.507921 [D3] read: (217.8 59.9 220.4 60.0 002.8 007 361.8 > 361.8 272.9 ---.- 025.2 100000000000 > 1.507934 [D5] send_to_all: SETINFO input.frequency "59.9" > 1.507940 [D5] send_to_all: SETINFO output.voltage "220.4" > 1.507944 [D5] send_to_all: SETINFO output.frequency "60.0" > 1.507950 [D5] send_to_all: SETINFO output.current "2.8" > 1.507954 [D5] send_to_all: SETINFO ups.load "7" > 1.507959 [D5] send_to_all: SETINFO battery.voltage "272.9" > 1.507964 [D5] send_to_all: SETINFO ups.temperature "25.2" > 1.507971 [D5] send_to_all: SETINFO ups.type "online" > 1.507975 [D5] update_status: OL > 1.507977 [D5] update_status: !LB > 1.507984 [D5] update_status: !CAL > 1.507989 [D5] update_status: !FSD > 1.507993 [D5] send_to_all: SETINFO ups.beeper.status "enabled" > 1.509278 [D3] send: QMOD > 1.547916 [D5] read [ 0]: (8 bytes) => 28 4c 0d 00 00 00 00 00 > 1.547921 [D3] read: (L > 1.547927 [D5] update_status: OL > 1.549157 [D3] send: QWS > 1.603912 [D5] read [ 0]: (8 bytes) => 28 30 30 30 30 30 30 30 > 1.643913 [D5] read [ 8]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.675914 [D5] read [ 16]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.707913 [D5] read [ 24]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.747910 [D5] read [ 32]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.779908 [D5] read [ 40]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.819910 [D5] read [ 48]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.851911 [D5] read [ 56]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.859909 [D5] read [ 64]: (8 bytes) => 30 0d 30 30 30 30 30 30 > 1.859913 [D3] read: > (0000000000000000000000000000000000000000000000000000000000000000 > 1.861214 [D3] send: QBV > 1.915912 [D5] read [ 0]: (8 bytes) => 28 32 37 32 2e 39 20 32 > 1.955910 [D5] read [ 8]: (8 bytes) => 30 20 30 31 20 31 30 30 > 1.971911 [D5] read [ 16]: (8 bytes) => 20 30 31 30 0d 00 00 00 > 1.971916 [D3] read: (272.9 20 01 100 010 > 1.971921 battery_number: 20 > 1.971927 battery_number, settable range: 1..9 > 1.971933 [D5] send_to_all: SETINFO battery.packs "1" > 1.971936 [D5] send_to_all: SETFLAGS battery.packs RW > 1.971939 [D5] send_to_all: ADDRANGE battery.packs 1 99 > 1.971942 [D5] send_to_all: SETFLAGS battery.packs RW NUMBER > 1.971946 [D5] send_to_all: SETINFO battery.charge "100" > 1.971950 [D5] send_to_all: SETINFO battery.runtime "600" > 1.973146 [D3] send: QLDL > 2.019909 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 2.019914 [D3] read: (NAK > 2.019920 [D2] qx_process_answer: query rejected by the UPS > (output.power.minimum.percent) > 2.019923 [D2] qx_process_answer: query rejected by the UPS > (output.power.maximum.percent) > 2.021213 [D3] send: QFLAG > 2.083912 [D5] read [ 0]: (8 bytes) => 28 45 70 62 72 61 73 64 > 2.123904 [D5] read [ 8]: (8 bytes) => 74 69 44 6f 76 65 66 6a > 2.131908 [D5] read [ 16]: (8 bytes) => 6d 0d 00 00 00 00 00 00 > 2.131913 [D3] read: (EpbrasdtiDovefjm > 2.131928 [D5] send_to_all: SETINFO ups.start.auto "yes" > 2.131931 [D5] send_to_all: SETFLAGS ups.start.auto RW > 2.131935 [D5] send_to_all: ADDENUM ups.start.auto "no" > 2.131938 [D5] send_to_all: ADDENUM ups.start.auto "yes" > 2.131943 [D5] send_to_all: SETINFO battery.protection "yes" > 2.131946 [D5] send_to_all: SETFLAGS battery.protection RW > 2.131949 [D5] send_to_all: ADDENUM battery.protection "no" > 2.131951 [D5] send_to_all: ADDENUM battery.protection "yes" > 2.131956 [D4] ups_infoval_set: failed to preprocess value > [battery.energysave: EpbrasdtiDovefjm] > 2.131960 [D4] ups_infoval_set: failed to preprocess value > [ups.start.battery: EpbrasdtiDovefjm] > 2.131966 [D5] send_to_all: SETINFO outlet.0.switchable "no" > 2.131969 [D5] send_to_all: SETFLAGS outlet.0.switchable RW > 2.131972 [D5] send_to_all: ADDENUM outlet.0.switchable "no" > 2.131974 [D5] send_to_all: ADDENUM outlet.0.switchable "yes" > 2.131977 bypass_alarm: enabled > 2.131982 battery_alarm: enabled > 2.131987 bypass_when_off: disabled > 2.132000 alarm_control: enabled > 2.132003 converter_mode: disabled > 2.132021 eco_mode: disabled > 2.132025 battery_open_status_check: enabled > 2.132028 bypass_forbidding: disabled > 2.132033 [D4] ups_infoval_set: failed to preprocess value > [site_fault_detection: EpbrasdtiDovefjm] > 2.132036 [D4] ups_infoval_set: failed to preprocess value > [advanced_eco_mode: EpbrasdtiDovefjm] > 2.132039 [D4] ups_infoval_set: failed to preprocess value > [constant_phase_angle: EpbrasdtiDovefjm] > 2.132042 [D4] ups_infoval_set: failed to preprocess value > [limited_runtime_on_battery: EpbrasdtiDovefjm] > 2.132047 setvar(bypass_when_off, disabled) > 2.132049 bypass_when_off is already disabled > 2.132051 setvar: FAILED > 2.133339 [D3] send: QHE > 2.187906 [D5] read [ 0]: (8 bytes) => 28 32 33 31 20 32 30 39 > 2.195908 [D5] read [ 8]: (8 bytes) => 20 0d 00 00 00 00 00 00 > 2.195912 [D3] read: (231 209 > 2.195925 [D5] send_to_all: SETINFO input.transfer.high "231" > 2.195928 [D5] send_to_all: SETFLAGS input.transfer.high RW > 2.195931 [D5] send_to_all: ADDRANGE input.transfer.high 231 244 > 2.195933 [D5] send_to_all: SETFLAGS input.transfer.high RW NUMBER > 2.195940 [D5] send_to_all: SETINFO input.transfer.low "209" > 2.195943 [D5] send_to_all: SETFLAGS input.transfer.low RW > 2.195946 [D5] send_to_all: ADDRANGE input.transfer.low 196 209 > 2.195948 [D5] send_to_all: SETFLAGS input.transfer.low RW NUMBER > 2.195952 [D5] send_to_all: SETINFO input.transfer.low.min "196" > 2.195957 [D5] send_to_all: SETINFO input.transfer.low.max "209" > 2.195962 [D5] send_to_all: SETINFO input.transfer.high.min "231" > 2.195966 [D5] send_to_all: SETINFO input.transfer.high.max "244" > 2.197269 [D3] send: QFRE > 2.243908 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 2.243913 [D3] read: (NAK > 2.243916 [D2] qx_process_answer: query rejected by the UPS > (input.frequency.high) > 2.243919 [D2] qx_process_answer: query rejected by the UPS > (input.frequency.low) > 2.245272 [D3] send: QBYV > 2.307907 [D5] read [ 0]: (8 bytes) => 28 32 36 34 20 31 31 30 > 2.315910 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 > 2.315915 [D3] read: (264 110 > 2.315920 max_bypass_volt: 264 > 2.315927 max_bypass_volt, settable range: 231..276 > 2.315931 min_bypass_volt: 110 > 2.315936 min_bypass_volt, settable range: 110..209 > 2.317269 [D3] send: QBYF > 2.379904 [D5] read [ 0]: (8 bytes) => 28 36 34 2e 30 20 35 36 > 2.387902 [D5] read [ 8]: (8 bytes) => 2e 30 0d 00 00 00 00 00 > 2.387906 [D3] read: (64.0 56.0 > 2.387910 max_bypass_freq: 64.0 > 2.387916 max_bypass_freq, settable range: 61.0..64.0 > 2.387920 min_bypass_freq: 56.0 > 2.387924 min_bypass_freq, settable range: 56.0..59.0 > 2.387929 [D2] setvar: nothing to do... [battery_number] > 2.389143 [D3] send: RE0 > 2.619925 [D5] read [ 0]: (8 bytes) => 00 00 00 00 00 00 00 00 > 3.622015 [D3] read: Connection timed out (-110) > 3.622032 [D4] qx_process: failed to preprocess answer > [battery.voltage.low] > 3.623374 [D3] send: QPD > 3.667908 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 3.667920 [D3] read: (NAK > 3.667928 [D2] qx_process_answer: query rejected by the UPS > (input_phase_angle) > 3.667933 [D2] qx_process_answer: query rejected by the UPS > (output_phase_angle) > 3.669140 [D3] send: QPAR > 3.715928 [D5] read [ 0]: (8 bytes) => 28 30 31 0d 00 00 00 00 > 3.715940 [D3] read: (01 > ] 3.715946 [D2] voltronic_parallel: non numerical value > [voltronic_parallel: 01 > ] 3.715949 [D4] ups_infoval_set: failed to preprocess value > [voltronic_parallel: 01 > 3.715959 [D5] send_to_all: ADDCMD load.off > 3.715962 [D5] send_to_all: ADDCMD load.on > 3.715965 [D5] send_to_all: ADDCMD shutdown.return > 3.715967 [D5] send_to_all: ADDCMD shutdown.stayoff > 3.715970 [D5] send_to_all: ADDCMD shutdown.stop > 3.715973 [D5] send_to_all: ADDCMD test.battery.start > 3.715975 [D5] send_to_all: ADDCMD test.battery.start.deep > 3.715978 [D5] send_to_all: ADDCMD test.battery.start.quick > 3.715981 [D5] send_to_all: ADDCMD test.battery.stop > 3.715984 [D5] send_to_all: ADDCMD beeper.toggle > 3.715986 [D5] send_to_all: ADDCMD beeper.enable > 3.715989 [D5] send_to_all: ADDCMD beeper.disable > 3.715992 [D5] send_to_all: ADDCMD bypass.start > 3.715994 [D5] send_to_all: ADDCMD bypass.stop > 3.715998 [D5] send_to_all: SETINFO ups.delay.start "180" > 3.716002 [D5] send_to_all: SETFLAGS ups.delay.start RW > 3.716006 [D5] send_to_all: ADDRANGE ups.delay.start 0 599940 > 3.716009 [D5] send_to_all: SETFLAGS ups.delay.start RW NUMBER > 3.716012 [D5] send_to_all: SETINFO ups.delay.shutdown "30" > 3.716015 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW > 3.716027 [D5] send_to_all: ADDRANGE ups.delay.shutdown 12 5940 > 3.716030 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW NUMBER > 3.716034 No values for battery high/low voltages > 3.716039 [D5] send_to_all: SETINFO battery.voltage.low "208.00" > 3.716055 [D5] send_to_all: SETINFO battery.voltage.high "300.00" > 3.716058 Using 'guesstimation' (low: 208.000000, high: 300.000000)! > 3.716080 setvar(ups.delay.start, 60) > 3.716093 [D2] setvar: setting server side variable ups.delay.start > 3.716096 [D5] send_to_all: SETINFO ups.delay.start "60" > 3.716099 setvar: SUCCEED > 3.716113 setvar(ups.delay.shutdown, 12) > 3.716116 [D2] setvar: setting server side variable > ups.delay.shutdown > 3.716119 [D5] send_to_all: SETINFO ups.delay.shutdown "12" > 3.716121 setvar: SUCCEED > 3.716127 [D5] send_to_all: SETINFO driver.parameter.pollfreq "30" > 3.716133 [D5] send_to_all: SETINFO driver.state "init.updateinfo" > 3.716136 [D1] upsdrv_updateinfo... > 3.716138 [D1] Quick update... > 3.717379 [D3] send: QGS > 3.771896 [D5] read [ 0]: (8 bytes) => 28 32 31 36 2e 39 20 35 > 3.811874 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 39 2e > 3.843894 [D5] read [ 16]: (8 bytes) => 35 20 36 30 2e 30 20 30 > 3.883889 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 > 3.915894 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 > 3.947892 [D5] read [ 40]: (8 bytes) => 36 31 2e 33 20 32 37 32 > 3.987887 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d > 4.019889 [D5] read [ 56]: (8 bytes) => 20 30 32 35 2e 34 20 31 > 4.059890 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 4.075889 [D5] read [ 72]: (8 bytes) => 30 30 30 0d 20 32 37 32 > 4.075894 [D3] read: (216.9 59.9 219.5 60.0 002.8 007 361.8 > 361.3 272.9 ---.- 025.4 100000000000 > 4.075899 [D5] update_status: OL > 4.075902 [D5] update_status: !LB > 4.075906 [D5] update_status: !CAL > 4.075909 [D5] update_status: !FSD > 4.075916 [D5] send_to_all: SETINFO ups.status "OL" > 4.075919 [D5] send_to_all: DATAOK > 4.075921 [D5] send_to_all: SETINFO driver.state "init.quiet" > 4.075925 [D5] send_to_all: SETINFO driver.parameter.pollinterval > "10" > 4.075928 [D5] send_to_all: SETINFO driver.parameter.synchronous > "yes" > 4.075931 [D5] send_to_all: SETINFO driver.state "quiet" > 4.075933 [D1] Driver initialization completed, beginning data > dump (1 loops) > 4.075936 [D5] send_to_all: SETINFO driver.state "updateinfo" > 4.075938 [D1] upsdrv_updateinfo... > 4.075940 [D1] Quick update... > 4.077120 [D3] send: QGS > 4.131888 [D5] read [ 0]: (8 bytes) => 28 32 31 36 2e 39 20 35 > 4.171889 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 38 2e > 4.203867 [D5] read [ 16]: (8 bytes) => 37 20 36 30 2e 30 20 30 > 4.243908 [D5] read [ 24]: (8 bytes) => 30 33 2e 31 20 30 30 37 > 4.275890 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 > 4.315895 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 > 4.347870 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d > 4.379883 [D5] read [ 56]: (8 bytes) => 20 30 32 35 2e 32 20 31 > 4.419889 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 4.435887 [D5] read [ 72]: (8 bytes) => 30 30 30 0d 20 32 37 32 > 4.435892 [D3] read: (216.9 59.9 218.7 60.0 003.1 007 361.8 > 361.8 272.9 ---.- 025.2 100000000000 > 4.435898 [D5] update_status: OL > 4.435901 [D5] update_status: !LB > 4.435905 [D5] update_status: !CAL > 4.435908 [D5] update_status: !FSD > 4.435917 [D5] send_to_all: SETINFO driver.state "quiet" > 4.435920 [D5] send_to_all: SETINFO driver.state "updateinfo" > 4.435923 [D1] upsdrv_updateinfo... > 4.435926 [D1] Quick update... > 4.437133 [D3] send: QGS > 4.491888 [D5] read [ 0]: (8 bytes) => 28 32 31 36 2e 39 20 35 > 4.531888 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 39 2e > 4.563888 [D5] read [ 16]: (8 bytes) => 35 20 35 39 2e 39 20 30 > 4.603887 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 > 4.635882 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 > 4.667878 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 > 4.707882 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d > 4.739885 [D5] read [ 56]: (8 bytes) => 20 30 32 35 2e 32 20 31 > 4.779885 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 4.795884 [D5] read [ 72]: (8 bytes) => 30 30 30 0d 20 32 37 32 > 4.795889 [D3] read: (216.9 59.9 219.5 59.9 002.8 007 361.8 > 361.8 272.9 ---.- 025.2 100000000000 > 4.795893 [D5] update_status: OL > 4.795897 [D5] update_status: !LB > 4.795900 [D5] update_status: !CAL > 4.795903 [D5] update_status: !FSD > 4.795911 [D5] send_to_all: SETINFO driver.state "quiet" > 4.795914 [D5] send_to_all: SETINFO driver.state "dumping" > 4.795916 [D3] Entering dstate_dump > battery.charge: 100 > battery.packs: 1 > battery.protection: yes > battery.runtime: 600 > battery.voltage: 272.9 > battery.voltage.high: 300.00 > battery.voltage.low: 208.00 > battery.voltage.nominal: 240.0 > device.model: G10K > device.type: ups > driver.name: nutdrv_qx > driver.parameter.bypass_when_off: disabled > driver.parameter.offdelay: 12 > driver.parameter.ondelay: 60 > driver.parameter.pollfreq: 30 > driver.parameter.pollinterval: 10 > driver.parameter.port: auto > driver.parameter.synchronous: yes > driver.state: dumping > driver.version: Windows-v2.8.0-alpha3-1252-g757813e > driver.version.data: Voltronic 0.07 > driver.version.internal: 0.33 > driver.version.usb: libusb-0.1 (or compat) > input.current.nominal: 45.0 > input.frequency: 59.9 > input.frequency.nominal: 60.0 > input.phases: 1 > input.transfer.high: 231 > input.transfer.high.max: 244 > input.transfer.high.min: 231 > input.transfer.low: 209 > input.transfer.low.max: 209 > input.transfer.low.min: 196 > input.voltage: 216.9 > input.voltage.nominal: 230.0 > outlet.0.switchable: no > output.current: 2.8 > output.current.nominal: 45 > output.frequency: 60.0 > output.frequency.nominal: 60.0 > output.phases: 1 > output.powerfactor: 0.8 > output.voltage: 220.4 > output.voltage.nominal: 220.0 > ups.beeper.status: enabled > ups.delay.shutdown: 12 > ups.delay.start: 60 > ups.firmware: 00077.13 > ups.firmware.aux: P02 > ups.load: 7 > ups.power.nominal: 10000 > ups.productid: 5161 > ups.start.auto: yes > ups.status: OL > ups.temperature: 25.2 > ups.type: online > ups.vendorid: 0665 > 4.795978 [D5] send_to_all: SETINFO driver.state "cleanup.upsdrv" > 4.795980 [D1] upsdrv_cleanup... > 4.796001 [D5] send_to_all: SETINFO driver.state "cleanup.exit" > > 3KV: > >./nutdrv_qx -a ftups -DDDDDD -d1 > Network UPS Tools - Generic Q* USB/Serial driver 0.33 > (Windows-v2.8.0-alpha3-1252-g757813e) > USB communication driver (libusb 0.1) 0.44 > 0.000000 [D1] debug level is '6' > 0.001398 [D1] Succeeded to become_user(nut): now UID=57 GID=57 > 0.001425 [D5] send_to_all: SETINFO device.type "ups" > 0.001439 [D5] send_to_all: SETINFO driver.state "init.device" > 0.001446 [D1] upsdrv_initups... > 0.004450 [D3] usb_busses=0x16ed520 > 0.004462 [D2] Checking device (0665/5161) (002/004) > 0.004485 [D2] - VendorID: 0665 > 0.004493 [D2] - ProductID: 5161 > 0.004497 [D2] - Manufacturer: unknown > 0.004501 [D2] - Product: unknown > 0.004507 [D2] - Serial Number: unknown > 0.004512 [D2] - Bus: 002 > 0.004518 [D2] - Device: 004 > 0.004523 [D2] - Device release number: 0002 > 0.004535 [D2] Trying to match device > 0.004540 [D3] match_function_regex: matching a device... > 0.004546 [D2] Device matches > 0.004579 [D3] nut_usb_set_altinterface: skipped > usb_set_altinterface(udev, 0) > 0.004589 [D5] send_to_all: SETINFO ups.vendorid "0665" > 0.004596 [D5] send_to_all: SETINFO ups.productid "5161" > 0.006922 [D3] send: QGS > 0.071746 [D5] read [ 0]: (8 bytes) => 28 31 31 32 2e 30 20 35 > 0.103746 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 31 30 39 2e > 0.143746 [D5] read [ 16]: (8 bytes) => 36 20 36 30 2e 30 20 30 > 0.175758 [D5] read [ 24]: (8 bytes) => 30 35 2e 32 20 30 31 39 > 0.215704 [D5] read [ 32]: (8 bytes) => 20 31 38 31 2e 39 20 31 > 0.255745 [D5] read [ 40]: (8 bytes) => 38 31 2e 37 20 30 38 32 > 0.295743 [D5] read [ 48]: (8 bytes) => 2e 31 20 2d 2d 2d 2e 2d > 0.359735 [D5] read [ 56]: (8 bytes) => 20 30 31 37 2e 33 20 31 > 0.399731 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 0.415732 [D5] read [ 72]: (8 bytes) => 30 30 31 0d 00 00 00 00 > 0.415742 [D3] read: (112.0 59.9 109.6 60.0 005.2 019 181.9 > 181.7 082.1 ---.- 017.3 100000000001 > 0.415780 [D5] send_to_all: SETINFO input.voltage "112.0" > 0.418233 [D3] send: QPI > 0.471737 [D5] read [ 0]: (8 bytes) => 28 50 49 30 31 0d 00 00 > 0.471746 [D3] read: (PI01 > 0.471830 [D5] send_to_all: SETINFO ups.firmware.aux "P01" > 0.471847 Using protocol: Voltronic 0.07 > 0.471854 [D5] send_to_all: SETINFO driver.state "init.quiet" > 0.471863 [D5] send_to_all: SETINFO driver.version > "Windows-v2.8.0-alpha3-1252-g757813e" > 0.471870 [D5] send_to_all: SETINFO driver.version.internal "0.33" > 0.471877 [D5] send_to_all: SETINFO driver.name "nutdrv_qx" > 0.471884 [D5] send_to_all: SETINFO driver.state "init.info" > 0.471889 [D1] upsdrv_initinfo... > 0.471895 [D5] send_to_all: SETINFO driver.version.data "Voltronic > 0.07" > 0.474546 [D3] send: QRI > 0.535733 [D5] read [ 0]: (8 bytes) => 28 31 31 30 2e 30 20 30 > 0.575671 [D5] read [ 8]: (8 bytes) => 32 37 20 30 37 32 2e 30 > 0.599742 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 > 0.599752 [D3] read: (110.0 027 072.0 60.0 > 0.599768 [D5] send_to_all: SETINFO output.voltage.nominal "110.0" > 0.599790 [D5] send_to_all: SETINFO output.current.nominal "27" > 0.599800 [D5] send_to_all: SETINFO battery.voltage.nominal "72.0" > 0.599815 [D5] send_to_all: SETINFO output.frequency.nominal "60.0" > 0.602586 [D3] send: QMD > 0.663734 [D5] read [ 0]: (8 bytes) => 28 23 23 23 23 23 23 23 > 0.695734 [D5] read [ 8]: (8 bytes) => 23 23 23 23 23 23 33 4b > 0.735756 [D5] read [ 16]: (8 bytes) => 20 23 23 23 33 30 30 30 > 0.775726 [D5] read [ 24]: (8 bytes) => 20 38 30 20 31 2f 31 20 > 0.839731 [D5] read [ 32]: (8 bytes) => 31 31 30 20 31 31 30 20 > 0.879779 [D5] read [ 40]: (8 bytes) => 30 36 20 31 32 2e 30 0d > 0.879789 [D3] read: (#############3K ###3000 80 1/1 110 110 06 12.0 > 0.879801 [D5] send_to_all: SETINFO device.model "3K" > 0.879811 [D5] send_to_all: SETINFO ups.power.nominal "3000" > 0.879822 [D5] send_to_all: SETINFO output.powerfactor "0.8" > 0.879839 [D5] send_to_all: SETINFO input.phases "1" > 0.879849 [D5] send_to_all: SETINFO output.phases "1" > 0.879861 [D5] send_to_all: SETINFO input.voltage.nominal "110.0" > 0.882293 [D3] send: F > 0.935727 [D5] read [ 0]: (8 bytes) => 23 31 31 30 2e 30 20 30 > 0.975673 [D5] read [ 8]: (8 bytes) => 32 37 20 30 37 32 2e 30 > 0.999744 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 > 0.999753 [D3] read: #110.0 027 072.0 60.0 > 0.999770 [D5] send_to_all: SETINFO input.current.nominal "27.0" > 0.999797 [D5] send_to_all: SETINFO input.frequency.nominal "60.0" > 1.002589 [D3] send: QMF > 1.055728 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 1.055738 [D3] read: (NAK > 1.055743 [D2] qx_process_answer: query rejected by the UPS > (device.mfr) > 1.057829 [D3] send: QVFW > 1.119731 [D5] read [ 0]: (8 bytes) => 28 56 45 52 46 57 3a 30 > 1.159735 [D5] read [ 8]: (8 bytes) => 30 32 30 34 2e 30 36 0d > 1.159744 [D3] read: (VERFW:00204.06 > 1.159752 [D5] send_to_all: SETINFO ups.firmware "00204.06" > 1.161839 [D3] send: QID > 1.223728 [D5] read [ 0]: (8 bytes) => 28 30 30 30 30 30 30 30 > 1.263662 [D5] read [ 8]: (8 bytes) => 30 30 30 30 30 30 30 0d > 1.263671 [D3] read: (00000000000000 > 1.263677 device.serial: UPS reported a non-significant serial > [00000000000000] > 1.263681 [D4] ups_infoval_set: failed to preprocess value > [device.serial: 00000000000000] > 1.265586 [D3] send: I > 1.319693 [D5] read [ 0]: (8 bytes) => 23 20 20 20 20 20 20 20 > 1.359732 [D5] read [ 8]: (8 bytes) => 20 20 20 20 20 20 20 20 > 1.391737 [D5] read [ 16]: (8 bytes) => 20 4c 56 20 33 4b 20 20 > 1.431728 [D5] read [ 24]: (8 bytes) => 20 20 20 20 30 30 32 30 > 1.463727 [D5] read [ 32]: (8 bytes) => 34 2e 30 36 20 20 0d 00 > 1.463735 [D3] read: # LV 3K 00204.06 > 1.463741 [D1] ups_infoval_set: non significant value [device.mfr] > 1.466024 [D3] send: QGS > 1.527728 [D5] read [ 0]: (8 bytes) => 28 31 31 31 2e 39 20 35 > 1.559685 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 31 30 39 2e > 1.607694 [D5] read [ 16]: (8 bytes) => 37 20 35 39 2e 39 20 30 > 1.639730 [D5] read [ 24]: (8 bytes) => 30 36 2e 30 20 30 31 39 > 1.679727 [D5] read [ 32]: (8 bytes) => 20 31 38 31 2e 39 20 31 > 1.719718 [D5] read [ 40]: (8 bytes) => 38 31 2e 34 20 30 38 32 > 1.759747 [D5] read [ 48]: (8 bytes) => 2e 31 20 2d 2d 2d 2e 2d > 1.791722 [D5] read [ 56]: (8 bytes) => 20 30 31 37 2e 33 20 31 > 1.831787 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.847731 [D5] read [ 72]: (8 bytes) => 30 30 31 0d 00 00 00 00 > 1.847741 [D3] read: (111.9 59.9 109.7 59.9 006.0 019 181.9 > 181.4 082.1 ---.- 017.3 100000000001 > 1.847777 [D5] send_to_all: SETINFO input.frequency "59.9" > 1.847790 [D5] send_to_all: SETINFO output.voltage "109.7" > 1.847801 [D5] send_to_all: SETINFO output.frequency "59.9" > 1.847815 [D5] send_to_all: SETINFO output.current "6.0" > 1.847825 [D5] send_to_all: SETINFO ups.load "19" > 1.847842 [D5] send_to_all: SETINFO battery.voltage "082.1" > 1.847852 [D5] send_to_all: SETINFO ups.temperature "17.3" > 1.847868 [D5] send_to_all: SETINFO ups.type "online" > 1.847876 [D5] update_status: OL > 1.847884 [D5] update_status: !LB > 1.847896 [D5] update_status: !CAL > 1.847915 [D5] update_status: !FSD > 1.847925 [D5] send_to_all: SETINFO ups.beeper.status "enabled" > 1.850541 [D3] send: QMOD > 1.895719 [D5] read [ 0]: (8 bytes) => 28 4c 0d 00 00 00 00 00 > 1.895728 [D3] read: (L > 1.895735 [D5] update_status: OL > 1.897650 [D3] send: QWS > 1.959728 [D5] read [ 0]: (8 bytes) => 28 30 30 30 30 30 30 30 > 1.991723 [D5] read [ 8]: (8 bytes) => 30 30 30 30 30 30 30 30 > 2.031725 [D5] read [ 16]: (8 bytes) => 30 30 30 30 30 30 30 30 > 2.063728 [D5] read [ 24]: (8 bytes) => 30 30 30 30 30 30 30 30 > 2.111710 [D5] read [ 32]: (8 bytes) => 30 30 30 30 30 30 30 30 > 2.143679 [D5] read [ 40]: (8 bytes) => 30 30 30 30 30 30 30 30 > 2.183721 [D5] read [ 48]: (8 bytes) => 30 30 30 30 30 30 30 30 > 2.215694 [D5] read [ 56]: (8 bytes) => 30 30 30 30 30 30 30 30 > 2.223724 [D5] read [ 64]: (8 bytes) => 30 0d 00 00 00 00 00 00 > 2.223733 [D3] read: > (0000000000000000000000000000000000000000000000000000000000000000 > 2.225774 [D3] send: QBV > 2.287722 [D5] read [ 0]: (8 bytes) => 28 30 38 32 2e 30 20 30 > 2.343726 [D5] read [ 8]: (8 bytes) => 36 20 30 31 20 31 30 30 > 2.367729 [D5] read [ 16]: (8 bytes) => 20 30 34 33 0d 00 00 00 > 2.367738 [D3] read: (082.0 06 01 100 043 > 2.367747 battery_number: 6 > 2.367771 battery_number, settable range: 1..9 > 2.367784 [D5] send_to_all: SETINFO battery.packs "1" > 2.367791 [D5] send_to_all: SETFLAGS battery.packs RW > 2.367797 [D5] send_to_all: ADDRANGE battery.packs 1 99 > 2.367802 [D5] send_to_all: SETFLAGS battery.packs RW NUMBER > 2.367811 [D5] send_to_all: SETINFO battery.charge "100" > 2.367822 [D5] send_to_all: SETINFO battery.runtime "2580" > 2.370574 [D3] send: QLDL > 2.439727 [D5] read [ 0]: (8 bytes) => 28 30 31 38 20 30 31 39 > 2.447733 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 > 2.447742 [D3] read: (018 019 > 2.447759 [D5] send_to_all: SETINFO output.power.minimum.percent "18" > 2.447767 [D5] send_to_all: SETINFO output.power.maximum.percent "19" > 2.450508 [D3] send: QFLAG > 2.519703 [D5] read [ 0]: (8 bytes) => 28 45 70 62 72 61 73 68 > 2.567706 [D5] read [ 8]: (8 bytes) => 63 7a 44 6f 76 65 67 66 > 2.591737 [D5] read [ 16]: (8 bytes) => 6a 6c 6d 0d 00 00 00 00 > 2.591747 [D3] read: (EpbrashczDovegfjlm > 2.591775 [D5] send_to_all: SETINFO ups.start.auto "yes" > 2.591793 [D5] send_to_all: SETFLAGS ups.start.auto RW > 2.591800 [D5] send_to_all: ADDENUM ups.start.auto "no" > 2.591808 [D5] send_to_all: ADDENUM ups.start.auto "yes" > 2.591818 [D5] send_to_all: SETINFO battery.protection "yes" > 2.591825 [D5] send_to_all: SETFLAGS battery.protection RW > 2.591831 [D5] send_to_all: ADDENUM battery.protection "no" > 2.591838 [D5] send_to_all: ADDENUM battery.protection "yes" > 2.591863 [D5] send_to_all: SETINFO battery.energysave "no" > 2.591870 [D5] send_to_all: SETFLAGS battery.energysave RW > 2.591876 [D5] send_to_all: ADDENUM battery.energysave "no" > 2.591883 [D5] send_to_all: ADDENUM battery.energysave "yes" > 2.591897 [D5] send_to_all: SETINFO ups.start.battery "yes" > 2.591904 [D5] send_to_all: SETFLAGS ups.start.battery RW > 2.591912 [D5] send_to_all: ADDENUM ups.start.battery "no" > 2.591918 [D5] send_to_all: ADDENUM ups.start.battery "yes" > 2.591929 [D5] send_to_all: SETINFO outlet.0.switchable "no" > 2.591935 [D5] send_to_all: SETFLAGS outlet.0.switchable RW > 2.591942 [D5] send_to_all: ADDENUM outlet.0.switchable "no" > 2.591949 [D5] send_to_all: ADDENUM outlet.0.switchable "yes" > 2.591956 bypass_alarm: enabled > 2.591966 battery_alarm: enabled > 2.591981 bypass_when_off: disabled > 2.592003 alarm_control: enabled > 2.592012 converter_mode: disabled > 2.592045 eco_mode: disabled > 2.592053 [D4] ups_infoval_set: failed to preprocess value > [battery_open_status_check: EpbrashczDovegfjlm] > 2.592062 bypass_forbidding: disabled > 2.592077 site_fault_detection: disabled > 2.592084 [D4] ups_infoval_set: failed to preprocess value > [advanced_eco_mode: EpbrashczDovegfjlm] > 2.592092 [D4] ups_infoval_set: failed to preprocess value > [constant_phase_angle: EpbrashczDovegfjlm] > 2.592100 [D4] ups_infoval_set: failed to preprocess value > [limited_runtime_on_battery: EpbrashczDovegfjlm] > 2.592110 setvar(bypass_when_off, disabled) > 2.592116 bypass_when_off is already disabled > 2.592122 setvar: FAILED > 2.594532 [D3] send: QHE > 2.655731 [D5] read [ 0]: (8 bytes) => 28 31 31 36 20 31 30 34 > 2.663729 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 > 2.663738 [D3] read: (116 104 > 2.663775 [D5] send_to_all: SETINFO input.transfer.high "116" > 2.663785 [D5] send_to_all: SETFLAGS input.transfer.high RW > 2.663792 [D5] send_to_all: ADDRANGE input.transfer.high 113 122 > 2.663798 [D5] send_to_all: SETFLAGS input.transfer.high RW NUMBER > 2.663813 [D5] send_to_all: SETINFO input.transfer.low "104" > 2.663820 [D5] send_to_all: SETFLAGS input.transfer.low RW > 2.663827 [D5] send_to_all: ADDRANGE input.transfer.low 98 107 > 2.663834 [D5] send_to_all: SETFLAGS input.transfer.low RW NUMBER > 2.663841 [D5] send_to_all: SETINFO input.transfer.low.min "98" > 2.663851 [D5] send_to_all: SETINFO input.transfer.low.max "107" > 2.663861 [D5] send_to_all: SETINFO input.transfer.high.min "113" > 2.663871 [D5] send_to_all: SETINFO input.transfer.high.max "122" > 2.666579 [D3] send: QFRE > 2.719726 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 2.719735 [D3] read: (NAK > 2.719740 [D2] qx_process_answer: query rejected by the UPS > (input.frequency.high) > 2.719745 [D2] qx_process_answer: query rejected by the UPS > (input.frequency.low) > 2.722576 [D3] send: QBYV > 2.791725 [D5] read [ 0]: (8 bytes) => 28 31 33 32 20 30 38 35 > 2.799726 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 > 2.799735 [D3] read: (132 085 > 2.799743 max_bypass_volt: 132 > 2.799750 max_bypass_volt, settable range: 120..140 > 2.799770 min_bypass_volt: 85 > 2.799779 min_bypass_volt, settable range: 85..115 > 2.802578 [D3] send: QBYF > 2.871702 [D5] read [ 0]: (8 bytes) => 28 36 33 2e 30 20 35 37 > 2.879682 [D5] read [ 8]: (8 bytes) => 2e 30 0d 00 00 00 00 00 > 2.879691 [D3] read: (63.0 57.0 > 2.879699 max_bypass_freq: 63.0 > 2.879706 max_bypass_freq, settable range: 61.0..70.0 > 2.879731 min_bypass_freq: 57.0 > 2.879742 min_bypass_freq, settable range: 50.0..59.0 > 2.879753 [D2] setvar: nothing to do... [battery_number] > 2.881579 [D3] send: RE0 > 2.935705 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 2.935720 [D3] read: (NAK > 2.935732 [D2] qx_process_answer: query rejected by the UPS > (battery.voltage.low) > 2.937709 [D3] send: QPD > 2.991705 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 2.991721 [D3] read: (NAK > 2.991731 [D2] qx_process_answer: query rejected by the UPS > (input_phase_angle) > 2.991737 [D2] qx_process_answer: query rejected by the UPS > (output_phase_angle) > 2.994569 [D3] send: QPAR > 3.047721 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 3.047731 [D3] read: (NAK > 3.047735 [D2] qx_process_answer: query rejected by the UPS > (voltronic_parallel) > 3.047747 [D5] send_to_all: ADDCMD load.off > 3.047764 [D5] send_to_all: ADDCMD load.on > 3.047771 [D5] send_to_all: ADDCMD shutdown.return > 3.047777 [D5] send_to_all: ADDCMD shutdown.stayoff > 3.047784 [D5] send_to_all: ADDCMD shutdown.stop > 3.047791 [D5] send_to_all: ADDCMD test.battery.start > 3.047797 [D5] send_to_all: ADDCMD test.battery.start.deep > 3.047804 [D5] send_to_all: ADDCMD test.battery.start.quick > 3.047811 [D5] send_to_all: ADDCMD test.battery.stop > 3.047816 [D5] send_to_all: ADDCMD beeper.toggle > 3.047823 [D5] send_to_all: ADDCMD beeper.enable > 3.047827 [D5] send_to_all: ADDCMD beeper.disable > 3.047833 [D5] send_to_all: ADDCMD bypass.start > 3.047838 [D5] send_to_all: ADDCMD bypass.stop > 3.047845 [D5] send_to_all: SETINFO ups.delay.start "180" > 3.047850 [D5] send_to_all: SETFLAGS ups.delay.start RW > 3.047858 [D5] send_to_all: ADDRANGE ups.delay.start 0 599940 > 3.047864 [D5] send_to_all: SETFLAGS ups.delay.start RW NUMBER > 3.047872 [D5] send_to_all: SETINFO ups.delay.shutdown "30" > 3.047878 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW > 3.047885 [D5] send_to_all: ADDRANGE ups.delay.shutdown 12 5940 > 3.047892 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW NUMBER > 3.047899 No values for battery high/low voltages > 3.047907 [D5] send_to_all: SETINFO battery.voltage.low "62.40" > 3.047915 [D5] send_to_all: SETINFO battery.voltage.high "90.00" > 3.047922 Using 'guesstimation' (low: 62.400000, high: 90.000000)! > 3.047933 setvar(ups.delay.start, 60) > 3.047942 [D2] setvar: setting server side variable ups.delay.start > 3.047961 [D5] send_to_all: SETINFO ups.delay.start "60" > 3.047966 setvar: SUCCEED > 3.047974 setvar(ups.delay.shutdown, 30) > 3.047980 setvar: nothing to do... [ups.delay.shutdown] > 3.047991 [D5] send_to_all: SETINFO driver.parameter.pollfreq "30" > 3.048002 [D5] send_to_all: SETINFO driver.state "init.updateinfo" > 3.048008 [D1] upsdrv_updateinfo... > 3.048014 [D1] Quick update... > 3.050576 [D3] send: QGS > 3.119624 [D5] read [ 0]: (8 bytes) => 28 31 31 32 2e 31 20 35 > 3.151706 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 31 30 39 2e > 3.191707 [D5] read [ 16]: (8 bytes) => 34 20 35 39 2e 39 20 30 > 3.231641 [D5] read [ 24]: (8 bytes) => 30 35 2e 32 20 30 31 38 > 3.263696 [D5] read [ 32]: (8 bytes) => 20 31 38 32 2e 33 20 31 > 3.335720 [D5] read [ 40]: (8 bytes) => 38 31 2e 37 20 30 38 32 > 3.367710 [D5] read [ 48]: (8 bytes) => 2e 31 20 2d 2d 2d 2e 2d > 3.407696 [D5] read [ 56]: (8 bytes) => 20 30 31 37 2e 33 20 31 > 3.439702 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 3.463711 [D5] read [ 72]: (8 bytes) => 30 30 31 0d 00 00 00 00 > 3.463726 [D3] read: (112.1 59.9 109.4 59.9 005.2 018 182.3 > 181.7 082.1 ---.- 017.3 100000000001 > 3.463732 [D5] update_status: OL > 3.463737 [D5] update_status: !LB > 3.463742 [D5] update_status: !CAL > 3.463759 [D5] update_status: !FSD > 3.463768 [D5] send_to_all: SETINFO ups.status "OL" > 3.463775 [D5] send_to_all: DATAOK > 3.463781 [D5] send_to_all: SETINFO driver.state "init.quiet" > 3.463789 [D5] send_to_all: SETINFO driver.parameter.pollinterval > "10" > 3.463796 [D5] send_to_all: SETINFO driver.parameter.synchronous > "yes" > 3.463804 [D5] send_to_all: SETINFO driver.state "quiet" > 3.463810 [D1] Driver initialization completed, beginning data > dump (1 loops) > 3.463823 [D5] send_to_all: SETINFO driver.state "updateinfo" > 3.463829 [D1] upsdrv_updateinfo... > 3.463835 [D1] Quick update... > 3.465994 [D3] send: QGS > 3.527682 [D5] read [ 0]: (8 bytes) => 28 31 31 32 2e 30 20 35 > 3.567709 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 31 30 39 2e > 3.599709 [D5] read [ 16]: (8 bytes) => 35 20 35 39 2e 39 20 30 > 3.639706 [D5] read [ 24]: (8 bytes) => 30 35 2e 32 20 30 31 39 > 3.679721 [D5] read [ 32]: (8 bytes) => 20 31 38 32 2e 34 20 31 > 3.719719 [D5] read [ 40]: (8 bytes) => 38 31 2e 36 20 30 38 32 > 3.751702 [D5] read [ 48]: (8 bytes) => 2e 31 20 2d 2d 2d 2e 2d > 3.815719 [D5] read [ 56]: (8 bytes) => 20 30 31 37 2e 33 20 31 > 3.855707 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 3.871704 [D5] read [ 72]: (8 bytes) => 30 30 31 0d 00 00 00 00 > 3.871719 [D3] read: (112.0 59.9 109.5 59.9 005.2 019 182.4 > 181.6 082.1 ---.- 017.3 100000000001 > 3.871725 [D5] update_status: OL > 3.871730 [D5] update_status: !LB > 3.871734 [D5] update_status: !CAL > 3.871751 [D5] update_status: !FSD > 3.871759 [D5] send_to_all: SETINFO driver.state "quiet" > 3.871765 [D5] send_to_all: SETINFO driver.state "updateinfo" > 3.871771 [D1] upsdrv_updateinfo... > 3.871776 [D1] Quick update... > 3.874334 [D3] send: QGS > 3.935702 [D5] read [ 0]: (8 bytes) => 28 31 31 32 2e 31 20 35 > 3.975637 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 31 30 39 2e > 4.007635 [D5] read [ 16]: (8 bytes) => 36 20 35 39 2e 39 20 30 > 4.047703 [D5] read [ 24]: (8 bytes) => 30 35 2e 33 20 30 31 38 > 4.079697 [D5] read [ 32]: (8 bytes) => 20 31 38 32 2e 30 20 31 > 4.119683 [D5] read [ 40]: (8 bytes) => 38 31 2e 36 20 30 38 32 > 4.151690 [D5] read [ 48]: (8 bytes) => 2e 31 20 2d 2d 2d 2e 2d > 4.191696 [D5] read [ 56]: (8 bytes) => 20 30 31 37 2e 33 20 31 > 4.231651 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 4.247736 [D5] read [ 72]: (8 bytes) => 30 30 31 0d 00 00 00 00 > 4.247746 [D3] read: (112.1 59.9 109.6 59.9 005.3 018 182.0 > 181.6 082.1 ---.- 017.3 100000000001 > 4.247757 [D5] update_status: OL > 4.247764 [D5] update_status: !LB > 4.247781 [D5] update_status: !CAL > 4.247786 [D5] update_status: !FSD > 4.247803 [D5] send_to_all: SETINFO driver.state "quiet" > 4.247810 [D5] send_to_all: SETINFO driver.state "dumping" > 4.247815 [D3] Entering dstate_dump > battery.charge: 100 > battery.energysave: no > battery.packs: 1 > battery.protection: yes > battery.runtime: 2580 > battery.voltage: 082.1 > battery.voltage.high: 90.00 > battery.voltage.low: 62.40 > battery.voltage.nominal: 72.0 > device.model: 3K > device.type: ups > driver.name: nutdrv_qx > driver.parameter.bypass_when_off: disabled > driver.parameter.offdelay: 30 > driver.parameter.ondelay: 60 > driver.parameter.pollfreq: 30 > driver.parameter.pollinterval: 10 > driver.parameter.port: auto > driver.parameter.synchronous: yes > driver.state: dumping > driver.version: Windows-v2.8.0-alpha3-1252-g757813e > driver.version.data: Voltronic 0.07 > driver.version.internal: 0.33 > driver.version.usb: libusb-0.1 (or compat) > input.current.nominal: 27.0 > input.frequency: 59.9 > input.frequency.nominal: 60.0 > input.phases: 1 > input.transfer.high: 116 > input.transfer.high.max: 122 > input.transfer.high.min: 113 > input.transfer.low: 104 > input.transfer.low.max: 107 > input.transfer.low.min: 98 > input.voltage: 112.0 > input.voltage.nominal: 110.0 > outlet.0.switchable: no > output.current: 6.0 > output.current.nominal: 27 > output.frequency: 59.9 > output.frequency.nominal: 60.0 > output.phases: 1 > output.power.maximum.percent: 19 > output.power.minimum.percent: 18 > output.powerfactor: 0.8 > output.voltage: 109.7 > output.voltage.nominal: 110.0 > ups.beeper.status: enabled > ups.delay.shutdown: 30 > ups.delay.start: 60 > ups.firmware: 00204.06 > ups.firmware.aux: P01 > ups.load: 19 > ups.power.nominal: 3000 > ups.productid: 5161 > ups.start.auto: yes > ups.start.battery: yes > ups.status: OL > ups.temperature: 17.3 > ups.type: online > ups.vendorid: 0665 > 4.247957 [D5] send_to_all: SETINFO driver.state "cleanup.upsdrv" > 4.247964 [D1] upsdrv_cleanup... > 4.248000 [D5] send_to_all: SETINFO driver.state "cleanup.exit" > > 2KV: > >./nutdrv_qx -a ftups -DDDDDD -d1 > Network UPS Tools - Generic Q* USB/Serial driver 0.33 > (Windows-v2.8.0-alpha3-1252-g757813e) > USB communication driver (libusb 0.1) 0.44 > 0.000000 [D1] debug level is '6' > 0.000741 [D1] Succeeded to become_user(nut): now UID=57 GID=57 > 0.000767 [D5] send_to_all: SETINFO device.type "ups" > 0.000787 [D5] send_to_all: SETINFO driver.state "init.device" > 0.000797 [D1] upsdrv_initups... > 0.005897 [D3] usb_busses=0x1c571b0 > 0.005925 [D2] Checking device (046D/C31D) (002/006) > 0.005975 [D1] Failed to open device (046D/C31D), skipping: > Permission denied > 0.005998 [D2] Checking device (15D9/0A4F) (002/005) > 0.006017 [D1] Failed to open device (15D9/0A4F), skipping: > Permission denied > 0.006028 [D2] Checking device (1A40/0101) (002/004) > 0.006044 [D1] Failed to open device (1A40/0101), skipping: > Permission denied > 0.006054 [D2] Checking device (0665/5161) (002/003) > 0.006809 [D1] libusb_open get iManufacturer failed, retrying... > 0.010168 [D2] - VendorID: 0665 > 0.010191 [D2] - ProductID: 5161 > 0.010201 [D2] - Manufacturer: INNO TECH > 0.010209 [D2] - Product: USB to Serial > 0.010217 [D2] - Serial Number: unknown > 0.010225 [D2] - Bus: 002 > 0.010233 [D2] - Device: 003 > 0.010241 [D2] - Device release number: 0002 > 0.010249 [D2] Trying to match device > 0.010258 [D3] match_function_regex: matching a device... > 0.010268 [D2] Device matches > 0.010304 [D3] nut_usb_set_altinterface: skipped > usb_set_altinterface(udev, 0) > 0.010322 [D5] send_to_all: SETINFO ups.vendorid "0665" > 0.010334 [D5] send_to_all: SETINFO ups.productid "5161" > 0.011139 [D3] send: QGS > 0.154938 [D5] read [ 0]: (8 bytes) => 51 47 53 0d 00 00 00 00 > 0.154969 [D3] read: QGS > 0.154996 [D2] qx_process_answer: short reply (input.voltage) > 0.155673 [D3] send: QGS > 0.298945 [D5] read [ 0]: (8 bytes) => 51 47 53 0d 00 00 00 00 > 0.298992 [D3] read: QGS > 0.299006 [D2] qx_process_answer: short reply (input.voltage) > 0.299794 [D3] send: QGS > 0.443936 [D5] read [ 0]: (8 bytes) => 51 47 53 0d 00 00 00 00 > 0.443990 [D3] read: QGS > 0.444019 [D2] qx_process_answer: short reply (input.voltage) > 0.444777 [D3] send: M > 0.568954 [D5] read [ 0]: (8 bytes) => 56 0d 00 00 00 00 00 00 > 0.569023 [D3] read: V > 0.569077 [D2] voltronic_qs_protocol: detected V protocol [V] > 0.569115 [D5] send_to_all: SETINFO ups.firmware.aux "PM-V" > 0.569807 [D3] send: QS > 0.620945 [D5] read [ 0]: (8 bytes) => 28 31 32 31 2e 38 20 31 > 0.653944 [D5] read [ 8]: (8 bytes) => 32 30 2e 37 20 31 30 32 > 0.686967 [D5] read [ 16]: (8 bytes) => 2e 33 20 30 33 32 20 36 > 0.719956 [D5] read [ 24]: (8 bytes) => 30 2e 32 20 31 33 2e 35 > 0.752941 [D5] read [ 32]: (8 bytes) => 20 2d 2d 2e 2d 20 30 30 > 0.885947 [D5] read [ 40]: (8 bytes) => 31 30 31 30 30 31 0d 00 > 0.886001 [D3] read: (121.8 120.7 102.3 032 60.2 13.5 --.- 00101001 > 0.886086 [D5] send_to_all: SETINFO input.voltage "121.8" > 0.886116 Using protocol: Voltronic-QS 0.09 > 0.886146 [D5] send_to_all: SETINFO driver.state "init.quiet" > 0.886191 [D5] send_to_all: SETINFO driver.version > "Windows-v2.8.0-alpha3-1252-g757813e" > 0.886221 [D5] send_to_all: SETINFO driver.version.internal "0.33" > 0.886250 [D5] send_to_all: SETINFO driver.name "nutdrv_qx" > 0.886279 [D5] send_to_all: SETINFO driver.state "init.info" > 0.886310 [D1] upsdrv_initinfo... > 0.886353 [D5] send_to_all: SETINFO driver.version.data > "Voltronic-QS 0.09" > 0.887174 [D3] send: QS > 0.937952 [D5] read [ 0]: (8 bytes) => 28 31 32 30 2e 37 20 31 > 0.970963 [D5] read [ 8]: (8 bytes) => 32 30 2e 36 20 31 30 33 > 1.003970 [D5] read [ 16]: (8 bytes) => 2e 32 20 30 33 33 20 36 > 1.036953 [D5] read [ 24]: (8 bytes) => 30 2e 32 20 31 33 2e 35 > 1.070969 [D5] read [ 32]: (8 bytes) => 20 2d 2d 2e 2d 20 30 30 > 1.203956 [D5] read [ 40]: (8 bytes) => 31 30 31 30 30 31 0d 00 > 1.204016 [D3] read: (120.7 120.6 103.2 033 60.2 13.5 --.- 00101001 > 1.204064 [D5] send_to_all: SETINFO input.voltage.fault "120.6" > 1.204126 [D5] send_to_all: SETINFO output.voltage "103.2" > 1.204165 [D5] send_to_all: SETINFO ups.load "33" > 1.204231 [D5] send_to_all: SETINFO output.frequency "60.2" > 1.204269 [D5] send_to_all: SETINFO battery.voltage "13.5" > 1.204326 [D2] ups_infoval_set: non numerical value > [ups.temperature: --.-] > 1.204358 [D5] update_status: OL > 1.204388 [D5] update_status: !LB > 1.204429 [D5] update_status: TRIM > 1.204476 [D5] send_to_all: SETINFO ups.type "offline / line > interactive" > 1.204510 [D5] update_status: !CAL > 1.204577 [D5] update_status: !FSD > 1.204613 [D5] send_to_all: SETINFO ups.beeper.status "enabled" > 1.205300 [D3] send: F > 1.249958 [D5] read [ 0]: (8 bytes) => 23 31 31 30 2e 30 20 30 > 1.283966 [D5] read [ 8]: (8 bytes) => 30 36 20 31 32 2e 30 30 > 1.412963 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 > 1.413022 [D3] read: #110.0 006 12.00 60.0 > 1.413067 [D5] send_to_all: SETINFO output.voltage.nominal "110" > 1.413115 [D5] send_to_all: SETINFO output.current.nominal "6.0" > 1.413195 [D5] send_to_all: SETINFO battery.voltage.nominal "12.0" > 1.413232 [D5] send_to_all: SETINFO output.frequency.nominal "60" > 1.413288 [D5] send_to_all: ADDCMD beeper.toggle > 1.413320 [D5] send_to_all: ADDCMD load.off > 1.413354 [D5] send_to_all: ADDCMD load.on > 1.413383 [D5] send_to_all: ADDCMD shutdown.return > 1.413413 [D5] send_to_all: ADDCMD shutdown.stayoff > 1.413442 [D5] send_to_all: ADDCMD shutdown.stop > 1.413470 [D5] send_to_all: ADDCMD test.battery.start.quick > 1.413507 [D5] send_to_all: SETINFO ups.delay.start "180" > 1.413579 [D5] send_to_all: SETFLAGS ups.delay.start RW > 1.413615 [D5] send_to_all: ADDRANGE ups.delay.start 60 599940 > 1.413655 [D5] send_to_all: SETFLAGS ups.delay.start RW NUMBER > 1.413685 [D5] send_to_all: SETINFO ups.delay.shutdown "30" > 1.413718 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW > 1.413751 [D5] send_to_all: ADDRANGE ups.delay.shutdown 12 540 > 1.413779 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW NUMBER > 1.413814 No values for battery high/low voltages > 1.413846 [D5] send_to_all: SETINFO battery.voltage.low "10.40" > 1.413883 [D5] send_to_all: SETINFO battery.voltage.high "15.00" > 1.413911 Using 'guesstimation' (low: 10.400000, high: 15.000000)! > 1.413944 [D5] send_to_all: SETINFO battery.charge "67" > 1.413973 Autodetected 1 as number of battery packs [12/13.50] > 1.413999 Battery runtime will not be calculated (runtimecal not set) > 1.414030 setvar(ups.delay.start, 60) > 1.414058 [D2] setvar: setting server side variable ups.delay.start > 1.414092 [D5] send_to_all: SETINFO ups.delay.start "60" > 1.414117 setvar: SUCCEED > 1.414144 setvar(ups.delay.shutdown, 30) > 1.414170 setvar: nothing to do... [ups.delay.shutdown] > 1.414201 [D5] send_to_all: SETINFO driver.parameter.pollfreq "30" > 1.414237 [D5] send_to_all: SETINFO driver.state "init.updateinfo" > 1.414269 [D1] upsdrv_updateinfo... > 1.414294 [D1] Quick update... > 1.414924 [D3] send: QS > 1.465959 [D5] read [ 0]: (8 bytes) => 28 31 32 30 2e 37 20 31 > 1.498927 [D5] read [ 8]: (8 bytes) => 32 30 2e 36 20 31 30 32 > 1.531968 [D5] read [ 16]: (8 bytes) => 2e 33 20 30 33 33 20 36 > 1.565953 [D5] read [ 24]: (8 bytes) => 30 2e 32 20 31 33 2e 35 > 1.598962 [D5] read [ 32]: (8 bytes) => 20 2d 2d 2e 2d 20 30 30 > 1.731977 [D5] read [ 40]: (8 bytes) => 31 30 31 30 30 31 0d 00 > 1.732034 [D3] read: (120.7 120.6 102.3 033 60.2 13.5 --.- 00101001 > 1.732101 [D5] update_status: OL > 1.732144 [D5] update_status: !LB > 1.732178 [D5] update_status: TRIM > 1.732218 [D5] update_status: !CAL > 1.732247 [D5] update_status: !FSD > 1.732281 [D5] send_to_all: SETINFO ups.status "OL TRIM" > 1.732309 [D5] send_to_all: DATAOK > 1.732347 [D5] send_to_all: SETINFO driver.state "init.quiet" > 1.732377 [D5] send_to_all: SETINFO driver.parameter.pollinterval > "10" > 1.732418 [D5] send_to_all: SETINFO driver.parameter.synchronous > "yes" > 1.732449 [D5] send_to_all: SETINFO driver.state "quiet" > 1.732475 [D1] Driver initialization completed, beginning data > dump (1 loops) > 1.732516 [D5] send_to_all: SETINFO driver.state "updateinfo" > 1.732573 [D1] upsdrv_updateinfo... > 1.732623 [D1] Quick update... > 1.733310 [D3] send: QS > 1.783966 [D5] read [ 0]: (8 bytes) => 28 31 32 30 2e 36 20 31 > 1.816932 [D5] read [ 8]: (8 bytes) => 32 30 2e 36 20 31 30 32 > 1.849963 [D5] read [ 16]: (8 bytes) => 2e 33 20 30 33 32 20 36 > 1.883966 [D5] read [ 24]: (8 bytes) => 30 2e 32 20 31 33 2e 35 > 1.916969 [D5] read [ 32]: (8 bytes) => 20 2d 2d 2e 2d 20 30 30 > 2.049989 [D5] read [ 40]: (8 bytes) => 31 30 31 30 30 31 0d 00 > 2.050046 [D3] read: (120.6 120.6 102.3 032 60.2 13.5 --.- 00101001 > 2.050112 [D5] update_status: OL > 2.050153 [D5] update_status: !LB > 2.050187 [D5] update_status: TRIM > 2.050217 [D5] update_status: !CAL > 2.050245 [D5] update_status: !FSD > 2.050279 [D5] send_to_all: SETINFO driver.state "quiet" > 2.050309 [D5] send_to_all: SETINFO driver.state "updateinfo" > 2.050358 [D1] upsdrv_updateinfo... > 2.050384 [D1] Quick update... > 2.051194 [D3] send: QS > 2.101980 [D5] read [ 0]: (8 bytes) => 28 31 32 30 2e 36 20 31 > 2.134979 [D5] read [ 8]: (8 bytes) => 32 31 2e 38 20 31 30 33 > 2.167958 [D5] read [ 16]: (8 bytes) => 2e 32 20 30 33 32 20 36 > 2.201976 [D5] read [ 24]: (8 bytes) => 30 2e 32 20 31 33 2e 35 > 2.234974 [D5] read [ 32]: (8 bytes) => 20 2d 2d 2e 2d 20 30 30 > 2.367963 [D5] read [ 40]: (8 bytes) => 31 30 31 30 30 31 0d 00 > 2.368024 [D3] read: (120.6 121.8 103.2 032 60.2 13.5 --.- 00101001 > 2.368090 [D5] update_status: OL > 2.368144 [D5] update_status: !LB > 2.368179 [D5] update_status: TRIM > 2.368210 [D5] update_status: !CAL > 2.368239 [D5] update_status: !FSD > 2.368283 [D5] send_to_all: SETINFO driver.state "quiet" > 2.368313 [D5] send_to_all: SETINFO driver.state "dumping" > 2.368349 [D3] Entering dstate_dump > battery.charge: 67 > battery.voltage: 13.5 > battery.voltage.high: 15.00 > battery.voltage.low: 10.40 > battery.voltage.nominal: 12.0 > device.type: ups > driver.name: nutdrv_qx > driver.parameter.bypass_when_off: disabled > driver.parameter.offdelay: 30 > driver.parameter.ondelay: 60 > driver.parameter.pollfreq: 30 > driver.parameter.pollinterval: 10 > driver.parameter.port: auto > driver.parameter.synchronous: yes > driver.state: dumping > driver.version: Windows-v2.8.0-alpha3-1252-g757813e > driver.version.data: Voltronic-QS 0.09 > driver.version.internal: 0.33 > driver.version.usb: libusb-0.1 (or compat) > input.voltage: 121.8 > input.voltage.fault: 120.6 > output.current.nominal: 6.0 > output.frequency: 60.2 > output.frequency.nominal: 60 > output.voltage: 103.2 > output.voltage.nominal: 110 > ups.beeper.status: enabled > ups.delay.shutdown: 30 > ups.delay.start: 60 > ups.firmware.aux: PM-V > ups.load: 33 > ups.productid: 5161 > ups.status: OL TRIM > ups.type: offline / line interactive > ups.vendorid: 0665 > 2.368829 [D5] send_to_all: SETINFO driver.state "cleanup.upsdrv" > 2.368859 [D1] upsdrv_cleanup... > 2.368922 [D5] send_to_all: SETINFO driver.state "cleanup.exit" >-------------- next part -------------- An HTML attachment was scrubbed... URL: <http://alioth-lists.debian.net/pipermail/nut-upsdev/attachments/20230905/0dbeaa99/attachment-0001.htm>
d tbsky
2023-Sep-13 13:13 UTC
[Nut-upsdev] [Nut-upsuser] PR to test for users of Qx devices (blazer and nutdrv_qx)
Jim Klimov <jimklimov+nut at gmail.com>> > Hello all, > > Had another hard look at the PR for QX device voltage/charge/runtime fixes for some broken use-cases (AND hoping to not introduce problems for cases that were not broken), and hopefully found and rolled back the change which in fact introduced the strangeness found in our winter round of tests. Then the year was busy... > > As before, the context for this is: > * issue https://github.com/networkupstools/nut/issues/1279 > * PR https://github.com/networkupstools/nut/pull/1652 > * PR source git branch (code to build for tests) https://github.com/jimklimov/nut/tree/issue-1279 > * https://github.com/networkupstools/nut/wiki/Building-NUT-for-in%E2%80%90place-upgrades-or-non%E2%80%90disruptive-tests suggests how to quickly build and test a driver >Hi: one of our voltronic ups caught fire last year. so we abandoned them and bought APC. now I have only one 10KV ups to test. It's sad because I like nutdrv_qx driver. APC microlink is too bad since nut doesn't support it. there is only modbus with apcupsd driver. BTW I saw an APC ups discussion at nut-upsdev about "SRVS1KI"(can not reply, not subscribed to that list) . I have that easy-ups series. nut can support them well with apcsmart driver. normally we should attach it via serial cable. if you attach the ups with usb cable, you will see "XR21V1410" which is a usb-serial converter. linux kernel 5.15 seems include the driver. or you will need to compile the driver(xr_usb_serial_common) yourself and get "/dev/ttyXRUSB0" to use as an serial port. I do that because we lost serial cable at a remote site and forced to use the usb cable.> ./nutdrv_qx -a ftups -u root -DDDDDD -d1Network UPS Tools - Generic Q* USB/Serial driver 0.35 (2.8.0-2359-g6c0032e52) USB communication driver (libusb 1.0) 0.45 0.000000 [D1] Network UPS Tools version 2.8.0-2359-g6c0032e52 (release/snapshot of 2.8.0.1) built with gcc (GCC) 11.3.1 20221121 (Red Hat 11.3.1-4) and configured with flags: --enable-Wcolor --enable-keep_nut_report_feature --with-all=auto --with-cgi=auto --with-serial=auto --with-dev=auto --with-doc=skip --with-nut_monitor=auto --with-pynut=auto --disable-force-nut-version-header --enable-check-NIT --enable-maintainer-mode 0.000011 [D1] debug level is '6' 0.000014 [D5] send_to_all: SETINFO driver.debug "6" 0.000018 [D5] send_to_all: SETFLAGS driver.debug RW NUMBER 0.000815 [D1] Succeeded to become_user(root): now UID=0 GID=0 0.000822 [D5] send_to_all: SETINFO device.type "ups" 0.000825 [D5] send_to_all: SETINFO driver.state "init.device" 0.000827 [D1] upsdrv_initups... 0.003147 [D2] Checking device 1 of 11 (8087/8000) 0.057855 [D2] - VendorID: 8087 0.057861 [D2] - ProductID: 8000 0.057862 [D2] - Manufacturer: unknown 0.057864 [D2] - Product: unknown 0.057865 [D2] - Serial Number: unknown 0.057867 [D2] - Bus: 002 0.057868 [D2] - Device: 002 0.057870 [D2] - Device release number: 0005 0.057873 [D2] Trying to match device 0.057875 [D3] match_function_regex: matching a device... 0.057888 [D2] Device does not match - skipping 0.071830 [D2] Checking device 2 of 11 (1D6B/0002) 0.078881 [D2] - VendorID: 1d6b 0.078885 [D2] - ProductID: 0002 0.078887 [D2] - Manufacturer: Linux 5.14.0-162.23.1.el9_1.x86_64 ehci_hcd 0.078888 [D2] - Product: EHCI Host Controller 0.078890 [D2] - Serial Number: 0000:00:1d.0 0.078891 [D2] - Bus: 002 0.078893 [D2] - Device: 001 0.078894 [D2] - Device release number: 0514 0.078897 [D2] Trying to match device 0.078898 [D3] match_function_regex: matching a device... 0.078912 [D2] Device does not match - skipping 0.091359 [D2] Checking device 3 of 11 (8087/8008) 0.145626 [D2] - VendorID: 8087 0.145635 [D2] - ProductID: 8008 0.145637 [D2] - Manufacturer: unknown 0.145638 [D2] - Product: unknown 0.145640 [D2] - Serial Number: unknown 0.145641 [D2] - Bus: 001 0.145643 [D2] - Device: 002 0.145645 [D2] - Device release number: 0005 0.145648 [D2] Trying to match device 0.145661 [D3] match_function_regex: matching a device... 0.145664 [D2] Device does not match - skipping 0.159837 [D2] Checking device 4 of 11 (1D6B/0002) 0.166862 [D2] - VendorID: 1d6b 0.166867 [D2] - ProductID: 0002 0.166868 [D2] - Manufacturer: Linux 5.14.0-162.23.1.el9_1.x86_64 ehci_hcd 0.166870 [D2] - Product: EHCI Host Controller 0.166871 [D2] - Serial Number: 0000:00:1a.0 0.166873 [D2] - Bus: 001 0.166874 [D2] - Device: 001 0.166876 [D2] - Device release number: 0514 0.166878 [D2] Trying to match device 0.166880 [D3] match_function_regex: matching a device... 0.166894 [D2] Device does not match - skipping 0.179366 [D2] Checking device 5 of 11 (1D6B/0003) 0.200847 [D2] - VendorID: 1d6b 0.200851 [D2] - ProductID: 0003 0.200853 [D2] - Manufacturer: Linux 5.14.0-162.23.1.el9_1.x86_64 xhci-hcd 0.200854 [D2] - Product: xHCI Host Controller 0.200856 [D2] - Serial Number: 0000:00:14.0 0.200857 [D2] - Bus: 004 0.200858 [D2] - Device: 001 0.200860 [D2] - Device release number: 0514 0.200862 [D2] Trying to match device 0.200864 [D3] match_function_regex: matching a device... 0.200877 [D2] Device does not match - skipping 0.200931 [D2] Checking device 6 of 11 (9966/0202) 0.202237 [D2] - VendorID: 9966 0.202254 [D2] - ProductID: 0202 0.202256 [D2] - Manufacturer: PSTEK 0.202268 [D2] - Product: PSTEK Combo KVM 8/16 V:2.00 0.202269 [D2] - Serial Number: unknown 0.202271 [D2] - Bus: 003 0.202272 [D2] - Device: 003 0.202274 [D2] - Device release number: 0000 0.202275 [D2] Trying to match device 0.202276 [D3] match_function_regex: matching a device... 0.202279 [D2] Device does not match - skipping 0.202300 [D2] Checking device 7 of 11 (0557/2419) 0.202309 [D2] - VendorID: 0557 0.202327 [D2] - ProductID: 2419 0.202329 [D2] - Manufacturer: unknown 0.202331 [D2] - Product: unknown 0.202334 [D2] - Serial Number: unknown 0.202346 [D2] - Bus: 003 0.202348 [D2] - Device: 004 0.202350 [D2] - Device release number: 0100 0.202353 [D2] Trying to match device 0.202365 [D3] match_function_regex: matching a device... 0.202367 [D2] Device does not match - skipping 0.202371 [D2] Checking device 8 of 11 (0557/7000) 0.202377 [D2] - VendorID: 0557 0.202379 [D2] - ProductID: 7000 0.202380 [D2] - Manufacturer: unknown 0.202382 [D2] - Product: unknown 0.202384 [D2] - Serial Number: unknown 0.202386 [D2] - Bus: 003 0.202389 [D2] - Device: 002 0.202391 [D2] - Device release number: 0000 0.202393 [D2] Trying to match device 0.202395 [D3] match_function_regex: matching a device... 0.202398 [D2] Device does not match - skipping 0.202402 [D2] Checking device 9 of 11 (0665/5161) 0.204923 [D1] nut_libusb_open get iManufacturer failed, retrying... 0.207280 [D1] nut_libusb_open get iManufacturer failed, retrying... 0.209669 [D1] nut_libusb_open get iManufacturer failed, retrying... 0.212022 [D1] nut_libusb_open get iProduct failed, retrying... 0.214338 [D1] nut_libusb_open get iProduct failed, retrying... 0.216830 [D1] nut_libusb_open get iProduct failed, retrying... 0.216846 [D2] - VendorID: 0665 0.216847 [D2] - ProductID: 5161 0.216849 [D2] - Manufacturer: unknown 0.216850 [D2] - Product: unknown 0.216852 [D2] - Serial Number: unknown 0.216864 [D2] - Bus: 003 0.216866 [D2] - Device: 006 0.216868 [D2] - Device release number: 0001 0.216870 [D2] Trying to match device 0.216872 [D3] match_function_regex: matching a device... 0.216885 [D2] Device matches 0.216886 [D2] Reading first configuration descriptor 0.216896 [D3] libusb_kernel_driver_active() returned 0: Success 0.216926 [D2] Claimed interface 0 successfully 0.216929 [D3] nut_usb_set_altinterface: skipped libusb_set_interface_alt_setting(udev, 0, 0) 0.216946 [D5] send_to_all: SETINFO ups.vendorid "0665" 0.216950 [D5] send_to_all: SETINFO ups.productid "5161" 0.218318 [D3] send: QGS 0.278886 [D5] read [ 0]: (8 bytes) => 28 32 32 31 2e 33 20 35 0.310887 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 39 2e 0.342884 [D5] read [ 16]: (8 bytes) => 35 20 35 39 2e 39 20 30 0.382879 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 0.414887 [D5] read [ 32]: (8 bytes) => 20 33 36 32 2e 33 20 33 0.454888 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 0.486869 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d 0.518892 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 0.558896 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 0.574889 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 0.574909 [D3] read: (221.3 59.9 219.5 59.9 002.8 007 362.3 361.8 272.9 ---.- 022.9 100000000010 0.574928 [D5] send_to_all: SETINFO input.voltage "221.3" 0.576176 [D3] send: QPI 0.622874 [D5] read [ 0]: (8 bytes) => 28 50 49 30 32 0d 00 00 0.622880 [D3] read: (PI02 0.622937 [D5] send_to_all: SETINFO ups.firmware.aux "P02" 0.622940 Using protocol: Voltronic 0.08 0.622942 [D5] send_to_all: SETINFO driver.state "init.quiet" 0.622956 [D5] send_to_all: SETINFO driver.version "2.8.0-2359-g6c0032e52" 0.622959 [D5] send_to_all: SETINFO driver.version.internal "0.35" 0.622963 [D5] send_to_all: SETINFO driver.name "nutdrv_qx" 0.622965 [D5] send_to_all: SETINFO driver.state "init.info" 0.622967 [D1] upsdrv_initinfo... 0.622980 [D5] send_to_all: SETINFO driver.version.data "Voltronic 0.08" 0.624104 [D3] send: QRI 0.678874 [D5] read [ 0]: (8 bytes) => 28 32 32 30 2e 30 20 30 0.718855 [D5] read [ 8]: (8 bytes) => 34 35 20 32 34 30 2e 30 0.742898 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 0.742910 [D3] read: (220.0 045 240.0 60.0 0.742946 [D5] send_to_all: SETINFO output.voltage.nominal "220.0" 0.742952 [D5] send_to_all: SETINFO output.current.nominal "45" 0.742958 [D5] send_to_all: SETINFO battery.voltage.nominal "240.0" 0.742964 [D5] send_to_all: SETINFO output.frequency.nominal "60.0" 0.744242 [D3] send: QMD 0.798887 [D5] read [ 0]: (8 bytes) => 28 23 23 23 23 23 23 23 0.838882 [D5] read [ 8]: (8 bytes) => 23 23 23 23 47 31 30 4b 0.870886 [D5] read [ 16]: (8 bytes) => 20 23 23 31 30 30 30 30 0.910884 [D5] read [ 24]: (8 bytes) => 20 38 30 20 31 2f 31 20 0.942903 [D5] read [ 32]: (8 bytes) => 32 33 30 20 32 33 30 20 0.974868 [D5] read [ 40]: (8 bytes) => 32 30 20 31 32 2e 30 0d 0.974873 [D3] read: (###########G10K ##10000 80 1/1 230 230 20 12.0 0.974882 [D5] send_to_all: SETINFO device.model "G10K" 0.974887 [D5] send_to_all: SETINFO ups.power.nominal "10000" 0.974893 [D5] send_to_all: SETINFO output.powerfactor "0.8" 0.974903 [D5] send_to_all: SETINFO input.phases "1" 0.974907 [D5] send_to_all: SETINFO output.phases "1" 0.974911 [D5] send_to_all: SETINFO input.voltage.nominal "230.0" 0.976111 [D3] send: F 1.022870 [D5] read [ 0]: (8 bytes) => 23 32 32 30 2e 30 20 30 1.062876 [D5] read [ 8]: (8 bytes) => 34 35 20 32 34 30 2e 30 1.086867 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 1.086872 [D3] read: #220.0 045 240.0 60.0 1.086881 [D5] send_to_all: SETINFO input.current.nominal "45.0" 1.086901 [D5] send_to_all: SETINFO input.frequency.nominal "60.0" 1.088234 [D3] send: QMF 1.134884 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 1.134903 [D3] read: (NAK 1.134905 [D2] qx_process_answer: query rejected by the UPS (device.mfr) 1.136185 [D3] send: QVFW 1.198873 [D5] read [ 0]: (8 bytes) => 28 56 45 52 46 57 3a 30 1.230865 [D5] read [ 8]: (8 bytes) => 30 30 37 37 2e 31 33 0d 1.230870 [D3] read: (VERFW:00077.13 1.230874 [D5] send_to_all: SETINFO ups.firmware "00077.13" 1.232171 [D3] send: QID 1.278886 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 1.278896 [D3] read: (NAK 1.278909 [D2] qx_process_answer: query rejected by the UPS (device.serial) 1.280047 [D3] send: I 1.326866 [D5] read [ 0]: (8 bytes) => 20 20 20 20 20 20 20 20 1.334901 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 1.334906 [D3] read: 1.334908 [D2] qx_process_answer: short reply (device.mfr) 1.336115 [D3] send: QGS 1.390871 [D5] read [ 0]: (8 bytes) => 28 32 31 39 2e 35 20 35 1.430868 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 32 30 2e 1.462877 [D5] read [ 16]: (8 bytes) => 34 20 36 30 2e 30 20 30 1.502865 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 1.534867 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 1.566867 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 1.606862 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d 1.638861 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 1.678883 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 1.694864 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 1.694884 [D3] read: (219.5 59.9 220.4 60.0 002.8 007 361.8 361.8 272.9 ---.- 022.9 100000000010 1.694914 [D5] send_to_all: SETINFO input.frequency "59.9" 1.694921 [D5] send_to_all: SETINFO output.voltage "220.4" 1.694926 [D5] send_to_all: SETINFO output.frequency "60.0" 1.694932 [D5] send_to_all: SETINFO output.current "2.8" 1.694936 [D5] send_to_all: SETINFO ups.load "7" 1.694940 [D5] send_to_all: SETINFO battery.voltage "272.9" 1.694945 [D5] send_to_all: SETINFO ups.temperature "22.9" 1.694962 [D5] send_to_all: SETINFO ups.type "online" 1.694967 [D5] update_status: OL 1.694970 [D5] update_status: !LB 1.694988 [D5] update_status: !CAL 1.695003 [D5] update_status: !FSD 1.695007 [D5] send_to_all: SETINFO ups.beeper.status "enabled" 1.696295 [D3] send: QMOD 1.734859 [D5] read [ 0]: (8 bytes) => 28 4c 0d 00 00 00 00 00 1.734878 [D3] read: (L 1.734891 [D5] update_status: OL 1.736229 [D3] send: QWS 1.790912 [D5] read [ 0]: (8 bytes) => 28 30 30 30 30 30 30 30 1.830878 [D5] read [ 8]: (8 bytes) => 30 30 30 30 30 30 30 30 1.862874 [D5] read [ 16]: (8 bytes) => 30 30 30 30 30 30 30 30 1.894869 [D5] read [ 24]: (8 bytes) => 30 30 30 30 30 30 30 30 1.934865 [D5] read [ 32]: (8 bytes) => 30 30 30 30 30 30 30 30 1.966853 [D5] read [ 40]: (8 bytes) => 30 30 30 30 30 30 30 30 2.006871 [D5] read [ 48]: (8 bytes) => 30 30 30 30 30 30 30 30 2.038858 [D5] read [ 56]: (8 bytes) => 30 30 30 30 30 30 30 30 2.046851 [D5] read [ 64]: (8 bytes) => 30 0d 30 30 30 30 30 30 2.046870 [D3] read: (0000000000000000000000000000000000000000000000000000000000000000 2.048166 [D3] send: QBV 2.102862 [D5] read [ 0]: (8 bytes) => 28 32 37 33 2e 32 20 32 2.142871 [D5] read [ 8]: (8 bytes) => 30 20 30 31 20 31 30 30 2.158875 [D5] read [ 16]: (8 bytes) => 20 30 31 30 0d 00 00 00 2.158880 [D3] read: (273.2 20 01 100 010 2.158886 battery_number: 20 2.158895 battery_number, settable range: 1..9 2.158904 [D5] send_to_all: SETINFO battery.packs "1" 2.158907 [D5] send_to_all: SETFLAGS battery.packs RW 2.158911 [D5] send_to_all: ADDRANGE battery.packs 1 99 2.158914 [D5] send_to_all: SETFLAGS battery.packs RW NUMBER 2.158919 [D5] send_to_all: SETINFO battery.charge "100" 2.158924 [D5] send_to_all: SETINFO battery.runtime "600" 2.160228 [D3] send: QLDL 2.206859 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 2.206874 [D3] read: (NAK 2.206880 [D2] qx_process_answer: query rejected by the UPS (output.power.minimum.percent) 2.206894 [D2] qx_process_answer: query rejected by the UPS (output.power.maximum.percent) 2.208167 [D3] send: QFLAG 2.270872 [D5] read [ 0]: (8 bytes) => 28 45 70 62 72 61 73 64 2.310890 [D5] read [ 8]: (8 bytes) => 74 69 44 6f 76 65 66 6a 2.318849 [D5] read [ 16]: (8 bytes) => 6d 0d 00 00 00 00 00 00 2.318867 [D3] read: (EpbrasdtiDovefjm 2.318910 [D5] send_to_all: SETINFO ups.start.auto "yes" 2.318915 [D5] send_to_all: SETFLAGS ups.start.auto RW 2.318928 [D5] send_to_all: ADDENUM ups.start.auto "no" 2.318930 [D5] send_to_all: ADDENUM ups.start.auto "yes" 2.318945 [D5] send_to_all: SETINFO battery.protection "yes" 2.318948 [D5] send_to_all: SETFLAGS battery.protection RW 2.318951 [D5] send_to_all: ADDENUM battery.protection "no" 2.318964 [D5] send_to_all: ADDENUM battery.protection "yes" 2.318969 [D4] ups_infoval_set: failed to preprocess value [battery.energysave: EpbrasdtiDovefjm] 2.318973 [D4] ups_infoval_set: failed to preprocess value [ups.start.battery: EpbrasdtiDovefjm] 2.318989 [D5] send_to_all: SETINFO outlet.0.switchable "no" 2.318992 [D5] send_to_all: SETFLAGS outlet.0.switchable RW 2.318994 [D5] send_to_all: ADDENUM outlet.0.switchable "no" 2.318996 [D5] send_to_all: ADDENUM outlet.0.switchable "yes" 2.319001 bypass_alarm: enabled 2.319020 battery_alarm: enabled 2.319036 bypass_when_off: disabled 2.319055 alarm_control: enabled 2.319060 converter_mode: disabled 2.319072 eco_mode: disabled 2.319075 battery_open_status_check: enabled 2.319078 bypass_forbidding: disabled 2.319083 [D4] ups_infoval_set: failed to preprocess value [site_fault_detection: EpbrasdtiDovefjm] 2.319087 [D4] ups_infoval_set: failed to preprocess value [advanced_eco_mode: EpbrasdtiDovefjm] 2.319091 [D4] ups_infoval_set: failed to preprocess value [constant_phase_angle: EpbrasdtiDovefjm] 2.319096 [D4] ups_infoval_set: failed to preprocess value [limited_runtime_on_battery: EpbrasdtiDovefjm] 2.319101 setvar(bypass_when_off, disabled) 2.319104 bypass_when_off is already disabled 2.319106 setvar: FAILED 2.320434 [D3] send: QHE 2.374864 [D5] read [ 0]: (8 bytes) => 28 32 33 31 20 32 30 39 2.382868 [D5] read [ 8]: (8 bytes) => 20 0d 00 00 00 00 00 00 2.382883 [D3] read: (231 209 2.382916 [D5] send_to_all: SETINFO input.transfer.high "231" 2.382929 [D5] send_to_all: SETFLAGS input.transfer.high RW 2.382932 [D5] send_to_all: ADDRANGE input.transfer.high 231 244 2.382934 [D5] send_to_all: SETFLAGS input.transfer.high RW NUMBER 2.382950 [D5] send_to_all: SETINFO input.transfer.low "209" 2.382953 [D5] send_to_all: SETFLAGS input.transfer.low RW 2.382955 [D5] send_to_all: ADDRANGE input.transfer.low 196 209 2.382957 [D5] send_to_all: SETFLAGS input.transfer.low RW NUMBER 2.382962 [D5] send_to_all: SETINFO input.transfer.low.min "196" 2.382966 [D5] send_to_all: SETINFO input.transfer.low.max "209" 2.382970 [D5] send_to_all: SETINFO input.transfer.high.min "231" 2.382975 [D5] send_to_all: SETINFO input.transfer.high.max "244" 2.384206 [D3] send: QFRE 2.430854 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 2.430859 [D3] read: (NAK 2.430861 [D2] qx_process_answer: query rejected by the UPS (input.frequency.high) 2.430864 [D2] qx_process_answer: query rejected by the UPS (input.frequency.low) 2.432092 [D3] send: QBYV 2.494864 [D5] read [ 0]: (8 bytes) => 28 32 36 34 20 31 31 30 2.502857 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 2.502875 [D3] read: (264 110 2.502891 max_bypass_volt: 264 2.502896 max_bypass_volt, settable range: 231..276 2.502899 min_bypass_volt: 110 2.502903 min_bypass_volt, settable range: 110..209 2.504103 [D3] send: QBYF 2.566858 [D5] read [ 0]: (8 bytes) => 28 36 34 2e 30 20 35 36 2.574855 [D5] read [ 8]: (8 bytes) => 2e 30 0d 00 00 00 00 00 2.574870 [D3] read: (64.0 56.0 2.574876 max_bypass_freq: 64.0 2.574891 max_bypass_freq, settable range: 61.0..64.0 2.574895 min_bypass_freq: 56.0 2.574909 min_bypass_freq, settable range: 56.0..59.0 2.574915 [D2] setvar: nothing to do... [battery_number] 2.576110 [D3] send: RE0 2.798865 [D5] read [ 0]: (8 bytes) => 00 00 00 00 00 00 00 00 3.801004 [D3] read: Operation timed out (-7) 3.801025 [D4] qx_process: failed to preprocess answer [battery.voltage.low] 3.802276 [D3] send: QPD 3.846839 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 3.846844 [D3] read: (NAK 3.846855 [D2] qx_process_answer: query rejected by the UPS (input_phase_angle) 3.846872 [D2] qx_process_answer: query rejected by the UPS (output_phase_angle) 3.848203 [D3] send: QPAR 3.894852 [D5] read [ 0]: (8 bytes) => 28 30 31 0d 00 00 00 00 3.894870 [D3] read: (01 ] 3.894874 [D2] voltronic_parallel: non numerical value [voltronic_parallel: 01 ] 3.894875 [D4] ups_infoval_set: failed to preprocess value [voltronic_parallel: 01 3.894883 [D5] send_to_all: ADDCMD load.off 3.894898 [D5] send_to_all: ADDCMD load.on 3.894900 [D5] send_to_all: ADDCMD shutdown.return 3.894902 [D5] send_to_all: ADDCMD shutdown.stayoff 3.894904 [D5] send_to_all: ADDCMD shutdown.stop 3.894916 [D5] send_to_all: ADDCMD test.battery.start 3.894918 [D5] send_to_all: ADDCMD test.battery.start.deep 3.894920 [D5] send_to_all: ADDCMD test.battery.start.quick 3.894922 [D5] send_to_all: ADDCMD test.battery.stop 3.894934 [D5] send_to_all: ADDCMD beeper.toggle 3.894937 [D5] send_to_all: ADDCMD beeper.enable 3.894940 [D5] send_to_all: ADDCMD beeper.disable 3.894942 [D5] send_to_all: ADDCMD bypass.start 3.894956 [D5] send_to_all: ADDCMD bypass.stop 3.894960 [D5] send_to_all: SETINFO ups.delay.start "180" 3.894963 [D5] send_to_all: SETFLAGS ups.delay.start RW 3.894978 [D5] send_to_all: ADDRANGE ups.delay.start 0 599940 3.894981 [D5] send_to_all: SETFLAGS ups.delay.start RW NUMBER 3.894983 [D5] send_to_all: SETINFO ups.delay.shutdown "30" 3.894985 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW 3.894989 [D5] send_to_all: ADDRANGE ups.delay.shutdown 12 5940 3.895001 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW NUMBER 3.895005 No values for battery high/low voltages 3.895010 [D5] send_to_all: SETINFO battery.voltage.low "208.00" 3.895023 [D5] send_to_all: SETINFO battery.voltage.high "260.00" 3.895026 Using 'guesstimation' (low: 208.000000, high: 260.000000)! 3.895037 setvar(ups.delay.start, 60) 3.895041 [D2] setvar: setting server side variable ups.delay.start 3.895044 [D5] send_to_all: SETINFO ups.delay.start "60" 3.895046 setvar: SUCCEED 3.895049 setvar(ups.delay.shutdown, 30) 3.895051 setvar: nothing to do... [ups.delay.shutdown] 3.895057 [D5] send_to_all: SETINFO driver.parameter.pollfreq "30" 3.895065 [D5] send_to_all: SETINFO driver.state "init.updateinfo" 3.895068 [D1] upsdrv_updateinfo... 3.895071 [D1] Quick update... 3.896659 [D3] send: QGS 3.950819 [D5] read [ 0]: (8 bytes) => 28 32 32 30 2e 34 20 35 3.990855 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 38 2e 4.022858 [D5] read [ 16]: (8 bytes) => 37 20 35 39 2e 39 20 30 4.062843 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 4.094844 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 4.126840 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 33 4.166841 [D5] read [ 48]: (8 bytes) => 2e 32 20 2d 2d 2d 2e 2d 4.198838 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 4.238833 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 4.254852 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 33 4.254868 [D3] read: (220.4 59.9 218.7 59.9 002.8 007 361.8 361.8 273.2 ---.- 022.9 100000000010 4.254872 [D5] update_status: OL 4.254875 [D5] update_status: !LB 4.254879 [D5] update_status: !CAL 4.254896 [D5] update_status: !FSD 4.254918 [D5] send_to_all: SETINFO ups.status "OL" 4.254921 [D5] send_to_all: DATAOK 4.254924 [D5] send_to_all: SETINFO driver.state "init.quiet" 4.254938 [D5] send_to_all: SETINFO driver.parameter.pollinterval "10" 4.254941 [D5] send_to_all: SETINFO driver.parameter.synchronous "yes" 4.254943 Running as foreground process, not saving a PID file 4.254956 [D5] send_to_all: SETINFO driver.flag.allow_killpower "0" 4.254960 [D5] send_to_all: SETFLAGS driver.flag.allow_killpower RW NUMBER 4.254963 [D5] send_to_all: ADDCMD driver.killpower 4.254976 [D5] send_to_all: ADDCMD driver.reload 4.254979 [D5] send_to_all: ADDCMD driver.reload-or-exit 4.254981 [D5] send_to_all: ADDCMD driver.reload-or-error 4.254984 [D5] send_to_all: SETINFO driver.state "quiet" 4.254986 [D1] Driver initialization completed, beginning data dump (1 loops) 4.254990 [D5] send_to_all: SETINFO driver.state "updateinfo" 4.254993 [D1] upsdrv_updateinfo... 4.254995 [D1] Quick update... 4.256195 [D3] send: QGS 4.310837 [D5] read [ 0]: (8 bytes) => 28 32 31 39 2e 35 20 35 4.350846 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 39 2e 4.390858 [D5] read [ 16]: (8 bytes) => 35 20 36 30 2e 30 20 30 4.422834 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 4.454832 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 4.494848 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 4.526837 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d 4.566835 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 4.598847 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 4.614849 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 4.614855 [D3] read: (219.5 59.9 219.5 60.0 002.8 007 361.8 361.8 272.9 ---.- 022.9 100000000010 4.614859 [D5] update_status: OL 4.614862 [D5] update_status: !LB 4.614866 [D5] update_status: !CAL 4.614883 [D5] update_status: !FSD 4.614903 [D5] send_to_all: SETINFO driver.state "quiet" 4.614906 [D5] send_to_all: SETINFO driver.state "updateinfo" 4.614908 [D1] upsdrv_updateinfo... 4.614911 [D1] Quick update... 4.616211 [D3] send: QGS 4.670846 [D5] read [ 0]: (8 bytes) => 28 32 32 31 2e 33 20 35 4.710831 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 38 2e 4.742850 [D5] read [ 16]: (8 bytes) => 37 20 35 39 2e 39 20 30 4.782842 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 4.814822 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 4.846843 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 4.886822 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d 4.918833 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 4.958839 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 4.974825 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 4.974829 [D3] read: (221.3 59.9 218.7 59.9 002.8 007 361.8 361.8 272.9 ---.- 022.9 100000000010 4.974833 [D5] update_status: OL 4.974836 [D5] update_status: !LB 4.974839 [D5] update_status: !CAL 4.974855 [D5] update_status: !FSD 4.974864 [D5] send_to_all: SETINFO driver.state "quiet" 4.974878 [D5] send_to_all: SETINFO driver.state "dumping" 4.974881 [D3] Entering dstate_dump battery.charge: 100 battery.packs: 1 battery.protection: yes battery.runtime: 600 battery.voltage: 272.9 battery.voltage.high: 260.00 battery.voltage.low: 208.00 battery.voltage.nominal: 240.0 device.model: G10K device.type: ups driver.debug: 6 driver.flag.allow_killpower: 0 driver.name: nutdrv_qx driver.parameter.bypass_when_off: disabled driver.parameter.offdelay: 30 driver.parameter.ondelay: 60 driver.parameter.pollfreq: 30 driver.parameter.pollinterval: 10 driver.parameter.port: auto driver.parameter.synchronous: yes driver.state: dumping driver.version: 2.8.0-2359-g6c0032e52 driver.version.data: Voltronic 0.08 driver.version.internal: 0.35 driver.version.usb: libusb-1.0.26 (API: 0x1000109) input.current.nominal: 45.0 input.frequency: 59.9 input.frequency.nominal: 60.0 input.phases: 1 input.transfer.high: 231 input.transfer.high.max: 244 input.transfer.high.min: 231 input.transfer.low: 209 input.transfer.low.max: 209 input.transfer.low.min: 196 input.voltage: 221.3 input.voltage.nominal: 230.0 outlet.0.switchable: no output.current: 2.8 output.current.nominal: 45 output.frequency: 60.0 output.frequency.nominal: 60.0 output.phases: 1 output.powerfactor: 0.8 output.voltage: 220.4 output.voltage.nominal: 220.0 ups.beeper.status: enabled ups.delay.shutdown: 30 ups.delay.start: 60 ups.firmware: 00077.13 ups.firmware.aux: P02 ups.load: 7 ups.power.nominal: 10000 ups.productid: 5161 ups.start.auto: yes ups.status: OL ups.temperature: 22.9 ups.type: online ups.vendorid: 0665 4.975010 [D5] send_to_all: SETINFO driver.state "cleanup.upsdrv" 4.975014 [D1] upsdrv_cleanup... 4.975125 [D5] send_to_all: SETINFO driver.state "cleanup.exit"> The new battery_voltage_reports_one_pack (introduced by the PR) could be used as a flag in ups.conf for devices which report only a smallish ~2V value in their native `battery.voltage` along with an override.battery.packs setting, where needed. > > The main question for testing is if your old (packaged 2.8.0 or 2.7.4, master-branch custom builds, etc.) NUT driver binaries reported *some reasonable values* (for battery voltages, charge, runtime, maybe packs), and that the tested build would report the same sort of values - e.g. no regression. And if your older NUT drivers did previously report some broken values (such as charges under 100% for well-charged UPSes, bogus "actual" battery voltage, etc.) then that the PR would fix that on its own or possibly in tandem with `ups.conf` options such as `runtimecal` and overrides discussed in that issue and PR on github. > > Looking forward to data points that would allow me to finally merge this PR (or understand what remains broken, if any) :) > > Thanks in advance, > Jim Klimov > > > On Thu, Jan 19, 2023 at 6:03?AM d tbsky <tbskyd at gmail.com> wrote: >> >> Jim Klimov <jimklimov+nut at gmail.com> >> > @tbsky: >> > Can you please check if 2.7.4 also reports the huge voltages for the 3kW and 10kW units, or something around 13.5V? Does it set "battery.packs" to 20 or 6? >> > Namely, I wonder if the new "battery_voltage_reports_one_pack" handling (and with no such option in your configs) misfires here somehow?.. >> > >> > Also, can you please re-run the tests with the PR-ed branch build and higher verbosity (e.g. `./nutdrv_qx -a ftups -DDDDDD -d1`) to help trace whether values optionally guessed by qx_initbattery() are in fact guessed or directly provided by respective devices (and subdrivers)?.. >> >> Hi: >> I retest them with 2.7.4 and 2.8.x(with debugging). results below. >> I hope they can reveal some information. >> >> 2.7.4: >> 10KV: >> >upsc ftups >> battery.charge: 100 >> battery.packs: 1 >> battery.protection: yes >> battery.runtime: 600 >> battery.voltage: 272.90 >> battery.voltage.nominal: 240.0 >> device.model: G10K >> device.type: ups >> driver.name: nutdrv_qx >> driver.parameter.bypass_when_off: disabled >> driver.parameter.offdelay: 12 >> driver.parameter.ondelay: 60 >> driver.parameter.pollfreq: 30 >> driver.parameter.pollinterval: 10 >> driver.parameter.port: auto >> driver.parameter.synchronous: yes >> driver.version: 2.7.4 >> driver.version.data: Voltronic 0.06 >> driver.version.internal: 0.28 >> input.current.nominal: 45.0 >> input.frequency: 60.0 >> input.frequency.nominal: 60.0 >> input.phases: 1 >> input.transfer.high: 231 >> input.transfer.high.max: 244 >> input.transfer.high.min: 231 >> input.transfer.low: 209 >> input.transfer.low.max: 209 >> input.transfer.low.min: 196 >> input.voltage: 218.7 >> input.voltage.nominal: 230.0 >> outlet.0.switchable: no >> output.current: 2.8 >> output.current.nominal: 45 >> output.frequency: 60.0 >> output.frequency.nominal: 60.0 >> output.phases: 1 >> output.powerfactor: 0.8 >> output.voltage: 218.7 >> output.voltage.nominal: 220.0 >> ups.beeper.status: enabled >> ups.delay.shutdown: 12 >> ups.delay.start: 60 >> ups.firmware: 00077.13 >> ups.firmware.aux: P02 >> ups.load: 7 >> ups.power.nominal: 10000 >> ups.productid: 5161 >> ups.start.auto: yes >> ups.status: OL >> ups.temperature: 25.2 >> ups.type: online >> ups.vendorid: 0665 >> >> 3KV: >> >upsc ftups >> Init SSL without certificate database >> battery.charge: 100 >> battery.energysave: no >> battery.packs: 1 >> battery.protection: yes >> battery.runtime: 2520 >> battery.voltage: 82.00 >> battery.voltage.nominal: 72.0 >> device.model: 3K >> device.type: ups >> driver.name: nutdrv_qx >> driver.parameter.bypass_when_off: disabled >> driver.parameter.offdelay: 30 >> driver.parameter.ondelay: 60 >> driver.parameter.pollfreq: 30 >> driver.parameter.pollinterval: 10 >> driver.parameter.port: auto >> driver.parameter.synchronous: yes >> driver.version: 2.7.4 >> driver.version.data: Voltronic 0.06 >> driver.version.internal: 0.28 >> input.current.nominal: 27.0 >> input.frequency: 60.0 >> input.frequency.nominal: 60.0 >> input.phases: 1 >> input.transfer.high: 116 >> input.transfer.high.max: 122 >> input.transfer.high.min: 113 >> input.transfer.low: 104 >> input.transfer.low.max: 107 >> input.transfer.low.min: 98 >> input.voltage: 112.6 >> input.voltage.nominal: 110.0 >> outlet.0.switchable: no >> output.current: 5.0 >> output.current.nominal: 27 >> output.frequency: 60.0 >> output.frequency.nominal: 60.0 >> output.phases: 1 >> output.power.maximum.percent: 19 >> output.power.minimum.percent: 18 >> output.powerfactor: 0.8 >> output.voltage: 109.8 >> output.voltage.nominal: 110.0 >> ups.beeper.status: enabled >> ups.delay.shutdown: 30 >> ups.delay.start: 60 >> ups.firmware: 00204.06 >> ups.firmware.aux: P01 >> ups.load: 19 >> ups.power.nominal: 3000 >> ups.productid: 5161 >> ups.start.auto: yes >> ups.start.battery: yes >> ups.status: OL >> ups.temperature: 17.3 >> ups.type: online >> ups.vendorid: 0665 >> >> 2KV: >> >upsc ftups >> battery.charge: 100 >> battery.voltage: 13.50 >> battery.voltage.high: 13.00 >> battery.voltage.low: 10.40 >> battery.voltage.nominal: 12.0 >> device.type: ups >> driver.name: nutdrv_qx >> driver.parameter.bypass_when_off: disabled >> driver.parameter.offdelay: 30 >> driver.parameter.ondelay: 60 >> driver.parameter.pollfreq: 30 >> driver.parameter.pollinterval: 10 >> driver.parameter.port: auto >> driver.parameter.synchronous: yes >> driver.version: 2.7.4 >> driver.version.data: Voltronic-QS 0.07 >> driver.version.internal: 0.28 >> input.voltage: 120.6 >> input.voltage.fault: 120.6 >> output.current.nominal: 6.0 >> output.frequency: 59.9 >> output.frequency.nominal: 60 >> output.voltage: 102.3 >> output.voltage.nominal: 110 >> ups.beeper.status: enabled >> ups.delay.shutdown: 30 >> ups.delay.start: 60 >> ups.firmware.aux: PM-V >> ups.load: 32 >> ups.productid: 5161 >> ups.status: OL TRIM >> ups.type: offline / line interactive >> ups.vendorid: 0665 >> >> 2.8.x: >> 10KV: >> ./nutdrv_qx -a ftups -DDDDDD -d1 >> Network UPS Tools - Generic Q* USB/Serial driver 0.33 >> (Windows-v2.8.0-alpha3-1252-g757813e) >> USB communication driver (libusb 0.1) 0.44 >> 0.000000 [D1] debug level is '6' >> 0.000192 [D1] Succeeded to become_user(nut): now UID=57 GID=57 >> 0.000198 [D5] send_to_all: SETINFO device.type "ups" >> 0.000201 [D5] send_to_all: SETINFO driver.state "init.device" >> 0.000204 [D1] upsdrv_initups... >> 0.001581 [D3] usb_busses=0xf5bef0 >> 0.001588 [D2] Checking device (8087/8000) (002/002) >> 0.001605 [D1] Failed to open device (8087/8000), skipping: >> Permission denied >> 0.001611 [D2] Checking device (1D6B/0002) (002/001) >> 0.001616 [D1] Failed to open device (1D6B/0002), skipping: >> Permission denied >> 0.001618 [D2] Checking device (8087/8008) (001/002) >> 0.001622 [D1] Failed to open device (8087/8008), skipping: >> Permission denied >> 0.001625 [D2] Checking device (1D6B/0002) (001/001) >> 0.001628 [D1] Failed to open device (1D6B/0002), skipping: >> Permission denied >> 0.001631 [D2] Checking device (1D6B/0003) (004/001) >> 0.001635 [D1] Failed to open device (1D6B/0003), skipping: >> Permission denied >> 0.001637 [D2] Checking device (9966/0202) (003/003) >> 0.001641 [D1] Failed to open device (9966/0202), skipping: >> Permission denied >> 0.001644 [D2] Checking device (0557/2419) (003/004) >> 0.001648 [D1] Failed to open device (0557/2419), skipping: >> Permission denied >> 0.001650 [D2] Checking device (0557/7000) (003/002) >> 0.001654 [D1] Failed to open device (0557/7000), skipping: >> Permission denied >> 0.001656 [D2] Checking device (0665/5161) (003/008) >> 0.004203 [D1] libusb_open get iManufacturer failed, retrying... >> 0.006463 [D1] libusb_open get iManufacturer failed, retrying... >> 0.008989 [D1] libusb_open get iManufacturer failed, retrying... >> 0.011261 [D1] libusb_open get iProduct failed, retrying... >> 0.013722 [D1] libusb_open get iProduct failed, retrying... >> 0.016049 [D1] libusb_open get iProduct failed, retrying... >> 0.016053 [D2] - VendorID: 0665 >> 0.016055 [D2] - ProductID: 5161 >> 0.016057 [D2] - Manufacturer: unknown >> 0.016059 [D2] - Product: unknown >> 0.016061 [D2] - Serial Number: unknown >> 0.016063 [D2] - Bus: 003 >> 0.016065 [D2] - Device: 008 >> 0.016067 [D2] - Device release number: 0001 >> 0.016069 [D2] Trying to match device >> 0.016071 [D3] match_function_regex: matching a device... >> 0.016074 [D2] Device matches >> 0.016087 [D3] nut_usb_set_altinterface: skipped >> usb_set_altinterface(udev, 0) >> 0.016091 [D5] send_to_all: SETINFO ups.vendorid "0665" >> 0.016094 [D5] send_to_all: SETINFO ups.productid "5161" >> 0.017431 [D3] send: QGS >> 0.075931 [D5] read [ 0]: (8 bytes) => 28 32 31 36 2e 39 20 36 >> 0.107929 [D5] read [ 8]: (8 bytes) => 30 2e 30 20 32 32 30 2e >> 0.147930 [D5] read [ 16]: (8 bytes) => 34 20 35 39 2e 39 20 30 >> 0.179924 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 >> 0.219926 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 >> 0.251927 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 >> 0.291909 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d >> 0.323924 [D5] read [ 56]: (8 bytes) => 20 30 32 35 2e 34 20 31 >> 0.355924 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 0.379924 [D5] read [ 72]: (8 bytes) => 30 30 30 0d 20 32 37 32 >> 0.379929 [D3] read: (216.9 60.0 220.4 59.9 002.8 007 361.8 >> 361.8 272.9 ---.- 025.4 100000000000 >> 0.379946 [D5] send_to_all: SETINFO input.voltage "216.9" >> 0.381097 [D3] send: QPI >> 0.427922 [D5] read [ 0]: (8 bytes) => 28 50 49 30 32 0d 00 00 >> 0.427927 [D3] read: (PI02 >> 0.427987 [D5] send_to_all: SETINFO ups.firmware.aux "P02" >> 0.427990 Using protocol: Voltronic 0.07 >> 0.427993 [D5] send_to_all: SETINFO driver.state "init.quiet" >> 0.427997 [D5] send_to_all: SETINFO driver.version >> "Windows-v2.8.0-alpha3-1252-g757813e" >> 0.428000 [D5] send_to_all: SETINFO driver.version.internal "0.33" >> 0.428003 [D5] send_to_all: SETINFO driver.name "nutdrv_qx" >> 0.428005 [D5] send_to_all: SETINFO driver.state "init.info" >> 0.428008 [D1] upsdrv_initinfo... >> 0.428011 [D5] send_to_all: SETINFO driver.version.data "Voltronic 0.07" >> 0.429229 [D3] send: QRI >> 0.483926 [D5] read [ 0]: (8 bytes) => 28 32 32 30 2e 30 20 30 >> 0.523927 [D5] read [ 8]: (8 bytes) => 34 35 20 32 34 30 2e 30 >> 0.547926 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 >> 0.547931 [D3] read: (220.0 045 240.0 60.0 >> 0.547940 [D5] send_to_all: SETINFO output.voltage.nominal "220.0" >> 0.547946 [D5] send_to_all: SETINFO output.current.nominal "45" >> 0.547950 [D5] send_to_all: SETINFO battery.voltage.nominal "240.0" >> 0.547956 [D5] send_to_all: SETINFO output.frequency.nominal "60.0" >> 0.549288 [D3] send: QMD >> 0.603919 [D5] read [ 0]: (8 bytes) => 28 23 23 23 23 23 23 23 >> 0.643924 [D5] read [ 8]: (8 bytes) => 23 23 23 23 47 31 30 4b >> 0.675924 [D5] read [ 16]: (8 bytes) => 20 23 23 31 30 30 30 30 >> 0.715923 [D5] read [ 24]: (8 bytes) => 20 38 30 20 31 2f 31 20 >> 0.747920 [D5] read [ 32]: (8 bytes) => 32 33 30 20 32 33 30 20 >> 0.787921 [D5] read [ 40]: (8 bytes) => 32 30 20 31 32 2e 30 0d >> 0.787927 [D3] read: (###########G10K ##10000 80 1/1 230 230 20 12.0 >> 0.787936 [D5] send_to_all: SETINFO device.model "G10K" >> 0.787940 [D5] send_to_all: SETINFO ups.power.nominal "10000" >> 0.787946 [D5] send_to_all: SETINFO output.powerfactor "0.8" >> 0.787953 [D5] send_to_all: SETINFO input.phases "1" >> 0.787957 [D5] send_to_all: SETINFO output.phases "1" >> 0.787961 [D5] send_to_all: SETINFO input.voltage.nominal "230.0" >> 0.789227 [D3] send: F >> 0.835919 [D5] read [ 0]: (8 bytes) => 23 32 32 30 2e 30 20 30 >> 0.875923 [D5] read [ 8]: (8 bytes) => 34 35 20 32 34 30 2e 30 >> 0.899925 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 >> 0.899931 [D3] read: #220.0 045 240.0 60.0 >> 0.899939 [D5] send_to_all: SETINFO input.current.nominal "45.0" >> 0.899945 [D5] send_to_all: SETINFO input.frequency.nominal "60.0" >> 0.901226 [D3] send: QMF >> 0.947921 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 >> 0.947927 [D3] read: (NAK >> 0.947930 [D2] qx_process_answer: query rejected by the UPS (device.mfr) >> 0.949218 [D3] send: QVFW >> 1.011917 [D5] read [ 0]: (8 bytes) => 28 56 45 52 46 57 3a 30 >> 1.043922 [D5] read [ 8]: (8 bytes) => 30 30 37 37 2e 31 33 0d >> 1.043927 [D3] read: (VERFW:00077.13 >> 1.043932 [D5] send_to_all: SETINFO ups.firmware "00077.13" >> 1.045155 [D3] send: QID >> 1.091916 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 >> 1.091920 [D3] read: (NAK >> 1.091923 [D2] qx_process_answer: query rejected by the UPS >> (device.serial) >> 1.093154 [D3] send: I >> 1.139915 [D5] read [ 0]: (8 bytes) => 20 20 20 20 20 20 20 20 >> 1.147922 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 >> 1.147928 [D3] read: >> 1.147930 [D2] qx_process_answer: short reply (device.mfr) >> 1.149214 [D3] send: QGS >> 1.203920 [D5] read [ 0]: (8 bytes) => 28 32 31 37 2e 38 20 35 >> 1.243920 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 32 30 2e >> 1.275916 [D5] read [ 16]: (8 bytes) => 34 20 36 30 2e 30 20 30 >> 1.315917 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 >> 1.347915 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 >> 1.379917 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 >> 1.419915 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d >> 1.451914 [D5] read [ 56]: (8 bytes) => 20 30 32 35 2e 32 20 31 >> 1.491911 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 1.507915 [D5] read [ 72]: (8 bytes) => 30 30 30 0d 20 32 37 32 >> 1.507921 [D3] read: (217.8 59.9 220.4 60.0 002.8 007 361.8 >> 361.8 272.9 ---.- 025.2 100000000000 >> 1.507934 [D5] send_to_all: SETINFO input.frequency "59.9" >> 1.507940 [D5] send_to_all: SETINFO output.voltage "220.4" >> 1.507944 [D5] send_to_all: SETINFO output.frequency "60.0" >> 1.507950 [D5] send_to_all: SETINFO output.current "2.8" >> 1.507954 [D5] send_to_all: SETINFO ups.load "7" >> 1.507959 [D5] send_to_all: SETINFO battery.voltage "272.9" >> 1.507964 [D5] send_to_all: SETINFO ups.temperature "25.2" >> 1.507971 [D5] send_to_all: SETINFO ups.type "online" >> 1.507975 [D5] update_status: OL >> 1.507977 [D5] update_status: !LB >> 1.507984 [D5] update_status: !CAL >> 1.507989 [D5] update_status: !FSD >> 1.507993 [D5] send_to_all: SETINFO ups.beeper.status "enabled" >> 1.509278 [D3] send: QMOD >> 1.547916 [D5] read [ 0]: (8 bytes) => 28 4c 0d 00 00 00 00 00 >> 1.547921 [D3] read: (L >> 1.547927 [D5] update_status: OL >> 1.549157 [D3] send: QWS >> 1.603912 [D5] read [ 0]: (8 bytes) => 28 30 30 30 30 30 30 30 >> 1.643913 [D5] read [ 8]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 1.675914 [D5] read [ 16]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 1.707913 [D5] read [ 24]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 1.747910 [D5] read [ 32]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 1.779908 [D5] read [ 40]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 1.819910 [D5] read [ 48]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 1.851911 [D5] read [ 56]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 1.859909 [D5] read [ 64]: (8 bytes) => 30 0d 30 30 30 30 30 30 >> 1.859913 [D3] read: >> (0000000000000000000000000000000000000000000000000000000000000000 >> 1.861214 [D3] send: QBV >> 1.915912 [D5] read [ 0]: (8 bytes) => 28 32 37 32 2e 39 20 32 >> 1.955910 [D5] read [ 8]: (8 bytes) => 30 20 30 31 20 31 30 30 >> 1.971911 [D5] read [ 16]: (8 bytes) => 20 30 31 30 0d 00 00 00 >> 1.971916 [D3] read: (272.9 20 01 100 010 >> 1.971921 battery_number: 20 >> 1.971927 battery_number, settable range: 1..9 >> 1.971933 [D5] send_to_all: SETINFO battery.packs "1" >> 1.971936 [D5] send_to_all: SETFLAGS battery.packs RW >> 1.971939 [D5] send_to_all: ADDRANGE battery.packs 1 99 >> 1.971942 [D5] send_to_all: SETFLAGS battery.packs RW NUMBER >> 1.971946 [D5] send_to_all: SETINFO battery.charge "100" >> 1.971950 [D5] send_to_all: SETINFO battery.runtime "600" >> 1.973146 [D3] send: QLDL >> 2.019909 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 >> 2.019914 [D3] read: (NAK >> 2.019920 [D2] qx_process_answer: query rejected by the UPS >> (output.power.minimum.percent) >> 2.019923 [D2] qx_process_answer: query rejected by the UPS >> (output.power.maximum.percent) >> 2.021213 [D3] send: QFLAG >> 2.083912 [D5] read [ 0]: (8 bytes) => 28 45 70 62 72 61 73 64 >> 2.123904 [D5] read [ 8]: (8 bytes) => 74 69 44 6f 76 65 66 6a >> 2.131908 [D5] read [ 16]: (8 bytes) => 6d 0d 00 00 00 00 00 00 >> 2.131913 [D3] read: (EpbrasdtiDovefjm >> 2.131928 [D5] send_to_all: SETINFO ups.start.auto "yes" >> 2.131931 [D5] send_to_all: SETFLAGS ups.start.auto RW >> 2.131935 [D5] send_to_all: ADDENUM ups.start.auto "no" >> 2.131938 [D5] send_to_all: ADDENUM ups.start.auto "yes" >> 2.131943 [D5] send_to_all: SETINFO battery.protection "yes" >> 2.131946 [D5] send_to_all: SETFLAGS battery.protection RW >> 2.131949 [D5] send_to_all: ADDENUM battery.protection "no" >> 2.131951 [D5] send_to_all: ADDENUM battery.protection "yes" >> 2.131956 [D4] ups_infoval_set: failed to preprocess value >> [battery.energysave: EpbrasdtiDovefjm] >> 2.131960 [D4] ups_infoval_set: failed to preprocess value >> [ups.start.battery: EpbrasdtiDovefjm] >> 2.131966 [D5] send_to_all: SETINFO outlet.0.switchable "no" >> 2.131969 [D5] send_to_all: SETFLAGS outlet.0.switchable RW >> 2.131972 [D5] send_to_all: ADDENUM outlet.0.switchable "no" >> 2.131974 [D5] send_to_all: ADDENUM outlet.0.switchable "yes" >> 2.131977 bypass_alarm: enabled >> 2.131982 battery_alarm: enabled >> 2.131987 bypass_when_off: disabled >> 2.132000 alarm_control: enabled >> 2.132003 converter_mode: disabled >> 2.132021 eco_mode: disabled >> 2.132025 battery_open_status_check: enabled >> 2.132028 bypass_forbidding: disabled >> 2.132033 [D4] ups_infoval_set: failed to preprocess value >> [site_fault_detection: EpbrasdtiDovefjm] >> 2.132036 [D4] ups_infoval_set: failed to preprocess value >> [advanced_eco_mode: EpbrasdtiDovefjm] >> 2.132039 [D4] ups_infoval_set: failed to preprocess value >> [constant_phase_angle: EpbrasdtiDovefjm] >> 2.132042 [D4] ups_infoval_set: failed to preprocess value >> [limited_runtime_on_battery: EpbrasdtiDovefjm] >> 2.132047 setvar(bypass_when_off, disabled) >> 2.132049 bypass_when_off is already disabled >> 2.132051 setvar: FAILED >> 2.133339 [D3] send: QHE >> 2.187906 [D5] read [ 0]: (8 bytes) => 28 32 33 31 20 32 30 39 >> 2.195908 [D5] read [ 8]: (8 bytes) => 20 0d 00 00 00 00 00 00 >> 2.195912 [D3] read: (231 209 >> 2.195925 [D5] send_to_all: SETINFO input.transfer.high "231" >> 2.195928 [D5] send_to_all: SETFLAGS input.transfer.high RW >> 2.195931 [D5] send_to_all: ADDRANGE input.transfer.high 231 244 >> 2.195933 [D5] send_to_all: SETFLAGS input.transfer.high RW NUMBER >> 2.195940 [D5] send_to_all: SETINFO input.transfer.low "209" >> 2.195943 [D5] send_to_all: SETFLAGS input.transfer.low RW >> 2.195946 [D5] send_to_all: ADDRANGE input.transfer.low 196 209 >> 2.195948 [D5] send_to_all: SETFLAGS input.transfer.low RW NUMBER >> 2.195952 [D5] send_to_all: SETINFO input.transfer.low.min "196" >> 2.195957 [D5] send_to_all: SETINFO input.transfer.low.max "209" >> 2.195962 [D5] send_to_all: SETINFO input.transfer.high.min "231" >> 2.195966 [D5] send_to_all: SETINFO input.transfer.high.max "244" >> 2.197269 [D3] send: QFRE >> 2.243908 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 >> 2.243913 [D3] read: (NAK >> 2.243916 [D2] qx_process_answer: query rejected by the UPS >> (input.frequency.high) >> 2.243919 [D2] qx_process_answer: query rejected by the UPS >> (input.frequency.low) >> 2.245272 [D3] send: QBYV >> 2.307907 [D5] read [ 0]: (8 bytes) => 28 32 36 34 20 31 31 30 >> 2.315910 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 >> 2.315915 [D3] read: (264 110 >> 2.315920 max_bypass_volt: 264 >> 2.315927 max_bypass_volt, settable range: 231..276 >> 2.315931 min_bypass_volt: 110 >> 2.315936 min_bypass_volt, settable range: 110..209 >> 2.317269 [D3] send: QBYF >> 2.379904 [D5] read [ 0]: (8 bytes) => 28 36 34 2e 30 20 35 36 >> 2.387902 [D5] read [ 8]: (8 bytes) => 2e 30 0d 00 00 00 00 00 >> 2.387906 [D3] read: (64.0 56.0 >> 2.387910 max_bypass_freq: 64.0 >> 2.387916 max_bypass_freq, settable range: 61.0..64.0 >> 2.387920 min_bypass_freq: 56.0 >> 2.387924 min_bypass_freq, settable range: 56.0..59.0 >> 2.387929 [D2] setvar: nothing to do... [battery_number] >> 2.389143 [D3] send: RE0 >> 2.619925 [D5] read [ 0]: (8 bytes) => 00 00 00 00 00 00 00 00 >> 3.622015 [D3] read: Connection timed out (-110) >> 3.622032 [D4] qx_process: failed to preprocess answer >> [battery.voltage.low] >> 3.623374 [D3] send: QPD >> 3.667908 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 >> 3.667920 [D3] read: (NAK >> 3.667928 [D2] qx_process_answer: query rejected by the UPS >> (input_phase_angle) >> 3.667933 [D2] qx_process_answer: query rejected by the UPS >> (output_phase_angle) >> 3.669140 [D3] send: QPAR >> 3.715928 [D5] read [ 0]: (8 bytes) => 28 30 31 0d 00 00 00 00 >> 3.715940 [D3] read: (01 >> ] 3.715946 [D2] voltronic_parallel: non numerical value >> [voltronic_parallel: 01 >> ] 3.715949 [D4] ups_infoval_set: failed to preprocess value >> [voltronic_parallel: 01 >> 3.715959 [D5] send_to_all: ADDCMD load.off >> 3.715962 [D5] send_to_all: ADDCMD load.on >> 3.715965 [D5] send_to_all: ADDCMD shutdown.return >> 3.715967 [D5] send_to_all: ADDCMD shutdown.stayoff >> 3.715970 [D5] send_to_all: ADDCMD shutdown.stop >> 3.715973 [D5] send_to_all: ADDCMD test.battery.start >> 3.715975 [D5] send_to_all: ADDCMD test.battery.start.deep >> 3.715978 [D5] send_to_all: ADDCMD test.battery.start.quick >> 3.715981 [D5] send_to_all: ADDCMD test.battery.stop >> 3.715984 [D5] send_to_all: ADDCMD beeper.toggle >> 3.715986 [D5] send_to_all: ADDCMD beeper.enable >> 3.715989 [D5] send_to_all: ADDCMD beeper.disable >> 3.715992 [D5] send_to_all: ADDCMD bypass.start >> 3.715994 [D5] send_to_all: ADDCMD bypass.stop >> 3.715998 [D5] send_to_all: SETINFO ups.delay.start "180" >> 3.716002 [D5] send_to_all: SETFLAGS ups.delay.start RW >> 3.716006 [D5] send_to_all: ADDRANGE ups.delay.start 0 599940 >> 3.716009 [D5] send_to_all: SETFLAGS ups.delay.start RW NUMBER >> 3.716012 [D5] send_to_all: SETINFO ups.delay.shutdown "30" >> 3.716015 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW >> 3.716027 [D5] send_to_all: ADDRANGE ups.delay.shutdown 12 5940 >> 3.716030 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW NUMBER >> 3.716034 No values for battery high/low voltages >> 3.716039 [D5] send_to_all: SETINFO battery.voltage.low "208.00" >> 3.716055 [D5] send_to_all: SETINFO battery.voltage.high "300.00" >> 3.716058 Using 'guesstimation' (low: 208.000000, high: 300.000000)! >> 3.716080 setvar(ups.delay.start, 60) >> 3.716093 [D2] setvar: setting server side variable ups.delay.start >> 3.716096 [D5] send_to_all: SETINFO ups.delay.start "60" >> 3.716099 setvar: SUCCEED >> 3.716113 setvar(ups.delay.shutdown, 12) >> 3.716116 [D2] setvar: setting server side variable ups.delay.shutdown >> 3.716119 [D5] send_to_all: SETINFO ups.delay.shutdown "12" >> 3.716121 setvar: SUCCEED >> 3.716127 [D5] send_to_all: SETINFO driver.parameter.pollfreq "30" >> 3.716133 [D5] send_to_all: SETINFO driver.state "init.updateinfo" >> 3.716136 [D1] upsdrv_updateinfo... >> 3.716138 [D1] Quick update... >> 3.717379 [D3] send: QGS >> 3.771896 [D5] read [ 0]: (8 bytes) => 28 32 31 36 2e 39 20 35 >> 3.811874 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 39 2e >> 3.843894 [D5] read [ 16]: (8 bytes) => 35 20 36 30 2e 30 20 30 >> 3.883889 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 >> 3.915894 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 >> 3.947892 [D5] read [ 40]: (8 bytes) => 36 31 2e 33 20 32 37 32 >> 3.987887 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d >> 4.019889 [D5] read [ 56]: (8 bytes) => 20 30 32 35 2e 34 20 31 >> 4.059890 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 4.075889 [D5] read [ 72]: (8 bytes) => 30 30 30 0d 20 32 37 32 >> 4.075894 [D3] read: (216.9 59.9 219.5 60.0 002.8 007 361.8 >> 361.3 272.9 ---.- 025.4 100000000000 >> 4.075899 [D5] update_status: OL >> 4.075902 [D5] update_status: !LB >> 4.075906 [D5] update_status: !CAL >> 4.075909 [D5] update_status: !FSD >> 4.075916 [D5] send_to_all: SETINFO ups.status "OL" >> 4.075919 [D5] send_to_all: DATAOK >> 4.075921 [D5] send_to_all: SETINFO driver.state "init.quiet" >> 4.075925 [D5] send_to_all: SETINFO driver.parameter.pollinterval "10" >> 4.075928 [D5] send_to_all: SETINFO driver.parameter.synchronous "yes" >> 4.075931 [D5] send_to_all: SETINFO driver.state "quiet" >> 4.075933 [D1] Driver initialization completed, beginning data >> dump (1 loops) >> 4.075936 [D5] send_to_all: SETINFO driver.state "updateinfo" >> 4.075938 [D1] upsdrv_updateinfo... >> 4.075940 [D1] Quick update... >> 4.077120 [D3] send: QGS >> 4.131888 [D5] read [ 0]: (8 bytes) => 28 32 31 36 2e 39 20 35 >> 4.171889 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 38 2e >> 4.203867 [D5] read [ 16]: (8 bytes) => 37 20 36 30 2e 30 20 30 >> 4.243908 [D5] read [ 24]: (8 bytes) => 30 33 2e 31 20 30 30 37 >> 4.275890 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 >> 4.315895 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 >> 4.347870 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d >> 4.379883 [D5] read [ 56]: (8 bytes) => 20 30 32 35 2e 32 20 31 >> 4.419889 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 4.435887 [D5] read [ 72]: (8 bytes) => 30 30 30 0d 20 32 37 32 >> 4.435892 [D3] read: (216.9 59.9 218.7 60.0 003.1 007 361.8 >> 361.8 272.9 ---.- 025.2 100000000000 >> 4.435898 [D5] update_status: OL >> 4.435901 [D5] update_status: !LB >> 4.435905 [D5] update_status: !CAL >> 4.435908 [D5] update_status: !FSD >> 4.435917 [D5] send_to_all: SETINFO driver.state "quiet" >> 4.435920 [D5] send_to_all: SETINFO driver.state "updateinfo" >> 4.435923 [D1] upsdrv_updateinfo... >> 4.435926 [D1] Quick update... >> 4.437133 [D3] send: QGS >> 4.491888 [D5] read [ 0]: (8 bytes) => 28 32 31 36 2e 39 20 35 >> 4.531888 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 39 2e >> 4.563888 [D5] read [ 16]: (8 bytes) => 35 20 35 39 2e 39 20 30 >> 4.603887 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 >> 4.635882 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 >> 4.667878 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 >> 4.707882 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d >> 4.739885 [D5] read [ 56]: (8 bytes) => 20 30 32 35 2e 32 20 31 >> 4.779885 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 4.795884 [D5] read [ 72]: (8 bytes) => 30 30 30 0d 20 32 37 32 >> 4.795889 [D3] read: (216.9 59.9 219.5 59.9 002.8 007 361.8 >> 361.8 272.9 ---.- 025.2 100000000000 >> 4.795893 [D5] update_status: OL >> 4.795897 [D5] update_status: !LB >> 4.795900 [D5] update_status: !CAL >> 4.795903 [D5] update_status: !FSD >> 4.795911 [D5] send_to_all: SETINFO driver.state "quiet" >> 4.795914 [D5] send_to_all: SETINFO driver.state "dumping" >> 4.795916 [D3] Entering dstate_dump >> battery.charge: 100 >> battery.packs: 1 >> battery.protection: yes >> battery.runtime: 600 >> battery.voltage: 272.9 >> battery.voltage.high: 300.00 >> battery.voltage.low: 208.00 >> battery.voltage.nominal: 240.0 >> device.model: G10K >> device.type: ups >> driver.name: nutdrv_qx >> driver.parameter.bypass_when_off: disabled >> driver.parameter.offdelay: 12 >> driver.parameter.ondelay: 60 >> driver.parameter.pollfreq: 30 >> driver.parameter.pollinterval: 10 >> driver.parameter.port: auto >> driver.parameter.synchronous: yes >> driver.state: dumping >> driver.version: Windows-v2.8.0-alpha3-1252-g757813e >> driver.version.data: Voltronic 0.07 >> driver.version.internal: 0.33 >> driver.version.usb: libusb-0.1 (or compat) >> input.current.nominal: 45.0 >> input.frequency: 59.9 >> input.frequency.nominal: 60.0 >> input.phases: 1 >> input.transfer.high: 231 >> input.transfer.high.max: 244 >> input.transfer.high.min: 231 >> input.transfer.low: 209 >> input.transfer.low.max: 209 >> input.transfer.low.min: 196 >> input.voltage: 216.9 >> input.voltage.nominal: 230.0 >> outlet.0.switchable: no >> output.current: 2.8 >> output.current.nominal: 45 >> output.frequency: 60.0 >> output.frequency.nominal: 60.0 >> output.phases: 1 >> output.powerfactor: 0.8 >> output.voltage: 220.4 >> output.voltage.nominal: 220.0 >> ups.beeper.status: enabled >> ups.delay.shutdown: 12 >> ups.delay.start: 60 >> ups.firmware: 00077.13 >> ups.firmware.aux: P02 >> ups.load: 7 >> ups.power.nominal: 10000 >> ups.productid: 5161 >> ups.start.auto: yes >> ups.status: OL >> ups.temperature: 25.2 >> ups.type: online >> ups.vendorid: 0665 >> 4.795978 [D5] send_to_all: SETINFO driver.state "cleanup.upsdrv" >> 4.795980 [D1] upsdrv_cleanup... >> 4.796001 [D5] send_to_all: SETINFO driver.state "cleanup.exit" >> >> 3KV: >> >./nutdrv_qx -a ftups -DDDDDD -d1 >> Network UPS Tools - Generic Q* USB/Serial driver 0.33 >> (Windows-v2.8.0-alpha3-1252-g757813e) >> USB communication driver (libusb 0.1) 0.44 >> 0.000000 [D1] debug level is '6' >> 0.001398 [D1] Succeeded to become_user(nut): now UID=57 GID=57 >> 0.001425 [D5] send_to_all: SETINFO device.type "ups" >> 0.001439 [D5] send_to_all: SETINFO driver.state "init.device" >> 0.001446 [D1] upsdrv_initups... >> 0.004450 [D3] usb_busses=0x16ed520 >> 0.004462 [D2] Checking device (0665/5161) (002/004) >> 0.004485 [D2] - VendorID: 0665 >> 0.004493 [D2] - ProductID: 5161 >> 0.004497 [D2] - Manufacturer: unknown >> 0.004501 [D2] - Product: unknown >> 0.004507 [D2] - Serial Number: unknown >> 0.004512 [D2] - Bus: 002 >> 0.004518 [D2] - Device: 004 >> 0.004523 [D2] - Device release number: 0002 >> 0.004535 [D2] Trying to match device >> 0.004540 [D3] match_function_regex: matching a device... >> 0.004546 [D2] Device matches >> 0.004579 [D3] nut_usb_set_altinterface: skipped >> usb_set_altinterface(udev, 0) >> 0.004589 [D5] send_to_all: SETINFO ups.vendorid "0665" >> 0.004596 [D5] send_to_all: SETINFO ups.productid "5161" >> 0.006922 [D3] send: QGS >> 0.071746 [D5] read [ 0]: (8 bytes) => 28 31 31 32 2e 30 20 35 >> 0.103746 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 31 30 39 2e >> 0.143746 [D5] read [ 16]: (8 bytes) => 36 20 36 30 2e 30 20 30 >> 0.175758 [D5] read [ 24]: (8 bytes) => 30 35 2e 32 20 30 31 39 >> 0.215704 [D5] read [ 32]: (8 bytes) => 20 31 38 31 2e 39 20 31 >> 0.255745 [D5] read [ 40]: (8 bytes) => 38 31 2e 37 20 30 38 32 >> 0.295743 [D5] read [ 48]: (8 bytes) => 2e 31 20 2d 2d 2d 2e 2d >> 0.359735 [D5] read [ 56]: (8 bytes) => 20 30 31 37 2e 33 20 31 >> 0.399731 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 0.415732 [D5] read [ 72]: (8 bytes) => 30 30 31 0d 00 00 00 00 >> 0.415742 [D3] read: (112.0 59.9 109.6 60.0 005.2 019 181.9 >> 181.7 082.1 ---.- 017.3 100000000001 >> 0.415780 [D5] send_to_all: SETINFO input.voltage "112.0" >> 0.418233 [D3] send: QPI >> 0.471737 [D5] read [ 0]: (8 bytes) => 28 50 49 30 31 0d 00 00 >> 0.471746 [D3] read: (PI01 >> 0.471830 [D5] send_to_all: SETINFO ups.firmware.aux "P01" >> 0.471847 Using protocol: Voltronic 0.07 >> 0.471854 [D5] send_to_all: SETINFO driver.state "init.quiet" >> 0.471863 [D5] send_to_all: SETINFO driver.version >> "Windows-v2.8.0-alpha3-1252-g757813e" >> 0.471870 [D5] send_to_all: SETINFO driver.version.internal "0.33" >> 0.471877 [D5] send_to_all: SETINFO driver.name "nutdrv_qx" >> 0.471884 [D5] send_to_all: SETINFO driver.state "init.info" >> 0.471889 [D1] upsdrv_initinfo... >> 0.471895 [D5] send_to_all: SETINFO driver.version.data "Voltronic 0.07" >> 0.474546 [D3] send: QRI >> 0.535733 [D5] read [ 0]: (8 bytes) => 28 31 31 30 2e 30 20 30 >> 0.575671 [D5] read [ 8]: (8 bytes) => 32 37 20 30 37 32 2e 30 >> 0.599742 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 >> 0.599752 [D3] read: (110.0 027 072.0 60.0 >> 0.599768 [D5] send_to_all: SETINFO output.voltage.nominal "110.0" >> 0.599790 [D5] send_to_all: SETINFO output.current.nominal "27" >> 0.599800 [D5] send_to_all: SETINFO battery.voltage.nominal "72.0" >> 0.599815 [D5] send_to_all: SETINFO output.frequency.nominal "60.0" >> 0.602586 [D3] send: QMD >> 0.663734 [D5] read [ 0]: (8 bytes) => 28 23 23 23 23 23 23 23 >> 0.695734 [D5] read [ 8]: (8 bytes) => 23 23 23 23 23 23 33 4b >> 0.735756 [D5] read [ 16]: (8 bytes) => 20 23 23 23 33 30 30 30 >> 0.775726 [D5] read [ 24]: (8 bytes) => 20 38 30 20 31 2f 31 20 >> 0.839731 [D5] read [ 32]: (8 bytes) => 31 31 30 20 31 31 30 20 >> 0.879779 [D5] read [ 40]: (8 bytes) => 30 36 20 31 32 2e 30 0d >> 0.879789 [D3] read: (#############3K ###3000 80 1/1 110 110 06 12.0 >> 0.879801 [D5] send_to_all: SETINFO device.model "3K" >> 0.879811 [D5] send_to_all: SETINFO ups.power.nominal "3000" >> 0.879822 [D5] send_to_all: SETINFO output.powerfactor "0.8" >> 0.879839 [D5] send_to_all: SETINFO input.phases "1" >> 0.879849 [D5] send_to_all: SETINFO output.phases "1" >> 0.879861 [D5] send_to_all: SETINFO input.voltage.nominal "110.0" >> 0.882293 [D3] send: F >> 0.935727 [D5] read [ 0]: (8 bytes) => 23 31 31 30 2e 30 20 30 >> 0.975673 [D5] read [ 8]: (8 bytes) => 32 37 20 30 37 32 2e 30 >> 0.999744 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 >> 0.999753 [D3] read: #110.0 027 072.0 60.0 >> 0.999770 [D5] send_to_all: SETINFO input.current.nominal "27.0" >> 0.999797 [D5] send_to_all: SETINFO input.frequency.nominal "60.0" >> 1.002589 [D3] send: QMF >> 1.055728 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 >> 1.055738 [D3] read: (NAK >> 1.055743 [D2] qx_process_answer: query rejected by the UPS (device.mfr) >> 1.057829 [D3] send: QVFW >> 1.119731 [D5] read [ 0]: (8 bytes) => 28 56 45 52 46 57 3a 30 >> 1.159735 [D5] read [ 8]: (8 bytes) => 30 32 30 34 2e 30 36 0d >> 1.159744 [D3] read: (VERFW:00204.06 >> 1.159752 [D5] send_to_all: SETINFO ups.firmware "00204.06" >> 1.161839 [D3] send: QID >> 1.223728 [D5] read [ 0]: (8 bytes) => 28 30 30 30 30 30 30 30 >> 1.263662 [D5] read [ 8]: (8 bytes) => 30 30 30 30 30 30 30 0d >> 1.263671 [D3] read: (00000000000000 >> 1.263677 device.serial: UPS reported a non-significant serial >> [00000000000000] >> 1.263681 [D4] ups_infoval_set: failed to preprocess value >> [device.serial: 00000000000000] >> 1.265586 [D3] send: I >> 1.319693 [D5] read [ 0]: (8 bytes) => 23 20 20 20 20 20 20 20 >> 1.359732 [D5] read [ 8]: (8 bytes) => 20 20 20 20 20 20 20 20 >> 1.391737 [D5] read [ 16]: (8 bytes) => 20 4c 56 20 33 4b 20 20 >> 1.431728 [D5] read [ 24]: (8 bytes) => 20 20 20 20 30 30 32 30 >> 1.463727 [D5] read [ 32]: (8 bytes) => 34 2e 30 36 20 20 0d 00 >> 1.463735 [D3] read: # LV 3K 00204.06 >> 1.463741 [D1] ups_infoval_set: non significant value [device.mfr] >> 1.466024 [D3] send: QGS >> 1.527728 [D5] read [ 0]: (8 bytes) => 28 31 31 31 2e 39 20 35 >> 1.559685 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 31 30 39 2e >> 1.607694 [D5] read [ 16]: (8 bytes) => 37 20 35 39 2e 39 20 30 >> 1.639730 [D5] read [ 24]: (8 bytes) => 30 36 2e 30 20 30 31 39 >> 1.679727 [D5] read [ 32]: (8 bytes) => 20 31 38 31 2e 39 20 31 >> 1.719718 [D5] read [ 40]: (8 bytes) => 38 31 2e 34 20 30 38 32 >> 1.759747 [D5] read [ 48]: (8 bytes) => 2e 31 20 2d 2d 2d 2e 2d >> 1.791722 [D5] read [ 56]: (8 bytes) => 20 30 31 37 2e 33 20 31 >> 1.831787 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 1.847731 [D5] read [ 72]: (8 bytes) => 30 30 31 0d 00 00 00 00 >> 1.847741 [D3] read: (111.9 59.9 109.7 59.9 006.0 019 181.9 >> 181.4 082.1 ---.- 017.3 100000000001 >> 1.847777 [D5] send_to_all: SETINFO input.frequency "59.9" >> 1.847790 [D5] send_to_all: SETINFO output.voltage "109.7" >> 1.847801 [D5] send_to_all: SETINFO output.frequency "59.9" >> 1.847815 [D5] send_to_all: SETINFO output.current "6.0" >> 1.847825 [D5] send_to_all: SETINFO ups.load "19" >> 1.847842 [D5] send_to_all: SETINFO battery.voltage "082.1" >> 1.847852 [D5] send_to_all: SETINFO ups.temperature "17.3" >> 1.847868 [D5] send_to_all: SETINFO ups.type "online" >> 1.847876 [D5] update_status: OL >> 1.847884 [D5] update_status: !LB >> 1.847896 [D5] update_status: !CAL >> 1.847915 [D5] update_status: !FSD >> 1.847925 [D5] send_to_all: SETINFO ups.beeper.status "enabled" >> 1.850541 [D3] send: QMOD >> 1.895719 [D5] read [ 0]: (8 bytes) => 28 4c 0d 00 00 00 00 00 >> 1.895728 [D3] read: (L >> 1.895735 [D5] update_status: OL >> 1.897650 [D3] send: QWS >> 1.959728 [D5] read [ 0]: (8 bytes) => 28 30 30 30 30 30 30 30 >> 1.991723 [D5] read [ 8]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 2.031725 [D5] read [ 16]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 2.063728 [D5] read [ 24]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 2.111710 [D5] read [ 32]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 2.143679 [D5] read [ 40]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 2.183721 [D5] read [ 48]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 2.215694 [D5] read [ 56]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 2.223724 [D5] read [ 64]: (8 bytes) => 30 0d 00 00 00 00 00 00 >> 2.223733 [D3] read: >> (0000000000000000000000000000000000000000000000000000000000000000 >> 2.225774 [D3] send: QBV >> 2.287722 [D5] read [ 0]: (8 bytes) => 28 30 38 32 2e 30 20 30 >> 2.343726 [D5] read [ 8]: (8 bytes) => 36 20 30 31 20 31 30 30 >> 2.367729 [D5] read [ 16]: (8 bytes) => 20 30 34 33 0d 00 00 00 >> 2.367738 [D3] read: (082.0 06 01 100 043 >> 2.367747 battery_number: 6 >> 2.367771 battery_number, settable range: 1..9 >> 2.367784 [D5] send_to_all: SETINFO battery.packs "1" >> 2.367791 [D5] send_to_all: SETFLAGS battery.packs RW >> 2.367797 [D5] send_to_all: ADDRANGE battery.packs 1 99 >> 2.367802 [D5] send_to_all: SETFLAGS battery.packs RW NUMBER >> 2.367811 [D5] send_to_all: SETINFO battery.charge "100" >> 2.367822 [D5] send_to_all: SETINFO battery.runtime "2580" >> 2.370574 [D3] send: QLDL >> 2.439727 [D5] read [ 0]: (8 bytes) => 28 30 31 38 20 30 31 39 >> 2.447733 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 >> 2.447742 [D3] read: (018 019 >> 2.447759 [D5] send_to_all: SETINFO output.power.minimum.percent "18" >> 2.447767 [D5] send_to_all: SETINFO output.power.maximum.percent "19" >> 2.450508 [D3] send: QFLAG >> 2.519703 [D5] read [ 0]: (8 bytes) => 28 45 70 62 72 61 73 68 >> 2.567706 [D5] read [ 8]: (8 bytes) => 63 7a 44 6f 76 65 67 66 >> 2.591737 [D5] read [ 16]: (8 bytes) => 6a 6c 6d 0d 00 00 00 00 >> 2.591747 [D3] read: (EpbrashczDovegfjlm >> 2.591775 [D5] send_to_all: SETINFO ups.start.auto "yes" >> 2.591793 [D5] send_to_all: SETFLAGS ups.start.auto RW >> 2.591800 [D5] send_to_all: ADDENUM ups.start.auto "no" >> 2.591808 [D5] send_to_all: ADDENUM ups.start.auto "yes" >> 2.591818 [D5] send_to_all: SETINFO battery.protection "yes" >> 2.591825 [D5] send_to_all: SETFLAGS battery.protection RW >> 2.591831 [D5] send_to_all: ADDENUM battery.protection "no" >> 2.591838 [D5] send_to_all: ADDENUM battery.protection "yes" >> 2.591863 [D5] send_to_all: SETINFO battery.energysave "no" >> 2.591870 [D5] send_to_all: SETFLAGS battery.energysave RW >> 2.591876 [D5] send_to_all: ADDENUM battery.energysave "no" >> 2.591883 [D5] send_to_all: ADDENUM battery.energysave "yes" >> 2.591897 [D5] send_to_all: SETINFO ups.start.battery "yes" >> 2.591904 [D5] send_to_all: SETFLAGS ups.start.battery RW >> 2.591912 [D5] send_to_all: ADDENUM ups.start.battery "no" >> 2.591918 [D5] send_to_all: ADDENUM ups.start.battery "yes" >> 2.591929 [D5] send_to_all: SETINFO outlet.0.switchable "no" >> 2.591935 [D5] send_to_all: SETFLAGS outlet.0.switchable RW >> 2.591942 [D5] send_to_all: ADDENUM outlet.0.switchable "no" >> 2.591949 [D5] send_to_all: ADDENUM outlet.0.switchable "yes" >> 2.591956 bypass_alarm: enabled >> 2.591966 battery_alarm: enabled >> 2.591981 bypass_when_off: disabled >> 2.592003 alarm_control: enabled >> 2.592012 converter_mode: disabled >> 2.592045 eco_mode: disabled >> 2.592053 [D4] ups_infoval_set: failed to preprocess value >> [battery_open_status_check: EpbrashczDovegfjlm] >> 2.592062 bypass_forbidding: disabled >> 2.592077 site_fault_detection: disabled >> 2.592084 [D4] ups_infoval_set: failed to preprocess value >> [advanced_eco_mode: EpbrashczDovegfjlm] >> 2.592092 [D4] ups_infoval_set: failed to preprocess value >> [constant_phase_angle: EpbrashczDovegfjlm] >> 2.592100 [D4] ups_infoval_set: failed to preprocess value >> [limited_runtime_on_battery: EpbrashczDovegfjlm] >> 2.592110 setvar(bypass_when_off, disabled) >> 2.592116 bypass_when_off is already disabled >> 2.592122 setvar: FAILED >> 2.594532 [D3] send: QHE >> 2.655731 [D5] read [ 0]: (8 bytes) => 28 31 31 36 20 31 30 34 >> 2.663729 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 >> 2.663738 [D3] read: (116 104 >> 2.663775 [D5] send_to_all: SETINFO input.transfer.high "116" >> 2.663785 [D5] send_to_all: SETFLAGS input.transfer.high RW >> 2.663792 [D5] send_to_all: ADDRANGE input.transfer.high 113 122 >> 2.663798 [D5] send_to_all: SETFLAGS input.transfer.high RW NUMBER >> 2.663813 [D5] send_to_all: SETINFO input.transfer.low "104" >> 2.663820 [D5] send_to_all: SETFLAGS input.transfer.low RW >> 2.663827 [D5] send_to_all: ADDRANGE input.transfer.low 98 107 >> 2.663834 [D5] send_to_all: SETFLAGS input.transfer.low RW NUMBER >> 2.663841 [D5] send_to_all: SETINFO input.transfer.low.min "98" >> 2.663851 [D5] send_to_all: SETINFO input.transfer.low.max "107" >> 2.663861 [D5] send_to_all: SETINFO input.transfer.high.min "113" >> 2.663871 [D5] send_to_all: SETINFO input.transfer.high.max "122" >> 2.666579 [D3] send: QFRE >> 2.719726 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 >> 2.719735 [D3] read: (NAK >> 2.719740 [D2] qx_process_answer: query rejected by the UPS >> (input.frequency.high) >> 2.719745 [D2] qx_process_answer: query rejected by the UPS >> (input.frequency.low) >> 2.722576 [D3] send: QBYV >> 2.791725 [D5] read [ 0]: (8 bytes) => 28 31 33 32 20 30 38 35 >> 2.799726 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 >> 2.799735 [D3] read: (132 085 >> 2.799743 max_bypass_volt: 132 >> 2.799750 max_bypass_volt, settable range: 120..140 >> 2.799770 min_bypass_volt: 85 >> 2.799779 min_bypass_volt, settable range: 85..115 >> 2.802578 [D3] send: QBYF >> 2.871702 [D5] read [ 0]: (8 bytes) => 28 36 33 2e 30 20 35 37 >> 2.879682 [D5] read [ 8]: (8 bytes) => 2e 30 0d 00 00 00 00 00 >> 2.879691 [D3] read: (63.0 57.0 >> 2.879699 max_bypass_freq: 63.0 >> 2.879706 max_bypass_freq, settable range: 61.0..70.0 >> 2.879731 min_bypass_freq: 57.0 >> 2.879742 min_bypass_freq, settable range: 50.0..59.0 >> 2.879753 [D2] setvar: nothing to do... [battery_number] >> 2.881579 [D3] send: RE0 >> 2.935705 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 >> 2.935720 [D3] read: (NAK >> 2.935732 [D2] qx_process_answer: query rejected by the UPS >> (battery.voltage.low) >> 2.937709 [D3] send: QPD >> 2.991705 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 >> 2.991721 [D3] read: (NAK >> 2.991731 [D2] qx_process_answer: query rejected by the UPS >> (input_phase_angle) >> 2.991737 [D2] qx_process_answer: query rejected by the UPS >> (output_phase_angle) >> 2.994569 [D3] send: QPAR >> 3.047721 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 >> 3.047731 [D3] read: (NAK >> 3.047735 [D2] qx_process_answer: query rejected by the UPS >> (voltronic_parallel) >> 3.047747 [D5] send_to_all: ADDCMD load.off >> 3.047764 [D5] send_to_all: ADDCMD load.on >> 3.047771 [D5] send_to_all: ADDCMD shutdown.return >> 3.047777 [D5] send_to_all: ADDCMD shutdown.stayoff >> 3.047784 [D5] send_to_all: ADDCMD shutdown.stop >> 3.047791 [D5] send_to_all: ADDCMD test.battery.start >> 3.047797 [D5] send_to_all: ADDCMD test.battery.start.deep >> 3.047804 [D5] send_to_all: ADDCMD test.battery.start.quick >> 3.047811 [D5] send_to_all: ADDCMD test.battery.stop >> 3.047816 [D5] send_to_all: ADDCMD beeper.toggle >> 3.047823 [D5] send_to_all: ADDCMD beeper.enable >> 3.047827 [D5] send_to_all: ADDCMD beeper.disable >> 3.047833 [D5] send_to_all: ADDCMD bypass.start >> 3.047838 [D5] send_to_all: ADDCMD bypass.stop >> 3.047845 [D5] send_to_all: SETINFO ups.delay.start "180" >> 3.047850 [D5] send_to_all: SETFLAGS ups.delay.start RW >> 3.047858 [D5] send_to_all: ADDRANGE ups.delay.start 0 599940 >> 3.047864 [D5] send_to_all: SETFLAGS ups.delay.start RW NUMBER >> 3.047872 [D5] send_to_all: SETINFO ups.delay.shutdown "30" >> 3.047878 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW >> 3.047885 [D5] send_to_all: ADDRANGE ups.delay.shutdown 12 5940 >> 3.047892 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW NUMBER >> 3.047899 No values for battery high/low voltages >> 3.047907 [D5] send_to_all: SETINFO battery.voltage.low "62.40" >> 3.047915 [D5] send_to_all: SETINFO battery.voltage.high "90.00" >> 3.047922 Using 'guesstimation' (low: 62.400000, high: 90.000000)! >> 3.047933 setvar(ups.delay.start, 60) >> 3.047942 [D2] setvar: setting server side variable ups.delay.start >> 3.047961 [D5] send_to_all: SETINFO ups.delay.start "60" >> 3.047966 setvar: SUCCEED >> 3.047974 setvar(ups.delay.shutdown, 30) >> 3.047980 setvar: nothing to do... [ups.delay.shutdown] >> 3.047991 [D5] send_to_all: SETINFO driver.parameter.pollfreq "30" >> 3.048002 [D5] send_to_all: SETINFO driver.state "init.updateinfo" >> 3.048008 [D1] upsdrv_updateinfo... >> 3.048014 [D1] Quick update... >> 3.050576 [D3] send: QGS >> 3.119624 [D5] read [ 0]: (8 bytes) => 28 31 31 32 2e 31 20 35 >> 3.151706 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 31 30 39 2e >> 3.191707 [D5] read [ 16]: (8 bytes) => 34 20 35 39 2e 39 20 30 >> 3.231641 [D5] read [ 24]: (8 bytes) => 30 35 2e 32 20 30 31 38 >> 3.263696 [D5] read [ 32]: (8 bytes) => 20 31 38 32 2e 33 20 31 >> 3.335720 [D5] read [ 40]: (8 bytes) => 38 31 2e 37 20 30 38 32 >> 3.367710 [D5] read [ 48]: (8 bytes) => 2e 31 20 2d 2d 2d 2e 2d >> 3.407696 [D5] read [ 56]: (8 bytes) => 20 30 31 37 2e 33 20 31 >> 3.439702 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 3.463711 [D5] read [ 72]: (8 bytes) => 30 30 31 0d 00 00 00 00 >> 3.463726 [D3] read: (112.1 59.9 109.4 59.9 005.2 018 182.3 >> 181.7 082.1 ---.- 017.3 100000000001 >> 3.463732 [D5] update_status: OL >> 3.463737 [D5] update_status: !LB >> 3.463742 [D5] update_status: !CAL >> 3.463759 [D5] update_status: !FSD >> 3.463768 [D5] send_to_all: SETINFO ups.status "OL" >> 3.463775 [D5] send_to_all: DATAOK >> 3.463781 [D5] send_to_all: SETINFO driver.state "init.quiet" >> 3.463789 [D5] send_to_all: SETINFO driver.parameter.pollinterval "10" >> 3.463796 [D5] send_to_all: SETINFO driver.parameter.synchronous "yes" >> 3.463804 [D5] send_to_all: SETINFO driver.state "quiet" >> 3.463810 [D1] Driver initialization completed, beginning data >> dump (1 loops) >> 3.463823 [D5] send_to_all: SETINFO driver.state "updateinfo" >> 3.463829 [D1] upsdrv_updateinfo... >> 3.463835 [D1] Quick update... >> 3.465994 [D3] send: QGS >> 3.527682 [D5] read [ 0]: (8 bytes) => 28 31 31 32 2e 30 20 35 >> 3.567709 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 31 30 39 2e >> 3.599709 [D5] read [ 16]: (8 bytes) => 35 20 35 39 2e 39 20 30 >> 3.639706 [D5] read [ 24]: (8 bytes) => 30 35 2e 32 20 30 31 39 >> 3.679721 [D5] read [ 32]: (8 bytes) => 20 31 38 32 2e 34 20 31 >> 3.719719 [D5] read [ 40]: (8 bytes) => 38 31 2e 36 20 30 38 32 >> 3.751702 [D5] read [ 48]: (8 bytes) => 2e 31 20 2d 2d 2d 2e 2d >> 3.815719 [D5] read [ 56]: (8 bytes) => 20 30 31 37 2e 33 20 31 >> 3.855707 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 3.871704 [D5] read [ 72]: (8 bytes) => 30 30 31 0d 00 00 00 00 >> 3.871719 [D3] read: (112.0 59.9 109.5 59.9 005.2 019 182.4 >> 181.6 082.1 ---.- 017.3 100000000001 >> 3.871725 [D5] update_status: OL >> 3.871730 [D5] update_status: !LB >> 3.871734 [D5] update_status: !CAL >> 3.871751 [D5] update_status: !FSD >> 3.871759 [D5] send_to_all: SETINFO driver.state "quiet" >> 3.871765 [D5] send_to_all: SETINFO driver.state "updateinfo" >> 3.871771 [D1] upsdrv_updateinfo... >> 3.871776 [D1] Quick update... >> 3.874334 [D3] send: QGS >> 3.935702 [D5] read [ 0]: (8 bytes) => 28 31 31 32 2e 31 20 35 >> 3.975637 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 31 30 39 2e >> 4.007635 [D5] read [ 16]: (8 bytes) => 36 20 35 39 2e 39 20 30 >> 4.047703 [D5] read [ 24]: (8 bytes) => 30 35 2e 33 20 30 31 38 >> 4.079697 [D5] read [ 32]: (8 bytes) => 20 31 38 32 2e 30 20 31 >> 4.119683 [D5] read [ 40]: (8 bytes) => 38 31 2e 36 20 30 38 32 >> 4.151690 [D5] read [ 48]: (8 bytes) => 2e 31 20 2d 2d 2d 2e 2d >> 4.191696 [D5] read [ 56]: (8 bytes) => 20 30 31 37 2e 33 20 31 >> 4.231651 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 >> 4.247736 [D5] read [ 72]: (8 bytes) => 30 30 31 0d 00 00 00 00 >> 4.247746 [D3] read: (112.1 59.9 109.6 59.9 005.3 018 182.0 >> 181.6 082.1 ---.- 017.3 100000000001 >> 4.247757 [D5] update_status: OL >> 4.247764 [D5] update_status: !LB >> 4.247781 [D5] update_status: !CAL >> 4.247786 [D5] update_status: !FSD >> 4.247803 [D5] send_to_all: SETINFO driver.state "quiet" >> 4.247810 [D5] send_to_all: SETINFO driver.state "dumping" >> 4.247815 [D3] Entering dstate_dump >> battery.charge: 100 >> battery.energysave: no >> battery.packs: 1 >> battery.protection: yes >> battery.runtime: 2580 >> battery.voltage: 082.1 >> battery.voltage.high: 90.00 >> battery.voltage.low: 62.40 >> battery.voltage.nominal: 72.0 >> device.model: 3K >> device.type: ups >> driver.name: nutdrv_qx >> driver.parameter.bypass_when_off: disabled >> driver.parameter.offdelay: 30 >> driver.parameter.ondelay: 60 >> driver.parameter.pollfreq: 30 >> driver.parameter.pollinterval: 10 >> driver.parameter.port: auto >> driver.parameter.synchronous: yes >> driver.state: dumping >> driver.version: Windows-v2.8.0-alpha3-1252-g757813e >> driver.version.data: Voltronic 0.07 >> driver.version.internal: 0.33 >> driver.version.usb: libusb-0.1 (or compat) >> input.current.nominal: 27.0 >> input.frequency: 59.9 >> input.frequency.nominal: 60.0 >> input.phases: 1 >> input.transfer.high: 116 >> input.transfer.high.max: 122 >> input.transfer.high.min: 113 >> input.transfer.low: 104 >> input.transfer.low.max: 107 >> input.transfer.low.min: 98 >> input.voltage: 112.0 >> input.voltage.nominal: 110.0 >> outlet.0.switchable: no >> output.current: 6.0 >> output.current.nominal: 27 >> output.frequency: 59.9 >> output.frequency.nominal: 60.0 >> output.phases: 1 >> output.power.maximum.percent: 19 >> output.power.minimum.percent: 18 >> output.powerfactor: 0.8 >> output.voltage: 109.7 >> output.voltage.nominal: 110.0 >> ups.beeper.status: enabled >> ups.delay.shutdown: 30 >> ups.delay.start: 60 >> ups.firmware: 00204.06 >> ups.firmware.aux: P01 >> ups.load: 19 >> ups.power.nominal: 3000 >> ups.productid: 5161 >> ups.start.auto: yes >> ups.start.battery: yes >> ups.status: OL >> ups.temperature: 17.3 >> ups.type: online >> ups.vendorid: 0665 >> 4.247957 [D5] send_to_all: SETINFO driver.state "cleanup.upsdrv" >> 4.247964 [D1] upsdrv_cleanup... >> 4.248000 [D5] send_to_all: SETINFO driver.state "cleanup.exit" >> >> 2KV: >> >./nutdrv_qx -a ftups -DDDDDD -d1 >> Network UPS Tools - Generic Q* USB/Serial driver 0.33 >> (Windows-v2.8.0-alpha3-1252-g757813e) >> USB communication driver (libusb 0.1) 0.44 >> 0.000000 [D1] debug level is '6' >> 0.000741 [D1] Succeeded to become_user(nut): now UID=57 GID=57 >> 0.000767 [D5] send_to_all: SETINFO device.type "ups" >> 0.000787 [D5] send_to_all: SETINFO driver.state "init.device" >> 0.000797 [D1] upsdrv_initups... >> 0.005897 [D3] usb_busses=0x1c571b0 >> 0.005925 [D2] Checking device (046D/C31D) (002/006) >> 0.005975 [D1] Failed to open device (046D/C31D), skipping: >> Permission denied >> 0.005998 [D2] Checking device (15D9/0A4F) (002/005) >> 0.006017 [D1] Failed to open device (15D9/0A4F), skipping: >> Permission denied >> 0.006028 [D2] Checking device (1A40/0101) (002/004) >> 0.006044 [D1] Failed to open device (1A40/0101), skipping: >> Permission denied >> 0.006054 [D2] Checking device (0665/5161) (002/003) >> 0.006809 [D1] libusb_open get iManufacturer failed, retrying... >> 0.010168 [D2] - VendorID: 0665 >> 0.010191 [D2] - ProductID: 5161 >> 0.010201 [D2] - Manufacturer: INNO TECH >> 0.010209 [D2] - Product: USB to Serial >> 0.010217 [D2] - Serial Number: unknown >> 0.010225 [D2] - Bus: 002 >> 0.010233 [D2] - Device: 003 >> 0.010241 [D2] - Device release number: 0002 >> 0.010249 [D2] Trying to match device >> 0.010258 [D3] match_function_regex: matching a device... >> 0.010268 [D2] Device matches >> 0.010304 [D3] nut_usb_set_altinterface: skipped >> usb_set_altinterface(udev, 0) >> 0.010322 [D5] send_to_all: SETINFO ups.vendorid "0665" >> 0.010334 [D5] send_to_all: SETINFO ups.productid "5161" >> 0.011139 [D3] send: QGS >> 0.154938 [D5] read [ 0]: (8 bytes) => 51 47 53 0d 00 00 00 00 >> 0.154969 [D3] read: QGS >> 0.154996 [D2] qx_process_answer: short reply (input.voltage) >> 0.155673 [D3] send: QGS >> 0.298945 [D5] read [ 0]: (8 bytes) => 51 47 53 0d 00 00 00 00 >> 0.298992 [D3] read: QGS >> 0.299006 [D2] qx_process_answer: short reply (input.voltage) >> 0.299794 [D3] send: QGS >> 0.443936 [D5] read [ 0]: (8 bytes) => 51 47 53 0d 00 00 00 00 >> 0.443990 [D3] read: QGS >> 0.444019 [D2] qx_process_answer: short reply (input.voltage) >> 0.444777 [D3] send: M >> 0.568954 [D5] read [ 0]: (8 bytes) => 56 0d 00 00 00 00 00 00 >> 0.569023 [D3] read: V >> 0.569077 [D2] voltronic_qs_protocol: detected V protocol [V] >> 0.569115 [D5] send_to_all: SETINFO ups.firmware.aux "PM-V" >> 0.569807 [D3] send: QS >> 0.620945 [D5] read [ 0]: (8 bytes) => 28 31 32 31 2e 38 20 31 >> 0.653944 [D5] read [ 8]: (8 bytes) => 32 30 2e 37 20 31 30 32 >> 0.686967 [D5] read [ 16]: (8 bytes) => 2e 33 20 30 33 32 20 36 >> 0.719956 [D5] read [ 24]: (8 bytes) => 30 2e 32 20 31 33 2e 35 >> 0.752941 [D5] read [ 32]: (8 bytes) => 20 2d 2d 2e 2d 20 30 30 >> 0.885947 [D5] read [ 40]: (8 bytes) => 31 30 31 30 30 31 0d 00 >> 0.886001 [D3] read: (121.8 120.7 102.3 032 60.2 13.5 --.- 00101001 >> 0.886086 [D5] send_to_all: SETINFO input.voltage "121.8" >> 0.886116 Using protocol: Voltronic-QS 0.09 >> 0.886146 [D5] send_to_all: SETINFO driver.state "init.quiet" >> 0.886191 [D5] send_to_all: SETINFO driver.version >> "Windows-v2.8.0-alpha3-1252-g757813e" >> 0.886221 [D5] send_to_all: SETINFO driver.version.internal "0.33" >> 0.886250 [D5] send_to_all: SETINFO driver.name "nutdrv_qx" >> 0.886279 [D5] send_to_all: SETINFO driver.state "init.info" >> 0.886310 [D1] upsdrv_initinfo... >> 0.886353 [D5] send_to_all: SETINFO driver.version.data >> "Voltronic-QS 0.09" >> 0.887174 [D3] send: QS >> 0.937952 [D5] read [ 0]: (8 bytes) => 28 31 32 30 2e 37 20 31 >> 0.970963 [D5] read [ 8]: (8 bytes) => 32 30 2e 36 20 31 30 33 >> 1.003970 [D5] read [ 16]: (8 bytes) => 2e 32 20 30 33 33 20 36 >> 1.036953 [D5] read [ 24]: (8 bytes) => 30 2e 32 20 31 33 2e 35 >> 1.070969 [D5] read [ 32]: (8 bytes) => 20 2d 2d 2e 2d 20 30 30 >> 1.203956 [D5] read [ 40]: (8 bytes) => 31 30 31 30 30 31 0d 00 >> 1.204016 [D3] read: (120.7 120.6 103.2 033 60.2 13.5 --.- 00101001 >> 1.204064 [D5] send_to_all: SETINFO input.voltage.fault "120.6" >> 1.204126 [D5] send_to_all: SETINFO output.voltage "103.2" >> 1.204165 [D5] send_to_all: SETINFO ups.load "33" >> 1.204231 [D5] send_to_all: SETINFO output.frequency "60.2" >> 1.204269 [D5] send_to_all: SETINFO battery.voltage "13.5" >> 1.204326 [D2] ups_infoval_set: non numerical value >> [ups.temperature: --.-] >> 1.204358 [D5] update_status: OL >> 1.204388 [D5] update_status: !LB >> 1.204429 [D5] update_status: TRIM >> 1.204476 [D5] send_to_all: SETINFO ups.type "offline / line interactive" >> 1.204510 [D5] update_status: !CAL >> 1.204577 [D5] update_status: !FSD >> 1.204613 [D5] send_to_all: SETINFO ups.beeper.status "enabled" >> 1.205300 [D3] send: F >> 1.249958 [D5] read [ 0]: (8 bytes) => 23 31 31 30 2e 30 20 30 >> 1.283966 [D5] read [ 8]: (8 bytes) => 30 36 20 31 32 2e 30 30 >> 1.412963 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 >> 1.413022 [D3] read: #110.0 006 12.00 60.0 >> 1.413067 [D5] send_to_all: SETINFO output.voltage.nominal "110" >> 1.413115 [D5] send_to_all: SETINFO output.current.nominal "6.0" >> 1.413195 [D5] send_to_all: SETINFO battery.voltage.nominal "12.0" >> 1.413232 [D5] send_to_all: SETINFO output.frequency.nominal "60" >> 1.413288 [D5] send_to_all: ADDCMD beeper.toggle >> 1.413320 [D5] send_to_all: ADDCMD load.off >> 1.413354 [D5] send_to_all: ADDCMD load.on >> 1.413383 [D5] send_to_all: ADDCMD shutdown.return >> 1.413413 [D5] send_to_all: ADDCMD shutdown.stayoff >> 1.413442 [D5] send_to_all: ADDCMD shutdown.stop >> 1.413470 [D5] send_to_all: ADDCMD test.battery.start.quick >> 1.413507 [D5] send_to_all: SETINFO ups.delay.start "180" >> 1.413579 [D5] send_to_all: SETFLAGS ups.delay.start RW >> 1.413615 [D5] send_to_all: ADDRANGE ups.delay.start 60 599940 >> 1.413655 [D5] send_to_all: SETFLAGS ups.delay.start RW NUMBER >> 1.413685 [D5] send_to_all: SETINFO ups.delay.shutdown "30" >> 1.413718 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW >> 1.413751 [D5] send_to_all: ADDRANGE ups.delay.shutdown 12 540 >> 1.413779 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW NUMBER >> 1.413814 No values for battery high/low voltages >> 1.413846 [D5] send_to_all: SETINFO battery.voltage.low "10.40" >> 1.413883 [D5] send_to_all: SETINFO battery.voltage.high "15.00" >> 1.413911 Using 'guesstimation' (low: 10.400000, high: 15.000000)! >> 1.413944 [D5] send_to_all: SETINFO battery.charge "67" >> 1.413973 Autodetected 1 as number of battery packs [12/13.50] >> 1.413999 Battery runtime will not be calculated (runtimecal not set) >> 1.414030 setvar(ups.delay.start, 60) >> 1.414058 [D2] setvar: setting server side variable ups.delay.start >> 1.414092 [D5] send_to_all: SETINFO ups.delay.start "60" >> 1.414117 setvar: SUCCEED >> 1.414144 setvar(ups.delay.shutdown, 30) >> 1.414170 setvar: nothing to do... [ups.delay.shutdown] >> 1.414201 [D5] send_to_all: SETINFO driver.parameter.pollfreq "30" >> 1.414237 [D5] send_to_all: SETINFO driver.state "init.updateinfo" >> 1.414269 [D1] upsdrv_updateinfo... >> 1.414294 [D1] Quick update... >> 1.414924 [D3] send: QS >> 1.465959 [D5] read [ 0]: (8 bytes) => 28 31 32 30 2e 37 20 31 >> 1.498927 [D5] read [ 8]: (8 bytes) => 32 30 2e 36 20 31 30 32 >> 1.531968 [D5] read [ 16]: (8 bytes) => 2e 33 20 30 33 33 20 36 >> 1.565953 [D5] read [ 24]: (8 bytes) => 30 2e 32 20 31 33 2e 35 >> 1.598962 [D5] read [ 32]: (8 bytes) => 20 2d 2d 2e 2d 20 30 30 >> 1.731977 [D5] read [ 40]: (8 bytes) => 31 30 31 30 30 31 0d 00 >> 1.732034 [D3] read: (120.7 120.6 102.3 033 60.2 13.5 --.- 00101001 >> 1.732101 [D5] update_status: OL >> 1.732144 [D5] update_status: !LB >> 1.732178 [D5] update_status: TRIM >> 1.732218 [D5] update_status: !CAL >> 1.732247 [D5] update_status: !FSD >> 1.732281 [D5] send_to_all: SETINFO ups.status "OL TRIM" >> 1.732309 [D5] send_to_all: DATAOK >> 1.732347 [D5] send_to_all: SETINFO driver.state "init.quiet" >> 1.732377 [D5] send_to_all: SETINFO driver.parameter.pollinterval "10" >> 1.732418 [D5] send_to_all: SETINFO driver.parameter.synchronous "yes" >> 1.732449 [D5] send_to_all: SETINFO driver.state "quiet" >> 1.732475 [D1] Driver initialization completed, beginning data >> dump (1 loops) >> 1.732516 [D5] send_to_all: SETINFO driver.state "updateinfo" >> 1.732573 [D1] upsdrv_updateinfo... >> 1.732623 [D1] Quick update... >> 1.733310 [D3] send: QS >> 1.783966 [D5] read [ 0]: (8 bytes) => 28 31 32 30 2e 36 20 31 >> 1.816932 [D5] read [ 8]: (8 bytes) => 32 30 2e 36 20 31 30 32 >> 1.849963 [D5] read [ 16]: (8 bytes) => 2e 33 20 30 33 32 20 36 >> 1.883966 [D5] read [ 24]: (8 bytes) => 30 2e 32 20 31 33 2e 35 >> 1.916969 [D5] read [ 32]: (8 bytes) => 20 2d 2d 2e 2d 20 30 30 >> 2.049989 [D5] read [ 40]: (8 bytes) => 31 30 31 30 30 31 0d 00 >> 2.050046 [D3] read: (120.6 120.6 102.3 032 60.2 13.5 --.- 00101001 >> 2.050112 [D5] update_status: OL >> 2.050153 [D5] update_status: !LB >> 2.050187 [D5] update_status: TRIM >> 2.050217 [D5] update_status: !CAL >> 2.050245 [D5] update_status: !FSD >> 2.050279 [D5] send_to_all: SETINFO driver.state "quiet" >> 2.050309 [D5] send_to_all: SETINFO driver.state "updateinfo" >> 2.050358 [D1] upsdrv_updateinfo... >> 2.050384 [D1] Quick update... >> 2.051194 [D3] send: QS >> 2.101980 [D5] read [ 0]: (8 bytes) => 28 31 32 30 2e 36 20 31 >> 2.134979 [D5] read [ 8]: (8 bytes) => 32 31 2e 38 20 31 30 33 >> 2.167958 [D5] read [ 16]: (8 bytes) => 2e 32 20 30 33 32 20 36 >> 2.201976 [D5] read [ 24]: (8 bytes) => 30 2e 32 20 31 33 2e 35 >> 2.234974 [D5] read [ 32]: (8 bytes) => 20 2d 2d 2e 2d 20 30 30 >> 2.367963 [D5] read [ 40]: (8 bytes) => 31 30 31 30 30 31 0d 00 >> 2.368024 [D3] read: (120.6 121.8 103.2 032 60.2 13.5 --.- 00101001 >> 2.368090 [D5] update_status: OL >> 2.368144 [D5] update_status: !LB >> 2.368179 [D5] update_status: TRIM >> 2.368210 [D5] update_status: !CAL >> 2.368239 [D5] update_status: !FSD >> 2.368283 [D5] send_to_all: SETINFO driver.state "quiet" >> 2.368313 [D5] send_to_all: SETINFO driver.state "dumping" >> 2.368349 [D3] Entering dstate_dump >> battery.charge: 67 >> battery.voltage: 13.5 >> battery.voltage.high: 15.00 >> battery.voltage.low: 10.40 >> battery.voltage.nominal: 12.0 >> device.type: ups >> driver.name: nutdrv_qx >> driver.parameter.bypass_when_off: disabled >> driver.parameter.offdelay: 30 >> driver.parameter.ondelay: 60 >> driver.parameter.pollfreq: 30 >> driver.parameter.pollinterval: 10 >> driver.parameter.port: auto >> driver.parameter.synchronous: yes >> driver.state: dumping >> driver.version: Windows-v2.8.0-alpha3-1252-g757813e >> driver.version.data: Voltronic-QS 0.09 >> driver.version.internal: 0.33 >> driver.version.usb: libusb-0.1 (or compat) >> input.voltage: 121.8 >> input.voltage.fault: 120.6 >> output.current.nominal: 6.0 >> output.frequency: 60.2 >> output.frequency.nominal: 60 >> output.voltage: 103.2 >> output.voltage.nominal: 110 >> ups.beeper.status: enabled >> ups.delay.shutdown: 30 >> ups.delay.start: 60 >> ups.firmware.aux: PM-V >> ups.load: 33 >> ups.productid: 5161 >> ups.status: OL TRIM >> ups.type: offline / line interactive >> ups.vendorid: 0665 >> 2.368829 [D5] send_to_all: SETINFO driver.state "cleanup.upsdrv" >> 2.368859 [D1] upsdrv_cleanup... >> 2.368922 [D5] send_to_all: SETINFO driver.state "cleanup.exit"
d tbsky
2023-Sep-13 13:26 UTC
[Nut-upsdev] [Nut-upsuser] PR to test for users of Qx devices (blazer and nutdrv_qx)
jim Klimov <jimklimov+nut at gmail.com>> > Hello all, > > Had another hard look at the PR for QX device voltage/charge/runtime fixes for some broken use-cases (AND hoping to not introduce problems for cases that were not broken), and hopefully found and rolled back the change which in fact introduced the strangeness found in our winter round of tests. Then the year was busy... > > As before, the context for this is: > * issue https://github.com/networkupstools/nut/issues/1279 > * PR https://github.com/networkupstools/nut/pull/1652 > * PR source git branch (code to build for tests) https://github.com/jimklimov/nut/tree/issue-1279 > * https://github.com/networkupstools/nut/wiki/Building-NUT-for-in%E2%80%90place-upgrades-or-non%E2%80%90disruptive-tests suggests how to quickly build andHi: one of our voltronic ups caught fire last year. so we abandoned them and bought APC. now I have only one 10KV ups to test. It's sad because I like nutdrv_qx driver. APC microlink is too bad since nut doesn't support it. there is only modbus with apcupsd driver. BTW I saw an APC ups discussion at nut-upsdev about "SRVS1KI"(can not reply, not subscribed to that list) . I have that easy-ups series. nut can support them well with apcsmart driver. normally we should attach it via serial cable. if you attach the ups with usb cable, you will see "XR21V1410" which is a usb-serial converter. linux kernel 5.15 seems include the driver. or you will need to compile the driver(xr_usb_serial_common) yourself and get "/dev/ttyXRUSB0" to use as an serial port. I do that because we lost serial cable at a remote site and forced to use the usb cable.> ./nutdrv_qx -a ftups -u root -DDDDDD -d1Network UPS Tools - Generic Q* USB/Serial driver 0.35 (2.8.0-2359-g6c0032e52) USB communication driver (libusb 1.0) 0.45 0.000000 [D1] Network UPS Tools version 2.8.0-2359-g6c0032e52 (release/snapshot of 2.8.0.1) built with gcc (GCC) 11.3.1 20221121 (Red Hat 11.3.1-4) and configured with flags: --enable-Wcolor --enable-keep_nut_report_featu re --with-all=auto --with-cgi=auto --with-serial=auto --with-dev=auto --with-doc=skip --with-nut_monitor=auto --with-pynut=auto --disable-force-nut-version-header --enable-check-NIT --enable-maintainer-mode 0.000011 [D1] debug level is '6' 0.000014 [D5] send_to_all: SETINFO driver.debug "6" 0.000018 [D5] send_to_all: SETFLAGS driver.debug RW NUMBER 0.000815 [D1] Succeeded to become_user(root): now UID=0 GID=0 0.000822 [D5] send_to_all: SETINFO device.type "ups" 0.000825 [D5] send_to_all: SETINFO driver.state "init.device" 0.000827 [D1] upsdrv_initups... 0.003147 [D2] Checking device 1 of 11 (8087/8000) 0.057855 [D2] - VendorID: 8087 0.057861 [D2] - ProductID: 8000 0.057862 [D2] - Manufacturer: unknown 0.057864 [D2] - Product: unknown 0.057865 [D2] - Serial Number: unknown 0.057867 [D2] - Bus: 002 0.057868 [D2] - Device: 002 0.057870 [D2] - Device release number: 0005 0.057873 [D2] Trying to match device 0.057875 [D3] match_function_regex: matching a device... 0.057888 [D2] Device does not match - skipping 0.071830 [D2] Checking device 2 of 11 (1D6B/0002) 0.078881 [D2] - VendorID: 1d6b 0.078885 [D2] - ProductID: 0002 0.078887 [D2] - Manufacturer: Linux 5.14.0-162.23.1.el9_1.x86_64 ehci_hcd 0.078888 [D2] - Product: EHCI Host Controller 0.078890 [D2] - Serial Number: 0000:00:1d.0 0.078891 [D2] - Bus: 002 0.078893 [D2] - Device: 001 0.078894 [D2] - Device release number: 0514 0.078897 [D2] Trying to match device 0.078898 [D3] match_function_regex: matching a device... 0.078912 [D2] Device does not match - skipping 0.091359 [D2] Checking device 3 of 11 (8087/8008) 0.145626 [D2] - VendorID: 8087 0.145635 [D2] - ProductID: 8008 0.145637 [D2] - Manufacturer: unknown 0.145638 [D2] - Product: unknown 0.145640 [D2] - Serial Number: unknown 0.145641 [D2] - Bus: 001 0.145643 [D2] - Device: 002 0.145645 [D2] - Device release number: 0005 0.145648 [D2] Trying to match device 0.145661 [D3] match_function_regex: matching a device... 0.145664 [D2] Device does not match - skipping 0.159837 [D2] Checking device 4 of 11 (1D6B/0002) 0.166862 [D2] - VendorID: 1d6b 0.166867 [D2] - ProductID: 0002 0.166868 [D2] - Manufacturer: Linux 5.14.0-162.23.1.el9_1.x86_64 ehci_hcd 0.166870 [D2] - Product: EHCI Host Controller 0.166871 [D2] - Serial Number: 0000:00:1a.0 0.166873 [D2] - Bus: 001 0.166874 [D2] - Device: 001 0.166876 [D2] - Device release number: 0514 0.166878 [D2] Trying to match device 0.166880 [D3] match_function_regex: matching a device... 0.166894 [D2] Device does not match - skipping 0.179366 [D2] Checking device 5 of 11 (1D6B/0003) 0.200847 [D2] - VendorID: 1d6b 0.200851 [D2] - ProductID: 0003 0.200853 [D2] - Manufacturer: Linux 5.14.0-162.23.1.el9_1.x86_64 xhci-hcd 0.200854 [D2] - Product: xHCI Host Controller 0.200856 [D2] - Serial Number: 0000:00:14.0 0.200857 [D2] - Bus: 004 0.200858 [D2] - Device: 001 0.200860 [D2] - Device release number: 0514 0.200862 [D2] Trying to match device 0.200864 [D3] match_function_regex: matching a device... 0.200877 [D2] Device does not match - skipping 0.200931 [D2] Checking device 6 of 11 (9966/0202) 0.202237 [D2] - VendorID: 9966 0.202254 [D2] - ProductID: 0202 0.202256 [D2] - Manufacturer: PSTEK 0.202268 [D2] - Product: PSTEK Combo KVM 8/16 V:2.00 0.202269 [D2] - Serial Number: unknown 0.202271 [D2] - Bus: 003 0.202272 [D2] - Device: 003 0.202274 [D2] - Device release number: 0000 0.202275 [D2] Trying to match device 0.202276 [D3] match_function_regex: matching a device... 0.202279 [D2] Device does not match - skipping 0.202300 [D2] Checking device 7 of 11 (0557/2419) 0.202309 [D2] - VendorID: 0557 0.202327 [D2] - ProductID: 2419 0.202329 [D2] - Manufacturer: unknown 0.202331 [D2] - Product: unknown 0.202334 [D2] - Serial Number: unknown 0.202346 [D2] - Bus: 003 0.202348 [D2] - Device: 004 0.202350 [D2] - Device release number: 0100 0.202353 [D2] Trying to match device 0.202365 [D3] match_function_regex: matching a device... 0.202367 [D2] Device does not match - skipping 0.202371 [D2] Checking device 8 of 11 (0557/7000) 0.202377 [D2] - VendorID: 0557 0.202379 [D2] - ProductID: 7000 0.202380 [D2] - Manufacturer: unknown 0.202382 [D2] - Product: unknown 0.202384 [D2] - Serial Number: unknown 0.202386 [D2] - Bus: 003 0.202389 [D2] - Device: 002 0.202391 [D2] - Device release number: 0000 0.202393 [D2] Trying to match device 0.202395 [D3] match_function_regex: matching a device... 0.202398 [D2] Device does not match - skipping 0.202402 [D2] Checking device 9 of 11 (0665/5161) 0.204923 [D1] nut_libusb_open get iManufacturer failed, retrying... 0.207280 [D1] nut_libusb_open get iManufacturer failed, retrying... 0.209669 [D1] nut_libusb_open get iManufacturer failed, retrying... 0.212022 [D1] nut_libusb_open get iProduct failed, retrying... 0.214338 [D1] nut_libusb_open get iProduct failed, retrying... 0.216830 [D1] nut_libusb_open get iProduct failed, retrying... 0.216846 [D2] - VendorID: 0665 0.216847 [D2] - ProductID: 5161 0.216849 [D2] - Manufacturer: unknown 0.216850 [D2] - Product: unknown 0.216852 [D2] - Serial Number: unknown 0.216864 [D2] - Bus: 003 0.216866 [D2] - Device: 006 0.216868 [D2] - Device release number: 0001 0.216870 [D2] Trying to match device 0.216872 [D3] match_function_regex: matching a device... 0.216885 [D2] Device matches 0.216886 [D2] Reading first configuration descriptor 0.216896 [D3] libusb_kernel_driver_active() returned 0: Success 0.216926 [D2] Claimed interface 0 successfully 0.216929 [D3] nut_usb_set_altinterface: skipped libusb_set_interface_alt_setting(udev, 0, 0) 0.216946 [D5] send_to_all: SETINFO ups.vendorid "0665" 0.216950 [D5] send_to_all: SETINFO ups.productid "5161" 0.218318 [D3] send: QGS 0.278886 [D5] read [ 0]: (8 bytes) => 28 32 32 31 2e 33 20 35 0.310887 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 39 2e 0.342884 [D5] read [ 16]: (8 bytes) => 35 20 35 39 2e 39 20 30 0.382879 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 0.414887 [D5] read [ 32]: (8 bytes) => 20 33 36 32 2e 33 20 33 0.454888 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 0.486869 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d 0.518892 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 0.558896 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 0.574889 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 0.574909 [D3] read: (221.3 59.9 219.5 59.9 002.8 007 362.3 361.8 272.9 ---.- 022.9 100000000010 0.574928 [D5] send_to_all: SETINFO input.voltage "221.3" 0.576176 [D3] send: QPI 0.622874 [D5] read [ 0]: (8 bytes) => 28 50 49 30 32 0d 00 00 0.622880 [D3] read: (PI02 0.622937 [D5] send_to_all: SETINFO ups.firmware.aux "P02" 0.622940 Using protocol: Voltronic 0.08 0.622942 [D5] send_to_all: SETINFO driver.state "init.quiet" 0.622956 [D5] send_to_all: SETINFO driver.version "2.8.0-2359-g6c0032e52" 0.622959 [D5] send_to_all: SETINFO driver.version.internal "0.35" 0.622963 [D5] send_to_all: SETINFO driver.name "nutdrv_qx" 0.622965 [D5] send_to_all: SETINFO driver.state "init.info" 0.622967 [D1] upsdrv_initinfo... 0.622980 [D5] send_to_all: SETINFO driver.version.data "Voltronic 0.08" 0.624104 [D3] send: QRI 0.678874 [D5] read [ 0]: (8 bytes) => 28 32 32 30 2e 30 20 30 0.718855 [D5] read [ 8]: (8 bytes) => 34 35 20 32 34 30 2e 30 0.742898 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 0.742910 [D3] read: (220.0 045 240.0 60.0 0.742946 [D5] send_to_all: SETINFO output.voltage.nominal "220.0" 0.742952 [D5] send_to_all: SETINFO output.current.nominal "45" 0.742958 [D5] send_to_all: SETINFO battery.voltage.nominal "240.0" 0.742964 [D5] send_to_all: SETINFO output.frequency.nominal "60.0" 0.744242 [D3] send: QMD 0.798887 [D5] read [ 0]: (8 bytes) => 28 23 23 23 23 23 23 23 0.838882 [D5] read [ 8]: (8 bytes) => 23 23 23 23 47 31 30 4b 0.870886 [D5] read [ 16]: (8 bytes) => 20 23 23 31 30 30 30 30 0.910884 [D5] read [ 24]: (8 bytes) => 20 38 30 20 31 2f 31 20 0.942903 [D5] read [ 32]: (8 bytes) => 32 33 30 20 32 33 30 20 0.974868 [D5] read [ 40]: (8 bytes) => 32 30 20 31 32 2e 30 0d 0.974873 [D3] read: (###########G10K ##10000 80 1/1 230 230 20 12.0 0.974882 [D5] send_to_all: SETINFO device.model "G10K" 0.974887 [D5] send_to_all: SETINFO ups.power.nominal "10000" 0.974893 [D5] send_to_all: SETINFO output.powerfactor "0.8" 0.974903 [D5] send_to_all: SETINFO input.phases "1" 0.974907 [D5] send_to_all: SETINFO output.phases "1" 0.974911 [D5] send_to_all: SETINFO input.voltage.nominal "230.0" 0.976111 [D3] send: F 1.022870 [D5] read [ 0]: (8 bytes) => 23 32 32 30 2e 30 20 30 1.062876 [D5] read [ 8]: (8 bytes) => 34 35 20 32 34 30 2e 30 1.086867 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 1.086872 [D3] read: #220.0 045 240.0 60.0 1.086881 [D5] send_to_all: SETINFO input.current.nominal "45.0" 1.086901 [D5] send_to_all: SETINFO input.frequency.nominal "60.0" 1.088234 [D3] send: QMF 1.134884 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 1.134903 [D3] read: (NAK 1.134905 [D2] qx_process_answer: query rejected by the UPS (device.mfr) 1.136185 [D3] send: QVFW 1.198873 [D5] read [ 0]: (8 bytes) => 28 56 45 52 46 57 3a 30 1.230865 [D5] read [ 8]: (8 bytes) => 30 30 37 37 2e 31 33 0d 1.230870 [D3] read: (VERFW:00077.13 1.230874 [D5] send_to_all: SETINFO ups.firmware "00077.13" 1.232171 [D3] send: QID 1.278886 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 1.278896 [D3] read: (NAK 1.278909 [D2] qx_process_answer: query rejected by the UPS (device.serial) 1.280047 [D3] send: I 1.326866 [D5] read [ 0]: (8 bytes) => 20 20 20 20 20 20 20 20 1.334901 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 1.334906 [D3] read: 1.334908 [D2] qx_process_answer: short reply (device.mfr) 1.336115 [D3] send: QGS 1.390871 [D5] read [ 0]: (8 bytes) => 28 32 31 39 2e 35 20 35 1.430868 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 32 30 2e 1.462877 [D5] read [ 16]: (8 bytes) => 34 20 36 30 2e 30 20 30 1.502865 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 1.534867 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 1.566867 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 1.606862 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d 1.638861 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 1.678883 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 1.694864 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 1.694884 [D3] read: (219.5 59.9 220.4 60.0 002.8 007 361.8 361.8 272.9 ---.- 022.9 100000000010 1.694914 [D5] send_to_all: SETINFO input.frequency "59.9" 1.694921 [D5] send_to_all: SETINFO output.voltage "220.4" 1.694926 [D5] send_to_all: SETINFO output.frequency "60.0" 1.694932 [D5] send_to_all: SETINFO output.current "2.8" 1.694936 [D5] send_to_all: SETINFO ups.load "7" 1.694940 [D5] send_to_all: SETINFO battery.voltage "272.9" 1.694945 [D5] send_to_all: SETINFO ups.temperature "22.9" 1.694962 [D5] send_to_all: SETINFO ups.type "online" 1.694967 [D5] update_status: OL 1.694970 [D5] update_status: !LB 1.694988 [D5] update_status: !CAL 1.695003 [D5] update_status: !FSD 1.695007 [D5] send_to_all: SETINFO ups.beeper.status "enabled" 1.696295 [D3] send: QMOD 1.734859 [D5] read [ 0]: (8 bytes) => 28 4c 0d 00 00 00 00 00 1.734878 [D3] read: (L 1.734891 [D5] update_status: OL 1.736229 [D3] send: QWS 1.790912 [D5] read [ 0]: (8 bytes) => 28 30 30 30 30 30 30 30 1.830878 [D5] read [ 8]: (8 bytes) => 30 30 30 30 30 30 30 30 1.862874 [D5] read [ 16]: (8 bytes) => 30 30 30 30 30 30 30 30 1.894869 [D5] read [ 24]: (8 bytes) => 30 30 30 30 30 30 30 30 1.934865 [D5] read [ 32]: (8 bytes) => 30 30 30 30 30 30 30 30 1.966853 [D5] read [ 40]: (8 bytes) => 30 30 30 30 30 30 30 30 2.006871 [D5] read [ 48]: (8 bytes) => 30 30 30 30 30 30 30 30 2.038858 [D5] read [ 56]: (8 bytes) => 30 30 30 30 30 30 30 30 2.046851 [D5] read [ 64]: (8 bytes) => 30 0d 30 30 30 30 30 30 2.046870 [D3] read: (0000000000000000000000000000000000000000000000000000000000000000 2.048166 [D3] send: QBV 2.102862 [D5] read [ 0]: (8 bytes) => 28 32 37 33 2e 32 20 32 2.142871 [D5] read [ 8]: (8 bytes) => 30 20 30 31 20 31 30 30 2.158875 [D5] read [ 16]: (8 bytes) => 20 30 31 30 0d 00 00 00 2.158880 [D3] read: (273.2 20 01 100 010 2.158886 battery_number: 20 2.158895 battery_number, settable range: 1..9 2.158904 [D5] send_to_all: SETINFO battery.packs "1" 2.158907 [D5] send_to_all: SETFLAGS battery.packs RW 2.158911 [D5] send_to_all: ADDRANGE battery.packs 1 99 2.158914 [D5] send_to_all: SETFLAGS battery.packs RW NUMBER 2.158919 [D5] send_to_all: SETINFO battery.charge "100" 2.158924 [D5] send_to_all: SETINFO battery.runtime "600" 2.160228 [D3] send: QLDL 2.206859 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 2.206874 [D3] read: (NAK 2.206880 [D2] qx_process_answer: query rejected by the UPS (output.power.minimum.percent) 2.206894 [D2] qx_process_answer: query rejected by the UPS (output.power.maximum.percent) 2.208167 [D3] send: QFLAG 2.270872 [D5] read [ 0]: (8 bytes) => 28 45 70 62 72 61 73 64 2.310890 [D5] read [ 8]: (8 bytes) => 74 69 44 6f 76 65 66 6a 2.318849 [D5] read [ 16]: (8 bytes) => 6d 0d 00 00 00 00 00 00 2.318867 [D3] read: (EpbrasdtiDovefjm 2.318910 [D5] send_to_all: SETINFO ups.start.auto "yes" 2.318915 [D5] send_to_all: SETFLAGS ups.start.auto RW 2.318928 [D5] send_to_all: ADDENUM ups.start.auto "no" 2.318930 [D5] send_to_all: ADDENUM ups.start.auto "yes" 2.318945 [D5] send_to_all: SETINFO battery.protection "yes" 2.318948 [D5] send_to_all: SETFLAGS battery.protection RW 2.318951 [D5] send_to_all: ADDENUM battery.protection "no" 2.318964 [D5] send_to_all: ADDENUM battery.protection "yes" 2.318969 [D4] ups_infoval_set: failed to preprocess value [battery.energysave: EpbrasdtiDovefjm] 2.318973 [D4] ups_infoval_set: failed to preprocess value [ups.start.battery: EpbrasdtiDovefjm] 2.318989 [D5] send_to_all: SETINFO outlet.0.switchable "no" 2.318992 [D5] send_to_all: SETFLAGS outlet.0.switchable RW 2.318994 [D5] send_to_all: ADDENUM outlet.0.switchable "no" 2.318996 [D5] send_to_all: ADDENUM outlet.0.switchable "yes" 2.319001 bypass_alarm: enabled 2.319020 battery_alarm: enabled 2.319036 bypass_when_off: disabled 2.319055 alarm_control: enabled 2.319060 converter_mode: disabled 2.319072 eco_mode: disabled 2.319075 battery_open_status_check: enabled 2.319078 bypass_forbidding: disabled 2.319083 [D4] ups_infoval_set: failed to preprocess value [site_fault_detection: EpbrasdtiDovefjm] 2.319087 [D4] ups_infoval_set: failed to preprocess value [advanced_eco_mode: EpbrasdtiDovefjm] 2.319091 [D4] ups_infoval_set: failed to preprocess value [constant_phase_angle: EpbrasdtiDovefjm] 2.319096 [D4] ups_infoval_set: failed to preprocess value [limited_runtime_on_battery: EpbrasdtiDovefjm] 2.319101 setvar(bypass_when_off, disabled) 2.319104 bypass_when_off is already disabled 2.319106 setvar: FAILED 2.320434 [D3] send: QHE 2.374864 [D5] read [ 0]: (8 bytes) => 28 32 33 31 20 32 30 39 2.382868 [D5] read [ 8]: (8 bytes) => 20 0d 00 00 00 00 00 00 2.382883 [D3] read: (231 209 2.382916 [D5] send_to_all: SETINFO input.transfer.high "231" 2.382929 [D5] send_to_all: SETFLAGS input.transfer.high RW 2.382932 [D5] send_to_all: ADDRANGE input.transfer.high 231 244 2.382934 [D5] send_to_all: SETFLAGS input.transfer.high RW NUMBER 2.382950 [D5] send_to_all: SETINFO input.transfer.low "209" 2.382953 [D5] send_to_all: SETFLAGS input.transfer.low RW 2.382955 [D5] send_to_all: ADDRANGE input.transfer.low 196 209 2.382957 [D5] send_to_all: SETFLAGS input.transfer.low RW NUMBER 2.382962 [D5] send_to_all: SETINFO input.transfer.low.min "196" 2.382966 [D5] send_to_all: SETINFO input.transfer.low.max "209" 2.382970 [D5] send_to_all: SETINFO input.transfer.high.min "231" 2.382975 [D5] send_to_all: SETINFO input.transfer.high.max "244" 2.384206 [D3] send: QFRE 2.430854 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 2.430859 [D3] read: (NAK 2.430861 [D2] qx_process_answer: query rejected by the UPS (input.frequency.high) 2.430864 [D2] qx_process_answer: query rejected by the UPS (input.frequency.low) 2.432092 [D3] send: QBYV 2.494864 [D5] read [ 0]: (8 bytes) => 28 32 36 34 20 31 31 30 2.502857 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 2.502875 [D3] read: (264 110 2.502891 max_bypass_volt: 264 2.502896 max_bypass_volt, settable range: 231..276 2.502899 min_bypass_volt: 110 2.502903 min_bypass_volt, settable range: 110..209 2.504103 [D3] send: QBYF 2.566858 [D5] read [ 0]: (8 bytes) => 28 36 34 2e 30 20 35 36 2.574855 [D5] read [ 8]: (8 bytes) => 2e 30 0d 00 00 00 00 00 2.574870 [D3] read: (64.0 56.0 2.574876 max_bypass_freq: 64.0 2.574891 max_bypass_freq, settable range: 61.0..64.0 2.574895 min_bypass_freq: 56.0 2.574909 min_bypass_freq, settable range: 56.0..59.0 2.574915 [D2] setvar: nothing to do... [battery_number] 2.576110 [D3] send: RE0 2.798865 [D5] read [ 0]: (8 bytes) => 00 00 00 00 00 00 00 00 3.801004 [D3] read: Operation timed out (-7) 3.801025 [D4] qx_process: failed to preprocess answer [battery.voltage.low] 3.802276 [D3] send: QPD 3.846839 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 3.846844 [D3] read: (NAK 3.846855 [D2] qx_process_answer: query rejected by the UPS (input_phase_angle) 3.846872 [D2] qx_process_answer: query rejected by the UPS (output_phase_angle) 3.848203 [D3] send: QPAR 3.894852 [D5] read [ 0]: (8 bytes) => 28 30 31 0d 00 00 00 00 3.894870 [D3] read: (01 ] 3.894874 [D2] voltronic_parallel: non numerical value [voltronic_parallel: 01 ] 3.894875 [D4] ups_infoval_set: failed to preprocess value [voltronic_parallel: 01 3.894883 [D5] send_to_all: ADDCMD load.off 3.894898 [D5] send_to_all: ADDCMD load.on 3.894900 [D5] send_to_all: ADDCMD shutdown.return 3.894902 [D5] send_to_all: ADDCMD shutdown.stayoff 3.894904 [D5] send_to_all: ADDCMD shutdown.stop 3.894916 [D5] send_to_all: ADDCMD test.battery.start 3.894918 [D5] send_to_all: ADDCMD test.battery.start.deep 3.894920 [D5] send_to_all: ADDCMD test.battery.start.quick 3.894922 [D5] send_to_all: ADDCMD test.battery.stop 3.894934 [D5] send_to_all: ADDCMD beeper.toggle 3.894937 [D5] send_to_all: ADDCMD beeper.enable 3.894940 [D5] send_to_all: ADDCMD beeper.disable 3.894942 [D5] send_to_all: ADDCMD bypass.start 3.894956 [D5] send_to_all: ADDCMD bypass.stop 3.894960 [D5] send_to_all: SETINFO ups.delay.start "180" 3.894963 [D5] send_to_all: SETFLAGS ups.delay.start RW 3.894978 [D5] send_to_all: ADDRANGE ups.delay.start 0 599940 3.894981 [D5] send_to_all: SETFLAGS ups.delay.start RW NUMBER 3.894983 [D5] send_to_all: SETINFO ups.delay.shutdown "30" 3.894985 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW 3.894989 [D5] send_to_all: ADDRANGE ups.delay.shutdown 12 5940 3.895001 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW NUMBER 3.895005 No values for battery high/low voltages 3.895010 [D5] send_to_all: SETINFO battery.voltage.low "208.00" 3.895023 [D5] send_to_all: SETINFO battery.voltage.high "260.00" 3.895026 Using 'guesstimation' (low: 208.000000, high: 260.000000)! 3.895037 setvar(ups.delay.start, 60) 3.895041 [D2] setvar: setting server side variable ups.delay.start 3.895044 [D5] send_to_all: SETINFO ups.delay.start "60" 3.895046 setvar: SUCCEED 3.895049 setvar(ups.delay.shutdown, 30) 3.895051 setvar: nothing to do... [ups.delay.shutdown] 3.895057 [D5] send_to_all: SETINFO driver.parameter.pollfreq "30" 3.895065 [D5] send_to_all: SETINFO driver.state "init.updateinfo" 3.895068 [D1] upsdrv_updateinfo... 3.895071 [D1] Quick update... 3.896659 [D3] send: QGS 3.950819 [D5] read [ 0]: (8 bytes) => 28 32 32 30 2e 34 20 35 3.990855 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 38 2e 4.022858 [D5] read [ 16]: (8 bytes) => 37 20 35 39 2e 39 20 30 4.062843 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 4.094844 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 4.126840 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 33 4.166841 [D5] read [ 48]: (8 bytes) => 2e 32 20 2d 2d 2d 2e 2d 4.198838 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 4.238833 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 4.254852 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 33 4.254868 [D3] read: (220.4 59.9 218.7 59.9 002.8 007 361.8 361.8 273.2 ---.- 022.9 100000000010 4.254872 [D5] update_status: OL 4.254875 [D5] update_status: !LB 4.254879 [D5] update_status: !CAL 4.254896 [D5] update_status: !FSD 4.254918 [D5] send_to_all: SETINFO ups.status "OL" 4.254921 [D5] send_to_all: DATAOK 4.254924 [D5] send_to_all: SETINFO driver.state "init.quiet" 4.254938 [D5] send_to_all: SETINFO driver.parameter.pollinterval "10" 4.254941 [D5] send_to_all: SETINFO driver.parameter.synchronous "yes" 4.254943 Running as foreground process, not saving a PID file 4.254956 [D5] send_to_all: SETINFO driver.flag.allow_killpower "0" 4.254960 [D5] send_to_all: SETFLAGS driver.flag.allow_killpower RW NUMBER 4.254963 [D5] send_to_all: ADDCMD driver.killpower 4.254976 [D5] send_to_all: ADDCMD driver.reload 4.254979 [D5] send_to_all: ADDCMD driver.reload-or-exit 4.254981 [D5] send_to_all: ADDCMD driver.reload-or-error 4.254984 [D5] send_to_all: SETINFO driver.state "quiet" 4.254986 [D1] Driver initialization completed, beginning data dump (1 loops) 4.254990 [D5] send_to_all: SETINFO driver.state "updateinfo" 4.254993 [D1] upsdrv_updateinfo... 4.254995 [D1] Quick update... 4.256195 [D3] send: QGS 4.310837 [D5] read [ 0]: (8 bytes) => 28 32 31 39 2e 35 20 35 4.350846 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 39 2e 4.390858 [D5] read [ 16]: (8 bytes) => 35 20 36 30 2e 30 20 30 4.422834 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 4.454832 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 4.494848 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 4.526837 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d 4.566835 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 4.598847 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 4.614849 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 4.614855 [D3] read: (219.5 59.9 219.5 60.0 002.8 007 361.8 361.8 272.9 ---.- 022.9 100000000010 4.614859 [D5] update_status: OL 4.614862 [D5] update_status: !LB 4.614866 [D5] update_status: !CAL 4.614883 [D5] update_status: !FSD 4.614903 [D5] send_to_all: SETINFO driver.state "quiet" 4.614906 [D5] send_to_all: SETINFO driver.state "updateinfo" 4.614908 [D1] upsdrv_updateinfo... 4.614911 [D1] Quick update... 4.616211 [D3] send: QGS 4.670846 [D5] read [ 0]: (8 bytes) => 28 32 32 31 2e 33 20 35 4.710831 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 38 2e 4.742850 [D5] read [ 16]: (8 bytes) => 37 20 35 39 2e 39 20 30 4.782842 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 4.814822 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 4.846843 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 4.886822 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d 4.918833 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 4.958839 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 4.974825 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 4.974829 [D3] read: (221.3 59.9 218.7 59.9 002.8 007 361.8 361.8 272.9 ---.- 022.9 100000000010 4.974833 [D5] update_status: OL 4.974836 [D5] update_status: !LB 4.974839 [D5] update_status: !CAL 4.974855 [D5] update_status: !FSD 4.974864 [D5] send_to_all: SETINFO driver.state "quiet" 4.974878 [D5] send_to_all: SETINFO driver.state "dumping" 4.974881 [D3] Entering dstate_dump battery.charge: 100 battery.packs: 1 battery.protection: yes battery.runtime: 600 battery.voltage: 272.9 battery.voltage.high: 260.00 battery.voltage.low: 208.00 battery.voltage.nominal: 240.0 device.model: G10K device.type: ups driver.debug: 6 driver.flag.allow_killpower: 0 driver.name: nutdrv_qx driver.parameter.bypass_when_off: disabled driver.parameter.offdelay: 30 driver.parameter.ondelay: 60 driver.parameter.pollfreq: 30 driver.parameter.pollinterval: 10 driver.parameter.port: auto driver.parameter.synchronous: yes driver.state: dumping driver.version: 2.8.0-2359-g6c0032e52 driver.version.data: Voltronic 0.08 driver.version.internal: 0.35 driver.version.usb: libusb-1.0.26 (API: 0x1000109) input.current.nominal: 45.0 input.frequency: 59.9 input.frequency.nominal: 60.0 input.phases: 1 input.transfer.high: 231 input.transfer.high.max: 244 input.transfer.high.min: 231 input.transfer.low: 209 input.transfer.low.max: 209 input.transfer.low.min: 196 input.voltage: 221.3 input.voltage.nominal: 230.0 outlet.0.switchable: no output.current: 2.8 output.current.nominal: 45 output.frequency: 60.0 output.frequency.nominal: 60.0 output.phases: 1 output.powerfactor: 0.8 output.voltage: 220.4 output.voltage.nominal: 220.0 ups.beeper.status: enabled ups.delay.shutdown: 30 ups.delay.start: 60 ups.firmware: 00077.13 ups.firmware.aux: P02 ups.load: 7 ups.power.nominal: 10000 ups.productid: 5161 ups.start.auto: yes ups.status: OL ups.temperature: 22.9 ups.type: online ups.vendorid: 0665 4.975010 [D5] send_to_all: SETINFO driver.state "cleanup.upsdrv" 4.975014 [D1] upsdrv_cleanup... 4.975125 [D5] send_to_all: SETINFO driver.state "cleanup.exit
Jim Klimov
2023-Sep-13 20:36 UTC
[Nut-upsdev] [Nut-upsuser] PR to test for users of Qx devices (blazer and nutdrv_qx)
Thanks! So, comparing this with the January report -- there are no substantial changes in device discovery process and the collected info. However, the 10K seems to actually report most of the data which we have to "guesstimate" in other cases. Hoping somebody else with QX devices would chime in then :) Jim On Wed, Sep 13, 2023 at 3:26?PM d tbsky <tbskyd at gmail.com> wrote:> jim Klimov <jimklimov+nut at gmail.com> > > > > Hello all, > > > > Had another hard look at the PR for QX device voltage/charge/runtime > fixes for some broken use-cases (AND hoping to not introduce problems for > cases that were not broken), and hopefully found and rolled back the change > which in fact introduced the strangeness found in our winter round of > tests. Then the year was busy... > > > > As before, the context for this is: > > * issue https://github.com/networkupstools/nut/issues/1279 > > * PR https://github.com/networkupstools/nut/pull/1652 > > * PR source git branch (code to build for tests) > https://github.com/jimklimov/nut/tree/issue-1279 > > * > https://github.com/networkupstools/nut/wiki/Building-NUT-for-in%E2%80%90place-upgrades-or-non%E2%80%90disruptive-tests > suggests how to quickly build and > > Hi: > one of our voltronic ups caught fire last year. so we abandoned > them and bought APC. now I have only one 10KV ups to test. It's sad > because I like nutdrv_qx driver. APC microlink is too bad since nut > doesn't support it. there is only modbus with apcupsd driver. > > BTW I saw an APC ups discussion at nut-upsdev about "SRVS1KI"(can > not reply, not subscribed to that list) . I have that easy-ups series. > nut can support them well with apcsmart driver. normally we should > attach it via serial cable. if you attach the ups with usb cable, you > will see "XR21V1410" which is a usb-serial converter. linux kernel > 5.15 seems include the driver. or you will need to compile the > driver(xr_usb_serial_common) yourself and get "/dev/ttyXRUSB0" to use > as an serial port. I do that because we lost serial cable at a remote > site and forced to use the usb cable. > > > ./nutdrv_qx -a ftups -u root -DDDDDD -d1 > Network UPS Tools - Generic Q* USB/Serial driver 0.35 > (2.8.0-2359-g6c0032e52) > USB communication driver (libusb 1.0) 0.45 > 0.000000 [D1] Network UPS Tools version 2.8.0-2359-g6c0032e52 > (release/snapshot of 2.8.0.1) built with gcc (GCC) 11.3.1 20221121 > (Red Hat 11.3.1-4) and configured with flags: --enable-Wcolor > --enable-keep_nut_report_featu > re --with-all=auto --with-cgi=auto > --with-serial=auto --with-dev=auto --with-doc=skip > --with-nut_monitor=auto --with-pynut=auto > --disable-force-nut-version-header --enable-check-NIT > --enable-maintainer-mode > 0.000011 [D1] debug level is '6' > 0.000014 [D5] send_to_all: SETINFO driver.debug "6" > 0.000018 [D5] send_to_all: SETFLAGS driver.debug RW NUMBER > 0.000815 [D1] Succeeded to become_user(root): now UID=0 GID=0 > 0.000822 [D5] send_to_all: SETINFO device.type "ups" > 0.000825 [D5] send_to_all: SETINFO driver.state "init.device" > 0.000827 [D1] upsdrv_initups... > 0.003147 [D2] Checking device 1 of 11 (8087/8000) > 0.057855 [D2] - VendorID: 8087 > 0.057861 [D2] - ProductID: 8000 > 0.057862 [D2] - Manufacturer: unknown > 0.057864 [D2] - Product: unknown > 0.057865 [D2] - Serial Number: unknown > 0.057867 [D2] - Bus: 002 > 0.057868 [D2] - Device: 002 > 0.057870 [D2] - Device release number: 0005 > 0.057873 [D2] Trying to match device > 0.057875 [D3] match_function_regex: matching a device... > 0.057888 [D2] Device does not match - skipping > 0.071830 [D2] Checking device 2 of 11 (1D6B/0002) > 0.078881 [D2] - VendorID: 1d6b > 0.078885 [D2] - ProductID: 0002 > 0.078887 [D2] - Manufacturer: Linux 5.14.0-162.23.1.el9_1.x86_64 > ehci_hcd > 0.078888 [D2] - Product: EHCI Host Controller > 0.078890 [D2] - Serial Number: 0000:00:1d.0 > 0.078891 [D2] - Bus: 002 > 0.078893 [D2] - Device: 001 > 0.078894 [D2] - Device release number: 0514 > 0.078897 [D2] Trying to match device > 0.078898 [D3] match_function_regex: matching a device... > 0.078912 [D2] Device does not match - skipping > 0.091359 [D2] Checking device 3 of 11 (8087/8008) > 0.145626 [D2] - VendorID: 8087 > 0.145635 [D2] - ProductID: 8008 > 0.145637 [D2] - Manufacturer: unknown > 0.145638 [D2] - Product: unknown > 0.145640 [D2] - Serial Number: unknown > 0.145641 [D2] - Bus: 001 > 0.145643 [D2] - Device: 002 > 0.145645 [D2] - Device release number: 0005 > 0.145648 [D2] Trying to match device > 0.145661 [D3] match_function_regex: matching a device... > 0.145664 [D2] Device does not match - skipping > 0.159837 [D2] Checking device 4 of 11 (1D6B/0002) > 0.166862 [D2] - VendorID: 1d6b > 0.166867 [D2] - ProductID: 0002 > 0.166868 [D2] - Manufacturer: Linux 5.14.0-162.23.1.el9_1.x86_64 > ehci_hcd > 0.166870 [D2] - Product: EHCI Host Controller > 0.166871 [D2] - Serial Number: 0000:00:1a.0 > 0.166873 [D2] - Bus: 001 > 0.166874 [D2] - Device: 001 > 0.166876 [D2] - Device release number: 0514 > 0.166878 [D2] Trying to match device > 0.166880 [D3] match_function_regex: matching a device... > 0.166894 [D2] Device does not match - skipping > 0.179366 [D2] Checking device 5 of 11 (1D6B/0003) > 0.200847 [D2] - VendorID: 1d6b > 0.200851 [D2] - ProductID: 0003 > 0.200853 [D2] - Manufacturer: Linux 5.14.0-162.23.1.el9_1.x86_64 > xhci-hcd > 0.200854 [D2] - Product: xHCI Host Controller > 0.200856 [D2] - Serial Number: 0000:00:14.0 > 0.200857 [D2] - Bus: 004 > 0.200858 [D2] - Device: 001 > 0.200860 [D2] - Device release number: 0514 > 0.200862 [D2] Trying to match device > 0.200864 [D3] match_function_regex: matching a device... > 0.200877 [D2] Device does not match - skipping > 0.200931 [D2] Checking device 6 of 11 (9966/0202) > 0.202237 [D2] - VendorID: 9966 > 0.202254 [D2] - ProductID: 0202 > 0.202256 [D2] - Manufacturer: PSTEK > 0.202268 [D2] - Product: PSTEK Combo KVM 8/16 V:2.00 > 0.202269 [D2] - Serial Number: unknown > 0.202271 [D2] - Bus: 003 > 0.202272 [D2] - Device: 003 > 0.202274 [D2] - Device release number: 0000 > 0.202275 [D2] Trying to match device > 0.202276 [D3] match_function_regex: matching a device... > 0.202279 [D2] Device does not match - skipping > 0.202300 [D2] Checking device 7 of 11 (0557/2419) > 0.202309 [D2] - VendorID: 0557 > 0.202327 [D2] - ProductID: 2419 > 0.202329 [D2] - Manufacturer: unknown > 0.202331 [D2] - Product: unknown > 0.202334 [D2] - Serial Number: unknown > 0.202346 [D2] - Bus: 003 > 0.202348 [D2] - Device: 004 > 0.202350 [D2] - Device release number: 0100 > 0.202353 [D2] Trying to match device > 0.202365 [D3] match_function_regex: matching a device... > 0.202367 [D2] Device does not match - skipping > 0.202371 [D2] Checking device 8 of 11 (0557/7000) > 0.202377 [D2] - VendorID: 0557 > 0.202379 [D2] - ProductID: 7000 > 0.202380 [D2] - Manufacturer: unknown > 0.202382 [D2] - Product: unknown > 0.202384 [D2] - Serial Number: unknown > 0.202386 [D2] - Bus: 003 > 0.202389 [D2] - Device: 002 > 0.202391 [D2] - Device release number: 0000 > 0.202393 [D2] Trying to match device > 0.202395 [D3] match_function_regex: matching a device... > 0.202398 [D2] Device does not match - skipping > 0.202402 [D2] Checking device 9 of 11 (0665/5161) > 0.204923 [D1] nut_libusb_open get iManufacturer failed, retrying... > 0.207280 [D1] nut_libusb_open get iManufacturer failed, retrying... > 0.209669 [D1] nut_libusb_open get iManufacturer failed, retrying... > 0.212022 [D1] nut_libusb_open get iProduct failed, retrying... > 0.214338 [D1] nut_libusb_open get iProduct failed, retrying... > 0.216830 [D1] nut_libusb_open get iProduct failed, retrying... > 0.216846 [D2] - VendorID: 0665 > 0.216847 [D2] - ProductID: 5161 > 0.216849 [D2] - Manufacturer: unknown > 0.216850 [D2] - Product: unknown > 0.216852 [D2] - Serial Number: unknown > 0.216864 [D2] - Bus: 003 > 0.216866 [D2] - Device: 006 > 0.216868 [D2] - Device release number: 0001 > 0.216870 [D2] Trying to match device > 0.216872 [D3] match_function_regex: matching a device... > 0.216885 [D2] Device matches > 0.216886 [D2] Reading first configuration descriptor > 0.216896 [D3] libusb_kernel_driver_active() returned 0: Success > 0.216926 [D2] Claimed interface 0 successfully > 0.216929 [D3] nut_usb_set_altinterface: skipped > libusb_set_interface_alt_setting(udev, 0, 0) > 0.216946 [D5] send_to_all: SETINFO ups.vendorid "0665" > 0.216950 [D5] send_to_all: SETINFO ups.productid "5161" > 0.218318 [D3] send: QGS > 0.278886 [D5] read [ 0]: (8 bytes) => 28 32 32 31 2e 33 20 35 > 0.310887 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 39 2e > 0.342884 [D5] read [ 16]: (8 bytes) => 35 20 35 39 2e 39 20 30 > 0.382879 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 > 0.414887 [D5] read [ 32]: (8 bytes) => 20 33 36 32 2e 33 20 33 > 0.454888 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 > 0.486869 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d > 0.518892 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 > 0.558896 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 0.574889 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 > 0.574909 [D3] read: (221.3 59.9 219.5 59.9 002.8 007 362.3 > 361.8 272.9 ---.- 022.9 100000000010 > 0.574928 [D5] send_to_all: SETINFO input.voltage "221.3" > 0.576176 [D3] send: QPI > 0.622874 [D5] read [ 0]: (8 bytes) => 28 50 49 30 32 0d 00 00 > 0.622880 [D3] read: (PI02 > 0.622937 [D5] send_to_all: SETINFO ups.firmware.aux "P02" > 0.622940 Using protocol: Voltronic 0.08 > 0.622942 [D5] send_to_all: SETINFO driver.state "init.quiet" > 0.622956 [D5] send_to_all: SETINFO driver.version > "2.8.0-2359-g6c0032e52" > 0.622959 [D5] send_to_all: SETINFO driver.version.internal "0.35" > 0.622963 [D5] send_to_all: SETINFO driver.name "nutdrv_qx" > 0.622965 [D5] send_to_all: SETINFO driver.state "init.info" > 0.622967 [D1] upsdrv_initinfo... > 0.622980 [D5] send_to_all: SETINFO driver.version.data "Voltronic > 0.08" > 0.624104 [D3] send: QRI > 0.678874 [D5] read [ 0]: (8 bytes) => 28 32 32 30 2e 30 20 30 > 0.718855 [D5] read [ 8]: (8 bytes) => 34 35 20 32 34 30 2e 30 > 0.742898 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 > 0.742910 [D3] read: (220.0 045 240.0 60.0 > 0.742946 [D5] send_to_all: SETINFO output.voltage.nominal "220.0" > 0.742952 [D5] send_to_all: SETINFO output.current.nominal "45" > 0.742958 [D5] send_to_all: SETINFO battery.voltage.nominal "240.0" > 0.742964 [D5] send_to_all: SETINFO output.frequency.nominal "60.0" > 0.744242 [D3] send: QMD > 0.798887 [D5] read [ 0]: (8 bytes) => 28 23 23 23 23 23 23 23 > 0.838882 [D5] read [ 8]: (8 bytes) => 23 23 23 23 47 31 30 4b > 0.870886 [D5] read [ 16]: (8 bytes) => 20 23 23 31 30 30 30 30 > 0.910884 [D5] read [ 24]: (8 bytes) => 20 38 30 20 31 2f 31 20 > 0.942903 [D5] read [ 32]: (8 bytes) => 32 33 30 20 32 33 30 20 > 0.974868 [D5] read [ 40]: (8 bytes) => 32 30 20 31 32 2e 30 0d > 0.974873 [D3] read: (###########G10K ##10000 80 1/1 230 230 20 12.0 > 0.974882 [D5] send_to_all: SETINFO device.model "G10K" > 0.974887 [D5] send_to_all: SETINFO ups.power.nominal "10000" > 0.974893 [D5] send_to_all: SETINFO output.powerfactor "0.8" > 0.974903 [D5] send_to_all: SETINFO input.phases "1" > 0.974907 [D5] send_to_all: SETINFO output.phases "1" > 0.974911 [D5] send_to_all: SETINFO input.voltage.nominal "230.0" > 0.976111 [D3] send: F > 1.022870 [D5] read [ 0]: (8 bytes) => 23 32 32 30 2e 30 20 30 > 1.062876 [D5] read [ 8]: (8 bytes) => 34 35 20 32 34 30 2e 30 > 1.086867 [D5] read [ 16]: (8 bytes) => 20 36 30 2e 30 0d 00 00 > 1.086872 [D3] read: #220.0 045 240.0 60.0 > 1.086881 [D5] send_to_all: SETINFO input.current.nominal "45.0" > 1.086901 [D5] send_to_all: SETINFO input.frequency.nominal "60.0" > 1.088234 [D3] send: QMF > 1.134884 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 1.134903 [D3] read: (NAK > 1.134905 [D2] qx_process_answer: query rejected by the UPS > (device.mfr) > 1.136185 [D3] send: QVFW > 1.198873 [D5] read [ 0]: (8 bytes) => 28 56 45 52 46 57 3a 30 > 1.230865 [D5] read [ 8]: (8 bytes) => 30 30 37 37 2e 31 33 0d > 1.230870 [D3] read: (VERFW:00077.13 > 1.230874 [D5] send_to_all: SETINFO ups.firmware "00077.13" > 1.232171 [D3] send: QID > 1.278886 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 1.278896 [D3] read: (NAK > 1.278909 [D2] qx_process_answer: query rejected by the UPS > (device.serial) > 1.280047 [D3] send: I > 1.326866 [D5] read [ 0]: (8 bytes) => 20 20 20 20 20 20 20 20 > 1.334901 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 > 1.334906 [D3] read: > 1.334908 [D2] qx_process_answer: short reply (device.mfr) > 1.336115 [D3] send: QGS > 1.390871 [D5] read [ 0]: (8 bytes) => 28 32 31 39 2e 35 20 35 > 1.430868 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 32 30 2e > 1.462877 [D5] read [ 16]: (8 bytes) => 34 20 36 30 2e 30 20 30 > 1.502865 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 > 1.534867 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 > 1.566867 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 > 1.606862 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d > 1.638861 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 > 1.678883 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.694864 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 > 1.694884 [D3] read: (219.5 59.9 220.4 60.0 002.8 007 361.8 > 361.8 272.9 ---.- 022.9 100000000010 > 1.694914 [D5] send_to_all: SETINFO input.frequency "59.9" > 1.694921 [D5] send_to_all: SETINFO output.voltage "220.4" > 1.694926 [D5] send_to_all: SETINFO output.frequency "60.0" > 1.694932 [D5] send_to_all: SETINFO output.current "2.8" > 1.694936 [D5] send_to_all: SETINFO ups.load "7" > 1.694940 [D5] send_to_all: SETINFO battery.voltage "272.9" > 1.694945 [D5] send_to_all: SETINFO ups.temperature "22.9" > 1.694962 [D5] send_to_all: SETINFO ups.type "online" > 1.694967 [D5] update_status: OL > 1.694970 [D5] update_status: !LB > 1.694988 [D5] update_status: !CAL > 1.695003 [D5] update_status: !FSD > 1.695007 [D5] send_to_all: SETINFO ups.beeper.status "enabled" > 1.696295 [D3] send: QMOD > 1.734859 [D5] read [ 0]: (8 bytes) => 28 4c 0d 00 00 00 00 00 > 1.734878 [D3] read: (L > 1.734891 [D5] update_status: OL > 1.736229 [D3] send: QWS > 1.790912 [D5] read [ 0]: (8 bytes) => 28 30 30 30 30 30 30 30 > 1.830878 [D5] read [ 8]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.862874 [D5] read [ 16]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.894869 [D5] read [ 24]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.934865 [D5] read [ 32]: (8 bytes) => 30 30 30 30 30 30 30 30 > 1.966853 [D5] read [ 40]: (8 bytes) => 30 30 30 30 30 30 30 30 > 2.006871 [D5] read [ 48]: (8 bytes) => 30 30 30 30 30 30 30 30 > 2.038858 [D5] read [ 56]: (8 bytes) => 30 30 30 30 30 30 30 30 > 2.046851 [D5] read [ 64]: (8 bytes) => 30 0d 30 30 30 30 30 30 > 2.046870 [D3] read: > (0000000000000000000000000000000000000000000000000000000000000000 > 2.048166 [D3] send: QBV > 2.102862 [D5] read [ 0]: (8 bytes) => 28 32 37 33 2e 32 20 32 > 2.142871 [D5] read [ 8]: (8 bytes) => 30 20 30 31 20 31 30 30 > 2.158875 [D5] read [ 16]: (8 bytes) => 20 30 31 30 0d 00 00 00 > 2.158880 [D3] read: (273.2 20 01 100 010 > 2.158886 battery_number: 20 > 2.158895 battery_number, settable range: 1..9 > 2.158904 [D5] send_to_all: SETINFO battery.packs "1" > 2.158907 [D5] send_to_all: SETFLAGS battery.packs RW > 2.158911 [D5] send_to_all: ADDRANGE battery.packs 1 99 > 2.158914 [D5] send_to_all: SETFLAGS battery.packs RW NUMBER > 2.158919 [D5] send_to_all: SETINFO battery.charge "100" > 2.158924 [D5] send_to_all: SETINFO battery.runtime "600" > 2.160228 [D3] send: QLDL > 2.206859 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 2.206874 [D3] read: (NAK > 2.206880 [D2] qx_process_answer: query rejected by the UPS > (output.power.minimum.percent) > 2.206894 [D2] qx_process_answer: query rejected by the UPS > (output.power.maximum.percent) > 2.208167 [D3] send: QFLAG > 2.270872 [D5] read [ 0]: (8 bytes) => 28 45 70 62 72 61 73 64 > 2.310890 [D5] read [ 8]: (8 bytes) => 74 69 44 6f 76 65 66 6a > 2.318849 [D5] read [ 16]: (8 bytes) => 6d 0d 00 00 00 00 00 00 > 2.318867 [D3] read: (EpbrasdtiDovefjm > 2.318910 [D5] send_to_all: SETINFO ups.start.auto "yes" > 2.318915 [D5] send_to_all: SETFLAGS ups.start.auto RW > 2.318928 [D5] send_to_all: ADDENUM ups.start.auto "no" > 2.318930 [D5] send_to_all: ADDENUM ups.start.auto "yes" > 2.318945 [D5] send_to_all: SETINFO battery.protection "yes" > 2.318948 [D5] send_to_all: SETFLAGS battery.protection RW > 2.318951 [D5] send_to_all: ADDENUM battery.protection "no" > 2.318964 [D5] send_to_all: ADDENUM battery.protection "yes" > 2.318969 [D4] ups_infoval_set: failed to preprocess value > [battery.energysave: EpbrasdtiDovefjm] > 2.318973 [D4] ups_infoval_set: failed to preprocess value > [ups.start.battery: EpbrasdtiDovefjm] > 2.318989 [D5] send_to_all: SETINFO outlet.0.switchable "no" > 2.318992 [D5] send_to_all: SETFLAGS outlet.0.switchable RW > 2.318994 [D5] send_to_all: ADDENUM outlet.0.switchable "no" > 2.318996 [D5] send_to_all: ADDENUM outlet.0.switchable "yes" > 2.319001 bypass_alarm: enabled > 2.319020 battery_alarm: enabled > 2.319036 bypass_when_off: disabled > 2.319055 alarm_control: enabled > 2.319060 converter_mode: disabled > 2.319072 eco_mode: disabled > 2.319075 battery_open_status_check: enabled > 2.319078 bypass_forbidding: disabled > 2.319083 [D4] ups_infoval_set: failed to preprocess value > [site_fault_detection: EpbrasdtiDovefjm] > 2.319087 [D4] ups_infoval_set: failed to preprocess value > [advanced_eco_mode: EpbrasdtiDovefjm] > 2.319091 [D4] ups_infoval_set: failed to preprocess value > [constant_phase_angle: EpbrasdtiDovefjm] > 2.319096 [D4] ups_infoval_set: failed to preprocess value > [limited_runtime_on_battery: EpbrasdtiDovefjm] > 2.319101 setvar(bypass_when_off, disabled) > 2.319104 bypass_when_off is already disabled > 2.319106 setvar: FAILED > 2.320434 [D3] send: QHE > 2.374864 [D5] read [ 0]: (8 bytes) => 28 32 33 31 20 32 30 39 > 2.382868 [D5] read [ 8]: (8 bytes) => 20 0d 00 00 00 00 00 00 > 2.382883 [D3] read: (231 209 > 2.382916 [D5] send_to_all: SETINFO input.transfer.high "231" > 2.382929 [D5] send_to_all: SETFLAGS input.transfer.high RW > 2.382932 [D5] send_to_all: ADDRANGE input.transfer.high 231 244 > 2.382934 [D5] send_to_all: SETFLAGS input.transfer.high RW NUMBER > 2.382950 [D5] send_to_all: SETINFO input.transfer.low "209" > 2.382953 [D5] send_to_all: SETFLAGS input.transfer.low RW > 2.382955 [D5] send_to_all: ADDRANGE input.transfer.low 196 209 > 2.382957 [D5] send_to_all: SETFLAGS input.transfer.low RW NUMBER > 2.382962 [D5] send_to_all: SETINFO input.transfer.low.min "196" > 2.382966 [D5] send_to_all: SETINFO input.transfer.low.max "209" > 2.382970 [D5] send_to_all: SETINFO input.transfer.high.min "231" > 2.382975 [D5] send_to_all: SETINFO input.transfer.high.max "244" > 2.384206 [D3] send: QFRE > 2.430854 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 2.430859 [D3] read: (NAK > 2.430861 [D2] qx_process_answer: query rejected by the UPS > (input.frequency.high) > 2.430864 [D2] qx_process_answer: query rejected by the UPS > (input.frequency.low) > 2.432092 [D3] send: QBYV > 2.494864 [D5] read [ 0]: (8 bytes) => 28 32 36 34 20 31 31 30 > 2.502857 [D5] read [ 8]: (8 bytes) => 0d 00 00 00 00 00 00 00 > 2.502875 [D3] read: (264 110 > 2.502891 max_bypass_volt: 264 > 2.502896 max_bypass_volt, settable range: 231..276 > 2.502899 min_bypass_volt: 110 > 2.502903 min_bypass_volt, settable range: 110..209 > 2.504103 [D3] send: QBYF > 2.566858 [D5] read [ 0]: (8 bytes) => 28 36 34 2e 30 20 35 36 > 2.574855 [D5] read [ 8]: (8 bytes) => 2e 30 0d 00 00 00 00 00 > 2.574870 [D3] read: (64.0 56.0 > 2.574876 max_bypass_freq: 64.0 > 2.574891 max_bypass_freq, settable range: 61.0..64.0 > 2.574895 min_bypass_freq: 56.0 > 2.574909 min_bypass_freq, settable range: 56.0..59.0 > 2.574915 [D2] setvar: nothing to do... [battery_number] > 2.576110 [D3] send: RE0 > 2.798865 [D5] read [ 0]: (8 bytes) => 00 00 00 00 00 00 00 00 > 3.801004 [D3] read: Operation timed out (-7) > 3.801025 [D4] qx_process: failed to preprocess answer > [battery.voltage.low] > 3.802276 [D3] send: QPD > 3.846839 [D5] read [ 0]: (8 bytes) => 28 4e 41 4b 0d 00 00 00 > 3.846844 [D3] read: (NAK > 3.846855 [D2] qx_process_answer: query rejected by the UPS > (input_phase_angle) > 3.846872 [D2] qx_process_answer: query rejected by the UPS > (output_phase_angle) > 3.848203 [D3] send: QPAR > 3.894852 [D5] read [ 0]: (8 bytes) => 28 30 31 0d 00 00 00 00 > 3.894870 [D3] read: (01 > ] 3.894874 [D2] voltronic_parallel: non numerical value > [voltronic_parallel: 01 > ] 3.894875 [D4] ups_infoval_set: failed to preprocess value > [voltronic_parallel: 01 > 3.894883 [D5] send_to_all: ADDCMD load.off > 3.894898 [D5] send_to_all: ADDCMD load.on > 3.894900 [D5] send_to_all: ADDCMD shutdown.return > 3.894902 [D5] send_to_all: ADDCMD shutdown.stayoff > 3.894904 [D5] send_to_all: ADDCMD shutdown.stop > 3.894916 [D5] send_to_all: ADDCMD test.battery.start > 3.894918 [D5] send_to_all: ADDCMD test.battery.start.deep > 3.894920 [D5] send_to_all: ADDCMD test.battery.start.quick > 3.894922 [D5] send_to_all: ADDCMD test.battery.stop > 3.894934 [D5] send_to_all: ADDCMD beeper.toggle > 3.894937 [D5] send_to_all: ADDCMD beeper.enable > 3.894940 [D5] send_to_all: ADDCMD beeper.disable > 3.894942 [D5] send_to_all: ADDCMD bypass.start > 3.894956 [D5] send_to_all: ADDCMD bypass.stop > 3.894960 [D5] send_to_all: SETINFO ups.delay.start "180" > 3.894963 [D5] send_to_all: SETFLAGS ups.delay.start RW > 3.894978 [D5] send_to_all: ADDRANGE ups.delay.start 0 599940 > 3.894981 [D5] send_to_all: SETFLAGS ups.delay.start RW NUMBER > 3.894983 [D5] send_to_all: SETINFO ups.delay.shutdown "30" > 3.894985 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW > 3.894989 [D5] send_to_all: ADDRANGE ups.delay.shutdown 12 5940 > 3.895001 [D5] send_to_all: SETFLAGS ups.delay.shutdown RW NUMBER > 3.895005 No values for battery high/low voltages > 3.895010 [D5] send_to_all: SETINFO battery.voltage.low "208.00" > 3.895023 [D5] send_to_all: SETINFO battery.voltage.high "260.00" > 3.895026 Using 'guesstimation' (low: 208.000000, high: 260.000000)! > 3.895037 setvar(ups.delay.start, 60) > 3.895041 [D2] setvar: setting server side variable ups.delay.start > 3.895044 [D5] send_to_all: SETINFO ups.delay.start "60" > 3.895046 setvar: SUCCEED > 3.895049 setvar(ups.delay.shutdown, 30) > 3.895051 setvar: nothing to do... [ups.delay.shutdown] > 3.895057 [D5] send_to_all: SETINFO driver.parameter.pollfreq "30" > 3.895065 [D5] send_to_all: SETINFO driver.state "init.updateinfo" > 3.895068 [D1] upsdrv_updateinfo... > 3.895071 [D1] Quick update... > 3.896659 [D3] send: QGS > 3.950819 [D5] read [ 0]: (8 bytes) => 28 32 32 30 2e 34 20 35 > 3.990855 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 38 2e > 4.022858 [D5] read [ 16]: (8 bytes) => 37 20 35 39 2e 39 20 30 > 4.062843 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 > 4.094844 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 > 4.126840 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 33 > 4.166841 [D5] read [ 48]: (8 bytes) => 2e 32 20 2d 2d 2d 2e 2d > 4.198838 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 > 4.238833 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 4.254852 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 33 > 4.254868 [D3] read: (220.4 59.9 218.7 59.9 002.8 007 361.8 > 361.8 273.2 ---.- 022.9 100000000010 > 4.254872 [D5] update_status: OL > 4.254875 [D5] update_status: !LB > 4.254879 [D5] update_status: !CAL > 4.254896 [D5] update_status: !FSD > 4.254918 [D5] send_to_all: SETINFO ups.status "OL" > 4.254921 [D5] send_to_all: DATAOK > 4.254924 [D5] send_to_all: SETINFO driver.state "init.quiet" > 4.254938 [D5] send_to_all: SETINFO driver.parameter.pollinterval > "10" > 4.254941 [D5] send_to_all: SETINFO driver.parameter.synchronous > "yes" > 4.254943 Running as foreground process, not saving a PID file > 4.254956 [D5] send_to_all: SETINFO driver.flag.allow_killpower "0" > 4.254960 [D5] send_to_all: SETFLAGS driver.flag.allow_killpower RW > NUMBER > 4.254963 [D5] send_to_all: ADDCMD driver.killpower > 4.254976 [D5] send_to_all: ADDCMD driver.reload > 4.254979 [D5] send_to_all: ADDCMD driver.reload-or-exit > 4.254981 [D5] send_to_all: ADDCMD driver.reload-or-error > 4.254984 [D5] send_to_all: SETINFO driver.state "quiet" > 4.254986 [D1] Driver initialization completed, beginning data > dump (1 loops) > 4.254990 [D5] send_to_all: SETINFO driver.state "updateinfo" > 4.254993 [D1] upsdrv_updateinfo... > 4.254995 [D1] Quick update... > 4.256195 [D3] send: QGS > 4.310837 [D5] read [ 0]: (8 bytes) => 28 32 31 39 2e 35 20 35 > 4.350846 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 39 2e > 4.390858 [D5] read [ 16]: (8 bytes) => 35 20 36 30 2e 30 20 30 > 4.422834 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 > 4.454832 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 > 4.494848 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 > 4.526837 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d > 4.566835 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 > 4.598847 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 4.614849 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 > 4.614855 [D3] read: (219.5 59.9 219.5 60.0 002.8 007 361.8 > 361.8 272.9 ---.- 022.9 100000000010 > 4.614859 [D5] update_status: OL > 4.614862 [D5] update_status: !LB > 4.614866 [D5] update_status: !CAL > 4.614883 [D5] update_status: !FSD > 4.614903 [D5] send_to_all: SETINFO driver.state "quiet" > 4.614906 [D5] send_to_all: SETINFO driver.state "updateinfo" > 4.614908 [D1] upsdrv_updateinfo... > 4.614911 [D1] Quick update... > 4.616211 [D3] send: QGS > 4.670846 [D5] read [ 0]: (8 bytes) => 28 32 32 31 2e 33 20 35 > 4.710831 [D5] read [ 8]: (8 bytes) => 39 2e 39 20 32 31 38 2e > 4.742850 [D5] read [ 16]: (8 bytes) => 37 20 35 39 2e 39 20 30 > 4.782842 [D5] read [ 24]: (8 bytes) => 30 32 2e 38 20 30 30 37 > 4.814822 [D5] read [ 32]: (8 bytes) => 20 33 36 31 2e 38 20 33 > 4.846843 [D5] read [ 40]: (8 bytes) => 36 31 2e 38 20 32 37 32 > 4.886822 [D5] read [ 48]: (8 bytes) => 2e 39 20 2d 2d 2d 2e 2d > 4.918833 [D5] read [ 56]: (8 bytes) => 20 30 32 32 2e 39 20 31 > 4.958839 [D5] read [ 64]: (8 bytes) => 30 30 30 30 30 30 30 30 > 4.974825 [D5] read [ 72]: (8 bytes) => 30 31 30 0d 20 32 37 32 > 4.974829 [D3] read: (221.3 59.9 218.7 59.9 002.8 007 361.8 > 361.8 272.9 ---.- 022.9 100000000010 > 4.974833 [D5] update_status: OL > 4.974836 [D5] update_status: !LB > 4.974839 [D5] update_status: !CAL > 4.974855 [D5] update_status: !FSD > 4.974864 [D5] send_to_all: SETINFO driver.state "quiet" > 4.974878 [D5] send_to_all: SETINFO driver.state "dumping" > 4.974881 [D3] Entering dstate_dump > battery.charge: 100 > battery.packs: 1 > battery.protection: yes > battery.runtime: 600 > battery.voltage: 272.9 > battery.voltage.high: 260.00 > battery.voltage.low: 208.00 > battery.voltage.nominal: 240.0 > device.model: G10K > device.type: ups > driver.debug: 6 > driver.flag.allow_killpower: 0 > driver.name: nutdrv_qx > driver.parameter.bypass_when_off: disabled > driver.parameter.offdelay: 30 > driver.parameter.ondelay: 60 > driver.parameter.pollfreq: 30 > driver.parameter.pollinterval: 10 > driver.parameter.port: auto > driver.parameter.synchronous: yes > driver.state: dumping > driver.version: 2.8.0-2359-g6c0032e52 > driver.version.data: Voltronic 0.08 > driver.version.internal: 0.35 > driver.version.usb: libusb-1.0.26 (API: 0x1000109) > input.current.nominal: 45.0 > input.frequency: 59.9 > input.frequency.nominal: 60.0 > input.phases: 1 > input.transfer.high: 231 > input.transfer.high.max: 244 > input.transfer.high.min: 231 > input.transfer.low: 209 > input.transfer.low.max: 209 > input.transfer.low.min: 196 > input.voltage: 221.3 > input.voltage.nominal: 230.0 > outlet.0.switchable: no > output.current: 2.8 > output.current.nominal: 45 > output.frequency: 60.0 > output.frequency.nominal: 60.0 > output.phases: 1 > output.powerfactor: 0.8 > output.voltage: 220.4 > output.voltage.nominal: 220.0 > ups.beeper.status: enabled > ups.delay.shutdown: 30 > ups.delay.start: 60 > ups.firmware: 00077.13 > ups.firmware.aux: P02 > ups.load: 7 > ups.power.nominal: 10000 > ups.productid: 5161 > ups.start.auto: yes > ups.status: OL > ups.temperature: 22.9 > ups.type: online > ups.vendorid: 0665 > 4.975010 [D5] send_to_all: SETINFO driver.state "cleanup.upsdrv" > 4.975014 [D1] upsdrv_cleanup... > 4.975125 [D5] send_to_all: SETINFO driver.state "cleanup.exit >-------------- next part -------------- An HTML attachment was scrubbed... URL: <http://alioth-lists.debian.net/pipermail/nut-upsdev/attachments/20230913/159e341c/attachment-0001.htm>