05/02/2015 14:34:43	VoxLog created / UAC test passed.
05/02/2015 14:34:44	72	.Net version: 4.0.30319.34209
05/02/2015 14:34:44	577	Setting current directory
05/02/2015 14:34:44	578	options: loading options
05/02/2015 14:34:44	822	options: verifying speech engine culture language
05/02/2015 14:34:44	822	SRE verify engine available: en-GB | 
05/02/2015 14:34:45	47	launching application
05/02/2015 14:34:45	136	Starting VoxCommando, version: 2.1.3.6
05/02/2015 14:34:45	374	creating the SR engine object
05/02/2015 14:34:45	461	[info] New SR engine created

05/02/2015 14:34:45	477	[info] SR engine: MS-2057-80-DESK

05/02/2015 14:34:45	481	SR language: English (United Kingdom) (en-GB)
05/02/2015 14:34:45	481	[info] SR language: en-GB

05/02/2015 14:34:45	481	[info] SR engine culture: en-GB

05/02/2015 14:34:45	482	Attempting to create speech engine using en-GB
05/02/2015 14:34:45	482	[info] loading group monsters

05/02/2015 14:34:45	485	Reload GroupMonsters
05/02/2015 14:34:45	487	processing group: Vox commands
05/02/2015 14:34:45	488	New groupMonster created
05/02/2015 14:34:45	490	creating group: Vox commands
05/02/2015 14:34:45	490	Creating Hashcode
05/02/2015 14:34:45	494	loading macros for group: Vox commands
05/02/2015 14:34:45	494	found 4commands
05/02/2015 14:34:45	494	creating command: Don't Listen
05/02/2015 14:34:45	494	desired ID: 1
05/02/2015 14:34:45	495	actual ID: 1
05/02/2015 14:34:45	500	creating command: Listen
05/02/2015 14:34:45	500	desired ID: 19
05/02/2015 14:34:45	500	actual ID: 19
05/02/2015 14:34:45	500	creating command: Option
05/02/2015 14:34:45	500	desired ID: 26
05/02/2015 14:34:45	500	actual ID: 26
05/02/2015 14:34:45	500	creating command: Vox Off
05/02/2015 14:34:45	500	desired ID: 36
05/02/2015 14:34:45	500	actual ID: 36
05/02/2015 14:34:45	501	GM Created: Vox commands
05/02/2015 14:34:45	501	# of macros loaded: 4
05/02/2015 14:34:45	503	srgs\en-GB_Vox commands.cfg exists: True
05/02/2015 14:34:45	503	srgs\en-GB_Vox commands.cfg exists: True
05/02/2015 14:34:45	504	loading grammar into engine
05/02/2015 14:34:45	538	Grammar ready.  Enabled: True Name: Vox commands
05/02/2015 14:34:45	538	processing group: Fibaro Basic
05/02/2015 14:34:45	538	New groupMonster created
05/02/2015 14:34:45	538	creating group: Fibaro Basic
05/02/2015 14:34:45	538	Creating Hashcode
05/02/2015 14:34:45	538	loading macros for group: Fibaro Basic
05/02/2015 14:34:45	538	found 3commands
05/02/2015 14:34:45	538	creating command: Dim {1} to {2} percent
05/02/2015 14:34:45	538	desired ID: 305
05/02/2015 14:34:45	538	actual ID: 305
05/02/2015 14:34:45	538	creating command: Switch{1} {2}
05/02/2015 14:34:45	538	desired ID: 310
05/02/2015 14:34:45	538	actual ID: 310
05/02/2015 14:34:45	539	creating command: Method 1: Get status of {1}
05/02/2015 14:34:45	539	desired ID: 316
05/02/2015 14:34:45	539	actual ID: 316
05/02/2015 14:34:45	539	GM Created: Fibaro Basic
05/02/2015 14:34:45	539	# of macros loaded: 3
05/02/2015 14:34:45	539	srgs\en-GB_Fibaro Basic.cfg exists: True
05/02/2015 14:34:45	539	srgs\en-GB_Fibaro Basic.cfg exists: True
05/02/2015 14:34:45	540	loading grammar into engine
05/02/2015 14:34:45	635	Grammar ready.  Enabled: True Name: Fibaro Basic
05/02/2015 14:34:45	635	processing group: Wunder
05/02/2015 14:34:45	635	New groupMonster created
05/02/2015 14:34:45	635	creating group: Wunder
05/02/2015 14:34:45	635	Creating Hashcode
05/02/2015 14:34:45	635	loading macros for group: Wunder
05/02/2015 14:34:45	635	found 6commands
05/02/2015 14:34:45	635	creating command: Todays Weather
05/02/2015 14:34:45	635	desired ID: 963
05/02/2015 14:34:45	635	actual ID: 963
05/02/2015 14:34:45	635	creating command: Tomorrows Weather
05/02/2015 14:34:45	635	desired ID: 970
05/02/2015 14:34:45	635	actual ID: 970
05/02/2015 14:34:45	635	creating command: Weather Forecast
05/02/2015 14:34:45	635	desired ID: 988
05/02/2015 14:34:45	635	actual ID: 988
05/02/2015 14:34:45	635	creating command: Temperature Highs Weather
05/02/2015 14:34:45	635	desired ID: 974
05/02/2015 14:34:45	635	actual ID: 974
05/02/2015 14:34:45	635	creating command: Todays Temperature
05/02/2015 14:34:45	635	desired ID: 979
05/02/2015 14:34:45	635	actual ID: 979
05/02/2015 14:34:45	635	creating command: Weather test
05/02/2015 14:34:45	635	desired ID: 997
05/02/2015 14:34:45	635	actual ID: 997
05/02/2015 14:34:45	635	GM Created: Wunder
05/02/2015 14:34:45	635	# of macros loaded: 6
05/02/2015 14:34:45	636	srgs\en-GB_Wunder.cfg exists: True
05/02/2015 14:34:45	636	srgs\en-GB_Wunder.cfg exists: True
05/02/2015 14:34:45	636	loading grammar into engine
05/02/2015 14:34:45	638	Grammar ready.  Enabled: True Name: Wunder
05/02/2015 14:34:45	638	processing group: Show help
05/02/2015 14:34:45	638	New groupMonster created
05/02/2015 14:34:45	638	creating group: Show help
05/02/2015 14:34:45	638	Creating Hashcode
05/02/2015 14:34:45	638	loading macros for group: Show help
05/02/2015 14:34:45	638	found 2commands
05/02/2015 14:34:45	638	creating command: Show active commands
05/02/2015 14:34:45	638	desired ID: 269
05/02/2015 14:34:45	638	actual ID: 269
05/02/2015 14:34:45	638	creating command: Show help
05/02/2015 14:34:45	638	desired ID: 271
05/02/2015 14:34:45	638	actual ID: 271
05/02/2015 14:34:45	638	GM Created: Show help
05/02/2015 14:34:45	638	# of macros loaded: 2
05/02/2015 14:34:45	639	srgs\en-GB_Show help.cfg exists: True
05/02/2015 14:34:45	639	srgs\en-GB_Show help.cfg exists: True
05/02/2015 14:34:45	639	loading grammar into engine
05/02/2015 14:34:45	640	Grammar ready.  Enabled: True Name: Show help
05/02/2015 14:34:45	640	processing group: our groceries high priority
05/02/2015 14:34:45	640	New groupMonster created
05/02/2015 14:34:45	640	creating group: our groceries high priority
05/02/2015 14:34:45	640	Creating Hashcode
05/02/2015 14:34:45	640	loading macros for group: our groceries high priority
05/02/2015 14:34:45	640	found 1commands
05/02/2015 14:34:45	640	creating command: Add Item
05/02/2015 14:34:45	640	desired ID: 934
05/02/2015 14:34:45	640	actual ID: 934
05/02/2015 14:34:45	640	GM Created: our groceries high priority
05/02/2015 14:34:45	641	# of macros loaded: 1
05/02/2015 14:34:45	641	srgs\en-GB_our groceries high priority.cfg exists: True
05/02/2015 14:34:45	641	srgs\en-GB_our groceries high priority.cfg exists: True
05/02/2015 14:34:45	642	loading grammar into engine
05/02/2015 14:34:45	642	Grammar ready.  Enabled: True Name: our groceries high priority
05/02/2015 14:34:45	642	processing group: Our Groceries new items
05/02/2015 14:34:45	642	New groupMonster created
05/02/2015 14:34:45	642	creating group: Our Groceries new items
05/02/2015 14:34:45	642	Creating Hashcode
05/02/2015 14:34:45	642	loading macros for group: Our Groceries new items
05/02/2015 14:34:45	642	found 5commands
05/02/2015 14:34:45	642	creating command: ++open list
05/02/2015 14:34:45	642	desired ID: 955
05/02/2015 14:34:45	642	actual ID: 955
05/02/2015 14:34:45	643	skipping event loading for now...
05/02/2015 14:34:45	643	creating command: Add Item dictionary
05/02/2015 14:34:45	643	desired ID: 877
05/02/2015 14:34:45	643	actual ID: 877
05/02/2015 14:34:45	643	creating command: Are you sure?
05/02/2015 14:34:45	643	desired ID: 942
05/02/2015 14:34:45	643	actual ID: 942
05/02/2015 14:34:45	643	skipping event loading for now...
05/02/2015 14:34:45	643	creating command: Show Groceries
05/02/2015 14:34:45	643	desired ID: 915
05/02/2015 14:34:45	643	actual ID: 915
05/02/2015 14:34:45	643	creating command: update payload XML master list
05/02/2015 14:34:45	643	desired ID: 949
05/02/2015 14:34:45	643	actual ID: 949
05/02/2015 14:34:45	643	GM Created: Our Groceries new items
05/02/2015 14:34:45	643	# of macros loaded: 5
05/02/2015 14:34:45	644	srgs\en-GB_Our Groceries new items.cfg exists: True
05/02/2015 14:34:45	644	srgs\en-GB_Our Groceries new items.cfg exists: True
05/02/2015 14:34:45	644	loading grammar into engine
05/02/2015 14:34:45	666	Grammar ready.  Enabled: True Name: Our Groceries new items
05/02/2015 14:34:45	666	processing group: Current Time
05/02/2015 14:34:45	666	New groupMonster created
05/02/2015 14:34:45	666	creating group: Current Time
05/02/2015 14:34:45	666	Creating Hashcode
05/02/2015 14:34:45	666	loading macros for group: Current Time
05/02/2015 14:34:45	666	found 1commands
05/02/2015 14:34:45	666	creating command: Current Time
05/02/2015 14:34:45	666	desired ID: 950
05/02/2015 14:34:45	666	actual ID: 950
05/02/2015 14:34:45	666	GM Created: Current Time
05/02/2015 14:34:45	666	# of macros loaded: 1
05/02/2015 14:34:45	666	srgs\en-GB_Current Time.cfg exists: True
05/02/2015 14:34:45	667	srgs\en-GB_Current Time.cfg exists: True
05/02/2015 14:34:45	667	loading grammar into engine
05/02/2015 14:34:45	668	Grammar ready.  Enabled: True Name: Current Time
05/02/2015 14:34:45	668	processing group: Todays Date
05/02/2015 14:34:45	668	New groupMonster created
05/02/2015 14:34:45	668	creating group: Todays Date
05/02/2015 14:34:45	668	Creating Hashcode
05/02/2015 14:34:45	668	loading macros for group: Todays Date
05/02/2015 14:34:45	668	found 1commands
05/02/2015 14:34:45	668	creating command: Todays Date
05/02/2015 14:34:45	668	desired ID: 962
05/02/2015 14:34:45	668	actual ID: 962
05/02/2015 14:34:45	668	GM Created: Todays Date
05/02/2015 14:34:45	668	# of macros loaded: 1
05/02/2015 14:34:45	668	srgs\en-GB_Todays Date.cfg exists: True
05/02/2015 14:34:45	668	srgs\en-GB_Todays Date.cfg exists: True
05/02/2015 14:34:45	669	loading grammar into engine
05/02/2015 14:34:45	669	Grammar ready.  Enabled: True Name: Todays Date
05/02/2015 14:34:45	669	processing group: VC_DefaultConfirm
05/02/2015 14:34:45	669	New groupMonster created
05/02/2015 14:34:45	669	creating group: VC_DefaultConfirm
05/02/2015 14:34:45	669	Creating Hashcode
05/02/2015 14:34:45	669	loading macros for group: VC_DefaultConfirm
05/02/2015 14:34:45	669	found 2commands
05/02/2015 14:34:45	669	creating command: ConfirmYes
05/02/2015 14:34:45	669	desired ID: 139
05/02/2015 14:34:45	669	actual ID: 139
05/02/2015 14:34:45	669	creating command: ConfirmNo
05/02/2015 14:34:45	669	desired ID: 149
05/02/2015 14:34:45	669	actual ID: 149
05/02/2015 14:34:45	669	GM Created: VC_DefaultConfirm
05/02/2015 14:34:45	669	# of macros loaded: 2
05/02/2015 14:34:45	670	srgs\en-GB_VC_DefaultConfirm.cfg exists: True
05/02/2015 14:34:45	670	srgs\en-GB_VC_DefaultConfirm.cfg exists: True
05/02/2015 14:34:45	670	loading grammar into engine
05/02/2015 14:34:45	671	Grammar ready.  Enabled: False Name: VC_DefaultConfirm
05/02/2015 14:34:45	671	[info] Re loaded commands in (ms): 184.1108
group ADDED: Vox commands# of macros loaded: 4
group ADDED: Fibaro Basic# of macros loaded: 3
group ADDED: Wunder# of macros loaded: 6
group ADDED: Show help# of macros loaded: 2
group ADDED: our groceries high priority# of macros loaded: 1
group ADDED: Our Groceries new items# of macros loaded: 5
group ADDED: Current Time# of macros loaded: 1
group ADDED: Todays Date# of macros loaded: 1
group ADDED: VC_DefaultConfirm# of macros loaded: 2

05/02/2015 14:34:45	671	[info] loaded events: 2

05/02/2015 14:34:45	672	using speech engine: Microsoft Speech Recognizer 8.0 for Windows (English - UK)
05/02/2015 14:34:45	697	Kinect object is null, using default input
05/02/2015 14:34:45	839	en-GB
05/02/2015 14:34:45	840	Loading plugins...
05/02/2015 14:34:45	840	[info] Loading plugins

05/02/2015 14:34:45	889	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Audio\Audio.dll
05/02/2015 14:34:45	921	Plugin not selected in options: Audio
05/02/2015 14:34:45	921	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\audioendpoint\AudioEndpoint.dll
05/02/2015 14:34:45	928	Plugin not selected in options: AudioEndpoint
05/02/2015 14:34:45	928	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Bing\Bing.dll
05/02/2015 14:34:45	935	Plugin not selected in options: Bing
05/02/2015 14:34:45	935	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\DxInput\DxInput.dll
05/02/2015 14:34:45	943	Plugin not selected in options: DxInput
05/02/2015 14:34:45	943	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\GgCal\GgCal.dll
05/02/2015 14:34:45	950	Plugin not selected in options: GgCal
05/02/2015 14:34:45	950	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Growl\Growl.dll
05/02/2015 14:34:45	958	Plugin not selected in options: Growl
05/02/2015 14:34:45	958	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\HitServer\HitServer.dll
05/02/2015 14:34:45	965	Plugin not selected in options: HitServer
05/02/2015 14:34:45	965	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Hook\Hook.dll
05/02/2015 14:34:45	973	Plugin not selected in options: Hook
05/02/2015 14:34:45	973	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Hue\Hue.dll
05/02/2015 14:34:45	981	Plugin not selected in options: Hue
05/02/2015 14:34:45	981	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\iTunes\Interop.iTunesLib.dll
05/02/2015 14:34:45	988	Plugin not selected in options: Interop.iTunesLib
05/02/2015 14:34:45	988	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\iTunes\iTunes.dll
05/02/2015 14:34:45	992	Plugin not selected in options: iTunes
05/02/2015 14:34:45	992	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\JRiver\JRiver.dll
05/02/2015 14:34:45	999	Plugin not selected in options: JRiver
05/02/2015 14:34:45	999	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\MM\MM.dll
05/02/2015 14:34:46	7	Plugin not selected in options: MM
05/02/2015 14:34:46	7	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\MpMessage\MpMessage.dll
05/02/2015 14:34:46	14	Plugin not selected in options: MpMessage
05/02/2015 14:34:46	14	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\MpScan\MpScan.dll
05/02/2015 14:34:46	21	Plugin not selected in options: MpScan
05/02/2015 14:34:46	21	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\MpWifi\MpWifi.dll
05/02/2015 14:34:46	28	Plugin not selected in options: MpWifi
05/02/2015 14:34:46	28	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\MpWifi\ZeroconfService.dll
05/02/2015 14:34:46	33	Plugin not selected in options: ZeroconfService
05/02/2015 14:34:46	33	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\MsAgent\MsAgent.dll
05/02/2015 14:34:46	40	Plugin not selected in options: MsAgent
05/02/2015 14:34:46	40	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Onkyo\Onkyo.dll
05/02/2015 14:34:46	49	Plugin not selected in options: Onkyo
05/02/2015 14:34:46	49	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\PY\PY.dll
05/02/2015 14:34:46	56	Plugin not selected in options: PY
05/02/2015 14:34:46	56	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\RoboB\RoboB.dll
05/02/2015 14:34:46	62	Loading: RoboB
05/02/2015 14:34:46	78	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Skype\Skype.dll
05/02/2015 14:34:46	86	Plugin not selected in options: Skype
05/02/2015 14:34:46	86	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\TCP\TCP.dll
05/02/2015 14:34:46	93	Plugin not selected in options: TCP
05/02/2015 14:34:46	93	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\TcpMic\TcpMic.dll
05/02/2015 14:34:46	100	Plugin not selected in options: TcpMic
05/02/2015 14:34:46	100	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\TTS\Interop.SpeechLib.dll
05/02/2015 14:34:46	107	Plugin not selected in options: Interop.SpeechLib
05/02/2015 14:34:46	107	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\TTS\TTS.dll
05/02/2015 14:34:46	112	Loading: TTS
05/02/2015 14:34:46	518	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\TTSMS\Interop.SpeechLib.dll
05/02/2015 14:34:46	534	Not a valid plugin. 
System.ArgumentException: An item with the same key has already been added.
   at System.ThrowHelper.ThrowArgumentException(ExceptionResource resource)
   at System.Collections.Generic.Dictionary`2.Insert(TKey key, TValue value, Boolean add)
   at VoxCommando.PluginServices.loadEnabledPlugins(String Path, List`1 whichPlugins)
05/02/2015 14:34:46	534	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\TTSMS\TTSMS.dll
05/02/2015 14:34:46	542	Plugin not selected in options: TTSMS
05/02/2015 14:34:46	542	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\UsbUirt\UsbUirt.dll
05/02/2015 14:34:46	550	Plugin not selected in options: UsbUirt
05/02/2015 14:34:46	550	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Vera\Vera.dll
05/02/2015 14:34:46	558	Loading: Vera
05/02/2015 14:34:46	676	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Watcher\Watcher.dll
05/02/2015 14:34:46	683	Plugin not selected in options: Watcher
05/02/2015 14:34:46	683	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Wemo\Wemo.dll
05/02/2015 14:34:46	689	Plugin not selected in options: Wemo
05/02/2015 14:34:46	689	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\WMC\WMC.dll
05/02/2015 14:34:46	697	Plugin not selected in options: WMC
05/02/2015 14:34:46	697	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Wunder\WUnder.dll
05/02/2015 14:34:46	704	Loading: WUnder
05/02/2015 14:34:46	731	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\X10\X10.dll
05/02/2015 14:34:46	741	Plugin not selected in options: X10
05/02/2015 14:34:46	741	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\XJson\XJson.dll
05/02/2015 14:34:46	749	Plugin not selected in options: XJson
05/02/2015 14:34:46	749	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\XJson\de\XJson.resources.dll
05/02/2015 14:34:46	756	Plugin not selected in options: XJson.resources
05/02/2015 14:34:46	756	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\XJson\es\XJson.resources.dll
05/02/2015 14:34:46	763	Not a valid plugin. 
System.ArgumentException: An item with the same key has already been added.
   at System.ThrowHelper.ThrowArgumentException(ExceptionResource resource)
   at System.Collections.Generic.Dictionary`2.Insert(TKey key, TValue value, Boolean add)
   at VoxCommando.PluginServices.loadEnabledPlugins(String Path, List`1 whichPlugins)
05/02/2015 14:34:46	764	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\XJson\fr\XJson.resources.dll
05/02/2015 14:34:46	771	Not a valid plugin. 
System.ArgumentException: An item with the same key has already been added.
   at System.ThrowHelper.ThrowArgumentException(ExceptionResource resource)
   at System.Collections.Generic.Dictionary`2.Insert(TKey key, TValue value, Boolean add)
   at VoxCommando.PluginServices.loadEnabledPlugins(String Path, List`1 whichPlugins)
05/02/2015 14:34:46	771	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\XJson\pt-BR\XJson.resources.dll
05/02/2015 14:34:46	781	Not a valid plugin. 
System.ArgumentException: An item with the same key has already been added.
   at System.ThrowHelper.ThrowArgumentException(ExceptionResource resource)
   at System.Collections.Generic.Dictionary`2.Insert(TKey key, TValue value, Boolean add)
   at VoxCommando.PluginServices.loadEnabledPlugins(String Path, List`1 whichPlugins)
05/02/2015 14:34:46	781	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\xMySql\xMySql.dll
05/02/2015 14:34:46	791	Plugin not selected in options: xMySql
05/02/2015 14:34:46	791	found dll: C:\Users\Steve\SkyDrive\VoxCommando\Plugins\Xsql\Xsql.dll
05/02/2015 14:34:46	801	Plugin not selected in options: Xsql
05/02/2015 14:34:47	139	[plugin] http://192.168.0.151:3480/data_request?id=sdata
05/02/2015 14:34:47	311	[vcevent] Vera1.Scanned.OK

05/02/2015 14:34:47	312	[vcevent] Plugins.Busy.1

05/02/2015 14:34:47	319	[plugin] http://192.168.0.151:3480/data_request?id=lu_sdata&timeout=60&minimumdelay=50
05/02/2015 14:34:47	614	[vcevent] Plugins.Busy.0

05/02/2015 14:34:47	615	[vcevent] VC.Loaded

05/02/2015 14:34:47	616	[info] event in group: Our Groceries new items

05/02/2015 14:34:47	622	[info] thread created

05/02/2015 14:34:47	626	doCommand:++open list
05/02/2015 14:34:47	690	action repeat set to: 1
05/02/2015 14:34:47	690	Action:  RoboB.Select - OurGroceries
05/02/2015 14:34:47	690	[action] RoboB.Select:OurGroceries

05/02/2015 14:34:47	752	action result: creating: OurGroceries
05/02/2015 14:34:47	752	action repeat set to: 1
05/02/2015 14:34:47	752	Action:  RoboB.SetWinSize - 800&&600
05/02/2015 14:34:47	752	[action] RoboB.SetWinSize:800&&600

05/02/2015 14:34:47	755	action result: window resized width: 800, height: 600
05/02/2015 14:34:47	770	action repeat set to: 1
05/02/2015 14:34:47	770	Action:  RoboB.Navigate - http://www.ourgroceries.com/your-lists/list/rAaukbc8tlGKvk5RCHXpWy
05/02/2015 14:34:47	770	[action] RoboB.Navigate:http://www.ourgroceries.com/your-lists/list/rAaukbc8tlGKvk5RCHXpWy

05/02/2015 14:34:47	912	action result: 
05/02/2015 14:34:47	912	action repeat set to: 1
05/02/2015 14:34:47	912	Action:  RoboB.Show - 
05/02/2015 14:34:47	912	[action] RoboB.Show:

05/02/2015 14:34:47	925	action result: 
05/02/2015 14:34:47	927	action repeat set to: 1
05/02/2015 14:34:47	927	Action:  VC.Pause - 1800
05/02/2015 14:34:47	928	[action] VC.Pause:1800

05/02/2015 14:34:47	955	[info] 9 of 9 groups already loaded

05/02/2015 14:34:47	962	Kinect object is null, using default input
05/02/2015 14:34:48	96	[vcevent] VC.On

05/02/2015 14:34:48	100	idle timer set for 1 seconds.
05/02/2015 14:34:48	100	[info] Timeout set for: 1(s)

05/02/2015 14:34:49	107	[vcevent] VC.Standby

05/02/2015 14:34:49	111	[vcevent] vc.idletimeout

05/02/2015 14:34:49	330	[plugin] http://192.168.0.151:3480/data_request?id=lu_sdata&loadtime=1423101746&dataversion=101746409&timeout=900&minimumdelay=2500
05/02/2015 14:34:49	731	action repeat set to: 1
05/02/2015 14:34:49	731	Action:  RoboB.Wait - 
05/02/2015 14:34:49	731	[action] RoboB.Wait:

05/02/2015 14:34:49	862	focused: VoxCommando
05/02/2015 14:34:49	862	[vcevent] focused.VoxCommando

05/02/2015 14:34:50	310	guessed text:pay ?? (Vox commands)
05/02/2015 14:34:50	796	[vcevent] VC.NotRecognized

05/02/2015 14:34:52	247	[vcevent] RoboB.DocComplete.OurGroceries

05/02/2015 14:34:52	271	action result: 
05/02/2015 14:34:52	274	[logic] doing IF: LastActionSuccess

05/02/2015 14:34:52	322	action repeat set to: 0
05/02/2015 14:34:52	324	action repeat set to: 1
05/02/2015 14:34:52	324	Action:  RoboB.SetText - email@stevejones.org
05/02/2015 14:34:52	324	[action] RoboB.SetText:email@stevejones.org

05/02/2015 14:34:52	328	action result: Error: System.NullReferenceException: Object reference not set to an instance of an object.
   at vcPlugin.frmRoboB.setCurrentInnerText(String strVal)
   at vcPlugin.Plugin.doAction(String[] parsedActions, String[] parsedParams)
05/02/2015 14:34:52	341	action repeat set to: 1
05/02/2015 14:34:52	341	Action:  RoboB.ElementByID - password
05/02/2015 14:34:52	341	[action] RoboB.ElementByID:password

05/02/2015 14:34:52	441	action result: found element
05/02/2015 14:34:52	442	action repeat set to: 1
05/02/2015 14:34:52	442	Action:  RoboB.SetText - 30845912
05/02/2015 14:34:52	442	[action] RoboB.SetText:30845912

05/02/2015 14:34:52	444	action result: 
05/02/2015 14:34:52	444	action repeat set to: 1
05/02/2015 14:34:52	444	Action:  RoboB.ElementByID - staySignedIn
05/02/2015 14:34:52	444	[action] RoboB.ElementByID:staySignedIn

05/02/2015 14:34:52	445	action result: found element
05/02/2015 14:34:52	445	action repeat set to: 1
05/02/2015 14:34:52	446	Action:  RoboB.Click - 
05/02/2015 14:34:52	446	[action] RoboB.Click:

05/02/2015 14:34:52	450	action result: 
05/02/2015 14:34:52	450	action repeat set to: 1
05/02/2015 14:34:52	450	Action:  RoboB.ElementByID - signInButton
05/02/2015 14:34:52	450	[action] RoboB.ElementByID:signInButton

05/02/2015 14:34:52	452	action result: found element
05/02/2015 14:34:52	466	action repeat set to: 1
05/02/2015 14:34:52	466	Action:  RoboB.Click - 
05/02/2015 14:34:52	466	[action] RoboB.Click:

05/02/2015 14:34:52	494	action result: 
05/02/2015 14:34:52	495	action repeat set to: 1
05/02/2015 14:34:52	495	Action:  VC.Pause - 100
05/02/2015 14:34:52	495	[action] VC.Pause:100

05/02/2015 14:34:53	379	[vcevent] RoboB.DocComplete.OurGroceries

05/02/2015 14:34:57	468	[vcevent] VC.OpenEditor

05/02/2015 14:34:57	532	options: loading options
05/02/2015 14:34:57	563	options: verifying speech engine culture language
05/02/2015 14:34:57	563	SRE verify engine available: en-GB | 
05/02/2015 14:34:57	651	Parent node: commandGroup / Vox commands. Loading children: 4
05/02/2015 14:34:57	651	Parent node: command / Don't Listen. Loading children: 2
05/02/2015 14:34:57	655	Parent node: command / Listen. Loading children: 2
05/02/2015 14:34:57	656	Parent node: command / Option. Loading children: 3
05/02/2015 14:34:57	656	Parent node: command / Vox Off. Loading children: 2
05/02/2015 14:34:57	658	Parent node: commandGroup / Fibaro Basic. Loading children: 3
05/02/2015 14:34:57	658	Parent node: command / Dim {1} to {2} percent. Loading children: 8
05/02/2015 14:34:57	660	Parent node: command / Switch{1} {2}. Loading children: 9
05/02/2015 14:34:57	660	Parent node: command / Method 1: Get status of {1}. Loading children: 4
05/02/2015 14:34:57	661	Parent node: commandGroup / Wunder. Loading children: 6
05/02/2015 14:34:57	661	Parent node: command / Todays Weather. Loading children: 6
05/02/2015 14:34:57	661	Parent node: command / Tomorrows Weather. Loading children: 7
05/02/2015 14:34:57	661	Parent node: command / Weather Forecast. Loading children: 7
05/02/2015 14:34:57	661	Parent node: command / Temperature Highs Weather. Loading children: 6
05/02/2015 14:34:57	661	Parent node: command / Todays Temperature. Loading children: 9
05/02/2015 14:34:57	662	Parent node: command / Weather test. Loading children: 7
05/02/2015 14:34:57	662	Parent node: commandGroup / Show help. Loading children: 2
05/02/2015 14:34:57	662	Parent node: command / Show active commands. Loading children: 8
05/02/2015 14:34:57	662	Parent node: command / Show help. Loading children: 3
05/02/2015 14:34:57	663	Parent node: commandGroup / our groceries high priority. Loading children: 1
05/02/2015 14:34:57	663	Parent node: command / Add Item. Loading children: 18
05/02/2015 14:34:57	664	Parent node: commandGroup / Our Groceries new items. Loading children: 5
05/02/2015 14:34:57	664	Parent node: command / ++open list. Loading children: 10
05/02/2015 14:34:57	664	Parent node: command / Add Item dictionary. Loading children: 12
05/02/2015 14:34:57	665	Parent node: command / Are you sure?. Loading children: 2
05/02/2015 14:34:57	665	Parent node: command / Show Groceries. Loading children: 3
05/02/2015 14:34:57	665	Parent node: command / update payload XML master list. Loading children: 18
05/02/2015 14:34:57	666	Parent node: commandGroup / Current Time. Loading children: 1
05/02/2015 14:34:57	666	Parent node: command / Current Time. Loading children: 9
05/02/2015 14:34:57	666	Parent node: commandGroup / Todays Date. Loading children: 1
05/02/2015 14:34:57	666	Parent node: command / Todays Date. Loading children: 8
05/02/2015 14:35:09	174	[vcevent] VC.Rebuild.Start

05/02/2015 14:35:09	176	[info] autorebuild initiated

05/02/2015 14:35:09	178	[info] checking for changes to payloadXML files using: en-GB

05/02/2015 14:35:09	183	Checking if any .cfg files need to be updated
05/02/2015 14:35:09	184	checking date of file: srgs\en-GB_Vox commands.cfg
05/02/2015 14:35:09	184	srgs\en-GB_Vox commands.cfg: is OK
05/02/2015 14:35:09	184	checking date of file: srgs\en-GB_Fibaro Basic.cfg
05/02/2015 14:35:09	186	srgs\en-GB_Fibaro Basic.cfg: is OK
05/02/2015 14:35:09	186	checking date of file: srgs\en-GB_Wunder.cfg
05/02/2015 14:35:09	186	srgs\en-GB_Wunder.cfg: is OK
05/02/2015 14:35:09	187	checking date of file: srgs\en-GB_Show help.cfg
05/02/2015 14:35:09	187	srgs\en-GB_Show help.cfg: is OK
05/02/2015 14:35:09	187	checking date of file: srgs\en-GB_our groceries high priority.cfg
05/02/2015 14:35:09	188	srgs\en-GB_our groceries high priority.cfg: is OK
05/02/2015 14:35:09	188	checking date of file: srgs\en-GB_Our Groceries new items.cfg
05/02/2015 14:35:09	188	srgs\en-GB_Our Groceries new items.cfg: is OK
05/02/2015 14:35:09	189	checking date of file: srgs\en-GB_Current Time.cfg
05/02/2015 14:35:09	189	srgs\en-GB_Current Time.cfg: is OK
05/02/2015 14:35:09	189	checking date of file: srgs\en-GB_Todays Date.cfg
05/02/2015 14:35:09	189	srgs\en-GB_Todays Date.cfg: is OK
05/02/2015 14:35:09	189	checking date of file: srgs\en-GB_VC_DefaultConfirm.cfg
05/02/2015 14:35:09	189	srgs\en-GB_VC_DefaultConfirm.cfg: is OK
05/02/2015 14:35:09	191	Reload GroupMonsters
05/02/2015 14:35:09	192	processing group: Vox commands
05/02/2015 14:35:09	192	group EXISTS: Vox commands
05/02/2015 14:35:09	193	Refresh requested for group: Vox commands
05/02/2015 14:35:09	193	Old Hashcode: -1252905547
05/02/2015 14:35:09	194	srgs\en-GB_Vox commands.cfg exists: True
05/02/2015 14:35:09	194	Hash is the same. No rebuild required
05/02/2015 14:35:09	194	loading macros for group: Vox commands
05/02/2015 14:35:09	194	found 4commands
05/02/2015 14:35:09	194	creating command: Don't Listen
05/02/2015 14:35:09	194	desired ID: 1
05/02/2015 14:35:09	194	actual ID: 1
05/02/2015 14:35:09	194	creating command: Listen
05/02/2015 14:35:09	194	desired ID: 19
05/02/2015 14:35:09	194	actual ID: 19
05/02/2015 14:35:09	194	creating command: Option
05/02/2015 14:35:09	194	desired ID: 26
05/02/2015 14:35:09	194	actual ID: 26
05/02/2015 14:35:09	194	creating command: Vox Off
05/02/2015 14:35:09	194	desired ID: 36
05/02/2015 14:35:09	194	actual ID: 36
05/02/2015 14:35:09	194	processing group: Fibaro Basic
05/02/2015 14:35:09	194	group EXISTS: Fibaro Basic
05/02/2015 14:35:09	194	Refresh requested for group: Fibaro Basic
05/02/2015 14:35:09	194	Old Hashcode: -1610304515
05/02/2015 14:35:09	194	srgs\en-GB_Fibaro Basic.cfg exists: True
05/02/2015 14:35:09	194	Hash is the same. No rebuild required
05/02/2015 14:35:09	194	loading macros for group: Fibaro Basic
05/02/2015 14:35:09	194	found 3commands
05/02/2015 14:35:09	194	creating command: Dim {1} to {2} percent
05/02/2015 14:35:09	194	desired ID: 305
05/02/2015 14:35:09	194	actual ID: 305
05/02/2015 14:35:09	194	creating command: Switch{1} {2}
05/02/2015 14:35:09	194	desired ID: 310
05/02/2015 14:35:09	194	actual ID: 310
05/02/2015 14:35:09	195	creating command: Method 1: Get status of {1}
05/02/2015 14:35:09	195	desired ID: 316
05/02/2015 14:35:09	195	actual ID: 316
05/02/2015 14:35:09	195	processing group: Wunder
05/02/2015 14:35:09	195	group EXISTS: Wunder
05/02/2015 14:35:09	195	Refresh requested for group: Wunder
05/02/2015 14:35:09	195	Old Hashcode: -1287566389
05/02/2015 14:35:09	195	srgs\en-GB_Wunder.cfg exists: True
05/02/2015 14:35:09	195	Hash is the same. No rebuild required
05/02/2015 14:35:09	195	loading macros for group: Wunder
05/02/2015 14:35:09	195	found 6commands
05/02/2015 14:35:09	195	creating command: Todays Weather
05/02/2015 14:35:09	195	desired ID: 963
05/02/2015 14:35:09	195	actual ID: 963
05/02/2015 14:35:09	195	creating command: Tomorrows Weather
05/02/2015 14:35:09	195	desired ID: 970
05/02/2015 14:35:09	195	actual ID: 970
05/02/2015 14:35:09	195	creating command: Weather Forecast
05/02/2015 14:35:09	195	desired ID: 988
05/02/2015 14:35:09	195	actual ID: 988
05/02/2015 14:35:09	195	creating command: Temperature Highs Weather
05/02/2015 14:35:09	195	desired ID: 974
05/02/2015 14:35:09	195	actual ID: 974
05/02/2015 14:35:09	195	creating command: Todays Temperature
05/02/2015 14:35:09	195	desired ID: 979
05/02/2015 14:35:09	195	actual ID: 979
05/02/2015 14:35:09	195	creating command: Weather test
05/02/2015 14:35:09	195	desired ID: 997
05/02/2015 14:35:09	195	actual ID: 997
05/02/2015 14:35:09	195	processing group: Show help
05/02/2015 14:35:09	195	group EXISTS: Show help
05/02/2015 14:35:09	195	Refresh requested for group: Show help
05/02/2015 14:35:09	195	Old Hashcode: 1224827913
05/02/2015 14:35:09	196	srgs\en-GB_Show help.cfg exists: True
05/02/2015 14:35:09	196	Hash is the same. No rebuild required
05/02/2015 14:35:09	196	loading macros for group: Show help
05/02/2015 14:35:09	196	found 2commands
05/02/2015 14:35:09	196	creating command: Show active commands
05/02/2015 14:35:09	196	desired ID: 269
05/02/2015 14:35:09	196	actual ID: 269
05/02/2015 14:35:09	196	creating command: Show help
05/02/2015 14:35:09	196	desired ID: 271
05/02/2015 14:35:09	196	actual ID: 271
05/02/2015 14:35:09	196	processing group: our groceries high priority
05/02/2015 14:35:09	196	group EXISTS: our groceries high priority
05/02/2015 14:35:09	196	Refresh requested for group: our groceries high priority
05/02/2015 14:35:09	196	Old Hashcode: 617474520
05/02/2015 14:35:09	196	srgs\en-GB_our groceries high priority.cfg exists: True
05/02/2015 14:35:09	196	Hash is the same. No rebuild required
05/02/2015 14:35:09	196	loading macros for group: our groceries high priority
05/02/2015 14:35:09	196	found 1commands
05/02/2015 14:35:09	196	creating command: Add Item
05/02/2015 14:35:09	196	desired ID: 934
05/02/2015 14:35:09	196	actual ID: 934
05/02/2015 14:35:09	196	processing group: Our Groceries new items
05/02/2015 14:35:09	196	group EXISTS: Our Groceries new items
05/02/2015 14:35:09	196	Refresh requested for group: Our Groceries new items
05/02/2015 14:35:09	196	Old Hashcode: 1758467663
05/02/2015 14:35:09	197	srgs\en-GB_Our Groceries new items.cfg exists: True
05/02/2015 14:35:09	197	Hash is the same. No rebuild required
05/02/2015 14:35:09	197	loading macros for group: Our Groceries new items
05/02/2015 14:35:09	197	found 5commands
05/02/2015 14:35:09	197	creating command: ++open list
05/02/2015 14:35:09	197	desired ID: 955
05/02/2015 14:35:09	197	actual ID: 955
05/02/2015 14:35:09	197	skipping event loading for now...
05/02/2015 14:35:09	197	creating command: Add Item dictionary
05/02/2015 14:35:09	197	desired ID: 877
05/02/2015 14:35:09	197	actual ID: 877
05/02/2015 14:35:09	197	creating command: Are you sure?
05/02/2015 14:35:09	197	desired ID: 942
05/02/2015 14:35:09	197	actual ID: 942
05/02/2015 14:35:09	197	skipping event loading for now...
05/02/2015 14:35:09	197	creating command: Show Groceries
05/02/2015 14:35:09	197	desired ID: 915
05/02/2015 14:35:09	197	actual ID: 915
05/02/2015 14:35:09	197	creating command: update payload XML master list
05/02/2015 14:35:09	197	desired ID: 949
05/02/2015 14:35:09	197	actual ID: 949
05/02/2015 14:35:09	197	processing group: Current Time
05/02/2015 14:35:09	197	group EXISTS: Current Time
05/02/2015 14:35:09	197	Refresh requested for group: Current Time
05/02/2015 14:35:09	197	Old Hashcode: -856960553
05/02/2015 14:35:09	198	srgs\en-GB_Current Time.cfg exists: True
05/02/2015 14:35:09	198	Hash is the same. No rebuild required
05/02/2015 14:35:09	198	loading macros for group: Current Time
05/02/2015 14:35:09	198	found 1commands
05/02/2015 14:35:09	198	creating command: Current Time
05/02/2015 14:35:09	198	desired ID: 950
05/02/2015 14:35:09	198	actual ID: 950
05/02/2015 14:35:09	198	processing group: Todays Date
05/02/2015 14:35:09	198	group EXISTS: Todays Date
05/02/2015 14:35:09	198	Refresh requested for group: Todays Date
05/02/2015 14:35:09	198	Old Hashcode: -335018245
05/02/2015 14:35:09	198	srgs\en-GB_Todays Date.cfg exists: True
05/02/2015 14:35:09	198	Hash is the same. No rebuild required
05/02/2015 14:35:09	198	loading macros for group: Todays Date
05/02/2015 14:35:09	198	found 1commands
05/02/2015 14:35:09	198	creating command: Todays Date
05/02/2015 14:35:09	198	desired ID: 962
05/02/2015 14:35:09	198	actual ID: 962
05/02/2015 14:35:09	198	processing group: VC_DefaultConfirm
05/02/2015 14:35:09	198	group EXISTS: VC_DefaultConfirm
05/02/2015 14:35:09	198	Refresh requested for group: VC_DefaultConfirm
05/02/2015 14:35:09	198	Old Hashcode: 1091503697
05/02/2015 14:35:09	199	srgs\en-GB_VC_DefaultConfirm.cfg exists: True
05/02/2015 14:35:09	199	Hash is the same. No rebuild required
05/02/2015 14:35:09	199	loading macros for group: VC_DefaultConfirm
05/02/2015 14:35:09	199	found 2commands
05/02/2015 14:35:09	199	creating command: ConfirmYes
05/02/2015 14:35:09	199	desired ID: 139
05/02/2015 14:35:09	199	actual ID: 139
05/02/2015 14:35:09	199	creating command: ConfirmNo
05/02/2015 14:35:09	199	desired ID: 149
05/02/2015 14:35:09	199	actual ID: 149
05/02/2015 14:35:09	199	[info] Re loaded commands in (ms): 7.0047
group EXISTS: Vox commands
group EXISTS: Fibaro Basic
group EXISTS: Wunder
group EXISTS: Show help
group EXISTS: our groceries high priority
group EXISTS: Our Groceries new items
group EXISTS: Current Time
group EXISTS: Todays Date
group EXISTS: VC_DefaultConfirm

05/02/2015 14:35:09	201	[info] loaded events: 2

05/02/2015 14:35:15	675	guessed text:the ?? (Todays Date)
05/02/2015 14:35:16	350	[vcevent] VC.NotRecognized

05/02/2015 14:35:17	914	[vcevent] VC.Prefix.Start

05/02/2015 14:35:17	916	guessed text:VERA ?? (our groceries high priority)
05/02/2015 14:35:18	100	guessed text:VERA Get ?? (Wunder)
05/02/2015 14:35:18	414	guessed text:VERA Get status ?? (Fibaro Basic)
05/02/2015 14:35:18	663	guessed text:VERA Get status of ?? (Fibaro Basic)
05/02/2015 14:35:18	913	guessed text:VERA Get status of device ?? (Fibaro Basic)
05/02/2015 14:35:19	101	guessed text:VERA Get status of device number ?? (Fibaro Basic)
05/02/2015 14:35:19	605	guessed text:VERA Get status of device number 25 ?? (Fibaro Basic)
05/02/2015 14:35:20	176	Rulename: root 	# Semantics: 2
05/02/2015 14:35:20	176	Group: Fibaro Basic 	Speech: VERA Get status of device number 25
05/02/2015 14:35:20	177	semanticID: 316
05/02/2015 14:35:20	177	command ID: 316
05/02/2015 14:35:20	181	semanticID: 316
05/02/2015 14:35:20	181	kvp: prefix | VERA
05/02/2015 14:35:20	181	kvp: command | 316
05/02/2015 14:35:20	189	semanticID: 316
05/02/2015 14:35:20	189	kvp: prefix | VERA
05/02/2015 14:35:20	189	kvp: command | 316
05/02/2015 14:35:20	189	alternate:VERA Get status of device number 25
05/02/2015 14:35:20	208	[info] prefix passed confidence test: 92.4

05/02/2015 14:35:20	249	[vcevent] VC.Prefix.End

05/02/2015 14:35:20	253	doCommand:Method 1: Get status of {1}
05/02/2015 14:35:20	254	action repeat set to: 1
05/02/2015 14:35:20	254	Action:  Scrape.Get - http://192.168.0.155/api/devices?id=25&&&&&&&&&&Authorization: Basic YWRtaW46YWRtaW4=
05/02/2015 14:35:20	254	[action] Scrape.Get:http://192.168.0.155/api/devices?id=25&&&&&&&&&&Authorization: Basic YWRtaW46YWRtaW4=

05/02/2015 14:35:20	258	Doing scrape put/post with headers:
Authorization: Basic YWRtaW46YWRtaW4=


05/02/2015 14:35:20	272	action result: {"id":25,"name":"Test light","roomID":10,"type":"com.fibaro.multilevelSwitch","baseType":"com.fibaro.binarySwitch","enabled":true,"visible":true,"isPlugin":false,"parentId":24,"remoteGatewayId":0,"interfaces":["light","zwave","zwaveProtection"],"properties":{"parameters":[],"associationSet":[],"associationView":[],"zwaveCompany":"Everspring","zwaveInfo":"4,2,64","zwaveVersion":"1.2","pollingTimeSec":0,"RFProtectionState":"0","RFProtectionSupport":"0","configured":"true","dead":"false","deviceControlType":"23","deviceIcon":"15","emailNotificationID":"0","emailNotificationType":"0","endPointId":"0","isLight":"true","liliOffCommand":"","liliOnCommand":"","localProtectionState":"0","localProtectionSupport":"0","log":"","logTemp":"","manufacturer":"","markAsDead":"true","model":"","nodeId":"5","parametersTemplate":"61","productInfo":"0,96,0,3,0,1,1,2","protectionExclusiveControl":"0","protectionExclusiveControlSupport":"false","protectionState":"0","protectionTimeout":"0","protectionTimeoutSupport":"false","pushNotificationID":"0","pushNotificationType":"0","remoteGatewayId":"0","saveLogs":"true","smsNotificationID":"0","smsNotificationType":"0","useTemplate":"false","userDescription":"","value":"1"},"actions":{"reconfigure":0,"setValue":1,"turnOff":0,"turnOn":0},"created":1422642147,"modified":1422642147,"sortOrder":19}
05/02/2015 14:35:20	273	action repeat set to: 1
05/02/2015 14:35:20	278	Action:  OSD.ShowText - {"id":25,"name":"Test light","roomID":10,"type":"com.fibaro.multilevelSwitch","baseType":"com.fibaro.binarySwitch","enabled":true,"visible":true,"isPlugin":false,"parentId":24,"remoteGatewayId":0,"interfaces":["light","zwave","zwaveProtection"],"properties":{"parameters":[],"associationSet":[],"associationView":[],"zwaveCompany":"Everspring","zwaveInfo":"4,2,64","zwaveVersion":"1.2","pollingTimeSec":0,"RFProtectionState":"0","RFProtectionSupport":"0","configured":"true","dead":"false","deviceControlType":"23","deviceIcon":"15","emailNotificationID":"0","emailNotificationType":"0","endPointId":"0","isLight":"true","liliOffCommand":"","liliOnCommand":"","localProtectionState":"0","localProtectionSupport":"0","log":"","logTemp":"","manufacturer":"","markAsDead":"true","model":"","nodeId":"5","parametersTemplate":"61","productInfo":"0,96,0,3,0,1,1,2","protectionExclusiveControl":"0","protectionExclusiveControlSupport":"false","protectionState":"0","protectionTimeout":"0","protectionTimeoutSupport":"false","pushNotificationID":"0","pushNotificationType":"0","remoteGatewayId":"0","saveLogs":"true","smsNotificationID":"0","smsNotificationType":"0","useTemplate":"false","userDescription":"","value":"1"},"actions":{"reconfigure":0,"setValue":1,"turnOff":0,"turnOn":0},"created":1422642147,"modified":1422642147,"sortOrder":19}
05/02/2015 14:35:20	278	[action] OSD.ShowText:{"id":25,"name":"Test light","roomID":10,"type":"com.fibaro.multilevelSwitch","baseType":"com.fibaro.binarySwitch","enabled":true,"visible":true,"isPlugin":false,"parentId":24,"remoteGatewayId":0,"interfaces":["light","zwave","zwaveProtection"],"properties":{"parameters":[],"associationSet":[],"associationView":[],"zwaveCompany":"Everspring","zwaveInfo":"4,2,64","zwaveVersion":"1.2","pollingTimeSec":0,"RFProtectionState":"0","RFProtectionSupport":"0","configured":"true","dead":"false","deviceControlType":"23","deviceIcon":"15","emailNotificationID":"0","emailNotificationType":"0","endPointId":"0","isLight":"true","liliOffCommand":"","liliOnCommand":"","localProtectionState":"0","localProtectionSupport":"0","log":"","logTemp":"","manufacturer":"","markAsDead":"true","model":"","nodeId":"5","parametersTemplate":"61","productInfo":"0,96,0,3,0,1,1,2","protectionExclusiveControl":"0","protectionExclusiveControlSupport":"false","protectionState":"0","protectionTimeout":"0","protectionTimeoutSupport":"false","pushNotificationID":"0","pushNotificationType":"0","remoteGatewayId":"0","saveLogs":"true","smsNotificationID":"0","smsNotificationType":"0","useTemplate":"false","userDescription":"","value":"1"},"actions":{"reconfigure":0,"setValue":1,"turnOff":0,"turnOn":0},"created":1422642147,"modified":1422642147,"sortOrder":19}

05/02/2015 14:35:20	332	action result: OK
05/02/2015 14:35:20	332	action repeat set to: 1
05/02/2015 14:35:20	332	Action:   - 
05/02/2015 14:35:20	332	[action] :

05/02/2015 14:35:20	334	action result: Error: Unknown base action: