INFO   2018-07-29 02:39:02,320 801E16000 ironscanner.main Initializing pyinsane2 ...
DEBUG  2018-07-29 02:39:02,320 805709000 ironscanner.trace /usr/local/lib/python3.6/site-packages/pyinsane2/sane/abstract.py:init()@44[TraceThread(<function init at 0x807b93488>)]
[sanei_debug] Setting debug level of dll to 255.
[dll] sane_init: SANE dll backend version 1.0.13 from sane-backends 1.0.25
[dll] sane_init/read_dlld: attempting to open directory `./dll.d'
[dll] sane_init/read_dlld: attempting to open directory `/usr/local/etc/sane.d/dll.d'
[dll] sane_init/read_dlld: using config directory `/usr/local/etc/sane.d/dll.d'
[dll] sane_init/read_dlld: done.
[dll] sane_init/read_config: reading dll.conf
[dll] add_backend: adding backend `pixma'
INFO   2018-07-29 02:39:02,321 801E16000 ironscanner.main Pyinsane2 ready
DEBUG  2018-07-29 02:39:02,326 801E16000 ironscanner.util For filename 'mainform.glade' got file '/usr/local/lib/python3.6/site-packages/ironscanner/mainform.glade'
/usr/local/lib/python3.6/site-packages/ironscanner/util.py:75: Warning: g_value_type_transformable: assertion 'G_TYPE_IS_VALUE (src_type)' failed
  widget_tree.add_from_file(ui_file)

(ironscanner:93116): Gtk-WARNING **: gtkliststore.c:834: Unable to convert from (null) to gchararray

(ironscanner:93116): Gtk-CRITICAL **: gtk_assistant_set_page_has_padding: assertion 'child != NULL' failed
WARNING 2018-07-29 02:39:02,554 801E16000 ironscanner.main version.txt file is missing
WARNING 2018-07-29 02:39:02,554 801E16000 ironscanner.main Please run 'make' first
DEBUG  2018-07-29 02:39:02,558 801E16000 ironscanner.util For filename 'logo.png' got file '/usr/local/lib/python3.6/site-packages/ironscanner/logo.png'
INFO   2018-07-29 02:39:04,609 81630EE00 ironscanner.main Looking for scanners ...
DEBUG  2018-07-29 02:39:04,610 815A45000 ironscanner.trace /usr/local/lib/python3.6/site-packages/pyinsane2/sane/abstract.py:get_devices()@472[TraceThread(<function get_devices at 0x807ff2488>)]
[dll] sane_get_devices
[dll] load: searching backend `pixma' in `/usr/local/lib/sane'
[dll] load: trying to load `/usr/local/lib/sane/libsane-pixma.so.1'
[dll] load: dlopen()ing `/usr/local/lib/sane/libsane-pixma.so.1'
[dll] init: initializing backend `pixma'
[dll] init: backend `pixma' is version 1.0.17
[dll] sane_get_devices: found 1 devices
INFO   2018-07-29 02:39:05,163 81630EE00 ironscanner.main 1 scanners found
INFO   2018-07-29 02:39:05,163 801E16000 ironscanner.main pixma:MX340_192.168.5.6 -> CANON Canon PIXMA MX340 (CANON Canon PIXMA MX340)
INFO   2018-07-29 02:39:05,166 801E16000 ironscanner.main Selected scanner: pixma:MX340_192.168.5.6
[dll] sane_open: trying to open `pixma:MX340_192.168.5.6'
[dll] sane_open: open successful
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=0)
[dll] sane_control_option(handle=0x8149aff10,option=0,action=0,value=0x810af0230,info=0x810af02b8)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=1)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=2)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=3)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=4)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=5)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=6)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=7)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=8)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=9)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=10)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=11)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=12)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=13)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=14)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=15)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=16)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=17)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=18)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=19)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=20)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=21)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=22)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=23)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=24)
INFO   2018-07-29 02:39:05,711 801E16000 ironscanner.main   Option: resolution
INFO   2018-07-29 02:39:05,712 801E16000 ironscanner.main     Title: Scan resolution
INFO   2018-07-29 02:39:05,712 801E16000 ironscanner.main     Desc: Sets the resolution of the scanned image.
INFO   2018-07-29 02:39:05,712 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Integer (1)
INFO   2018-07-29 02:39:05,712 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : Dpi (4)
INFO   2018-07-29 02:39:05,712 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,712 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect, Automatic,]
INFO   2018-07-29 02:39:05,712 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : Word list (2)
INFO   2018-07-29 02:39:05,712 801E16000 ironscanner.main     Constraint: [75, 150, 300, 600, 1200]
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=2)
[dll] sane_control_option(handle=0x8149aff10,option=2,action=0,value=0x810af02b8,info=0x810af03c8)
INFO   2018-07-29 02:39:05,713 801E16000 ironscanner.main     Value: 75
INFO   2018-07-29 02:39:05,713 801E16000 ironscanner.main   Option: mode
INFO   2018-07-29 02:39:05,713 801E16000 ironscanner.main     Title: Scan mode
INFO   2018-07-29 02:39:05,713 801E16000 ironscanner.main     Desc: Selects the scan mode (e.g., lineart, monochrome, or color).
INFO   2018-07-29 02:39:05,713 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : String (3)
INFO   2018-07-29 02:39:05,713 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,713 801E16000 ironscanner.main     Size: 31
INFO   2018-07-29 02:39:05,713 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect, Automatic,]
INFO   2018-07-29 02:39:05,713 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : String list (3)
INFO   2018-07-29 02:39:05,714 801E16000 ironscanner.main     Constraint: ['Color', 'Gray', 'Lineart']
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=3)
[dll] sane_control_option(handle=0x8149aff10,option=3,action=0,value=0x810aaeef0,info=0x810af0230)
INFO   2018-07-29 02:39:05,714 801E16000 ironscanner.main     Value: Color
INFO   2018-07-29 02:39:05,714 801E16000 ironscanner.main   Option: source
INFO   2018-07-29 02:39:05,714 801E16000 ironscanner.main     Title: Scan source
INFO   2018-07-29 02:39:05,714 801E16000 ironscanner.main     Desc: Selects the scan source (such as a document-feeder). Set source before mode and resolution. Resets mode and resolution to auto values.
INFO   2018-07-29 02:39:05,714 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : String (3)
INFO   2018-07-29 02:39:05,714 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,714 801E16000 ironscanner.main     Size: 31
INFO   2018-07-29 02:39:05,714 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect,]
INFO   2018-07-29 02:39:05,715 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : String list (3)
INFO   2018-07-29 02:39:05,715 801E16000 ironscanner.main     Constraint: ['Flatbed', 'Automatic Document Feeder']
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=4)
[dll] sane_control_option(handle=0x8149aff10,option=4,action=0,value=0x810aaeef0,info=0x810af03c8)
INFO   2018-07-29 02:39:05,715 801E16000 ironscanner.main     Value: Flatbed
INFO   2018-07-29 02:39:05,715 801E16000 ironscanner.main   Option: button-controlled
INFO   2018-07-29 02:39:05,715 801E16000 ironscanner.main     Title: Button-controlled scan
INFO   2018-07-29 02:39:05,715 801E16000 ironscanner.main     Desc: When enabled, scan process will not start immediately. To proceed, press "SCAN" button (for MP150) or "COLOR" button (for other models). To cancel, press "GRAY" button.
INFO   2018-07-29 02:39:05,715 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Boolean (0)
INFO   2018-07-29 02:39:05,715 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,715 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,715 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect,]
INFO   2018-07-29 02:39:05,716 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : None (0)
INFO   2018-07-29 02:39:05,716 801E16000 ironscanner.main     Constraint: None
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=5)
[dll] sane_control_option(handle=0x8149aff10,option=5,action=0,value=0x810af02b8,info=0x810af0230)
INFO   2018-07-29 02:39:05,716 801E16000 ironscanner.main     Value: 0
INFO   2018-07-29 02:39:05,716 801E16000 ironscanner.main   Option: custom-gamma
INFO   2018-07-29 02:39:05,716 801E16000 ironscanner.main     Title: Use custom gamma table
INFO   2018-07-29 02:39:05,716 801E16000 ironscanner.main     Desc: Determines whether a builtin or a custom gamma-table should be used.
INFO   2018-07-29 02:39:05,716 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Boolean (0)
INFO   2018-07-29 02:39:05,716 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,716 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,716 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect, Automatic,]
INFO   2018-07-29 02:39:05,717 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : None (0)
INFO   2018-07-29 02:39:05,717 801E16000 ironscanner.main     Constraint: None
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=7)
[dll] sane_control_option(handle=0x8149aff10,option=7,action=0,value=0x810af02b8,info=0x810af03c8)
INFO   2018-07-29 02:39:05,717 801E16000 ironscanner.main     Value: 1
INFO   2018-07-29 02:39:05,717 801E16000 ironscanner.main   Option: gamma-table
INFO   2018-07-29 02:39:05,717 801E16000 ironscanner.main     Title: Image intensity
INFO   2018-07-29 02:39:05,717 801E16000 ironscanner.main     Desc: Gamma-correction table.  In color mode this option equally affects the red, green, and blue channels simultaneously (i.e., it is an intensity gamma table).
INFO   2018-07-29 02:39:05,717 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Integer (1)
INFO   2018-07-29 02:39:05,717 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,717 801E16000 ironscanner.main     Size: 16384
INFO   2018-07-29 02:39:05,718 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect, Automatic,]
INFO   2018-07-29 02:39:05,718 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : Range (1)
INFO   2018-07-29 02:39:05,718 801E16000 ironscanner.main     Constraint: (0, 255, 0)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=8)
[dll] sane_control_option(handle=0x8149aff10,option=8,action=0,value=0x8163f9f80,info=0x810af0230)
INFO   2018-07-29 02:39:05,718 801E16000 ironscanner.main     Value: 0
INFO   2018-07-29 02:39:05,718 801E16000 ironscanner.main   Option: gamma
INFO   2018-07-29 02:39:05,718 801E16000 ironscanner.main     Title: Gamma function exponent
INFO   2018-07-29 02:39:05,718 801E16000 ironscanner.main     Desc: Changes intensity of midtones
INFO   2018-07-29 02:39:05,718 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Fixed (2)
INFO   2018-07-29 02:39:05,718 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,719 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,719 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect, Automatic,]
INFO   2018-07-29 02:39:05,719 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : Range (1)
INFO   2018-07-29 02:39:05,719 801E16000 ironscanner.main     Constraint: (19660, 327680, 0)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=9)
[dll] sane_control_option(handle=0x8149aff10,option=9,action=0,value=0x810af02b8,info=0x810af03c8)
INFO   2018-07-29 02:39:05,719 801E16000 ironscanner.main     Value: 144179
INFO   2018-07-29 02:39:05,719 801E16000 ironscanner.main   Option: tl-x
INFO   2018-07-29 02:39:05,719 801E16000 ironscanner.main     Title: Top-left x
INFO   2018-07-29 02:39:05,719 801E16000 ironscanner.main     Desc: Top-left x position of scan area.
INFO   2018-07-29 02:39:05,719 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Fixed (2)
INFO   2018-07-29 02:39:05,719 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : Mm (3)
INFO   2018-07-29 02:39:05,720 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,720 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect, Automatic,]
INFO   2018-07-29 02:39:05,720 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : Range (1)
INFO   2018-07-29 02:39:05,720 801E16000 ironscanner.main     Constraint: (0, 14160319, 0)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=11)
[dll] sane_control_option(handle=0x8149aff10,option=11,action=0,value=0x810af02b8,info=0x810af0230)
INFO   2018-07-29 02:39:05,720 801E16000 ironscanner.main     Value: 0
INFO   2018-07-29 02:39:05,720 801E16000 ironscanner.main   Option: tl-y
INFO   2018-07-29 02:39:05,720 801E16000 ironscanner.main     Title: Top-left y
INFO   2018-07-29 02:39:05,720 801E16000 ironscanner.main     Desc: Top-left y position of scan area.
INFO   2018-07-29 02:39:05,720 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Fixed (2)
INFO   2018-07-29 02:39:05,720 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : Mm (3)
INFO   2018-07-29 02:39:05,721 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,721 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect, Automatic,]
INFO   2018-07-29 02:39:05,721 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : Range (1)
INFO   2018-07-29 02:39:05,721 801E16000 ironscanner.main     Constraint: (0, 23304601, 0)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=12)
[dll] sane_control_option(handle=0x8149aff10,option=12,action=0,value=0x810af02b8,info=0x810af03c8)
INFO   2018-07-29 02:39:05,721 801E16000 ironscanner.main     Value: 0
INFO   2018-07-29 02:39:05,721 801E16000 ironscanner.main   Option: br-x
INFO   2018-07-29 02:39:05,721 801E16000 ironscanner.main     Title: Bottom-right x
INFO   2018-07-29 02:39:05,721 801E16000 ironscanner.main     Desc: Bottom-right x position of scan area.
INFO   2018-07-29 02:39:05,721 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Fixed (2)
INFO   2018-07-29 02:39:05,721 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : Mm (3)
INFO   2018-07-29 02:39:05,722 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,722 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect, Automatic,]
INFO   2018-07-29 02:39:05,722 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : Range (1)
INFO   2018-07-29 02:39:05,722 801E16000 ironscanner.main     Constraint: (0, 14160319, 0)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=13)
[dll] sane_control_option(handle=0x8149aff10,option=13,action=0,value=0x810af02b8,info=0x810af0230)
INFO   2018-07-29 02:39:05,722 801E16000 ironscanner.main     Value: 14160319
INFO   2018-07-29 02:39:05,722 801E16000 ironscanner.main   Option: br-y
INFO   2018-07-29 02:39:05,722 801E16000 ironscanner.main     Title: Bottom-right y
INFO   2018-07-29 02:39:05,722 801E16000 ironscanner.main     Desc: Bottom-right y position of scan area.
INFO   2018-07-29 02:39:05,722 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Fixed (2)
INFO   2018-07-29 02:39:05,723 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : Mm (3)
INFO   2018-07-29 02:39:05,723 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,723 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect, Automatic,]
INFO   2018-07-29 02:39:05,723 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : Range (1)
INFO   2018-07-29 02:39:05,723 801E16000 ironscanner.main     Constraint: (0, 23304601, 0)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=14)
[dll] sane_control_option(handle=0x8149aff10,option=14,action=0,value=0x810af02b8,info=0x810af03c8)
INFO   2018-07-29 02:39:05,723 801E16000 ironscanner.main     Value: 23304601
INFO   2018-07-29 02:39:05,723 801E16000 ironscanner.main   Option: button-1
INFO   2018-07-29 02:39:05,723 801E16000 ironscanner.main     Title: Button 1
INFO   2018-07-29 02:39:05,723 801E16000 ironscanner.main     Desc: Button 1
INFO   2018-07-29 02:39:05,724 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Integer (1)
INFO   2018-07-29 02:39:05,724 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,724 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,724 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_detect, Advanced,]
INFO   2018-07-29 02:39:05,724 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : None (0)
INFO   2018-07-29 02:39:05,724 801E16000 ironscanner.main     Constraint: None
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=17)
[dll] sane_control_option(handle=0x8149aff10,option=17,action=0,value=0x810af02b8,info=0x810af0230)
INFO   2018-07-29 02:39:05,732 801E16000 ironscanner.main     Value: 0
INFO   2018-07-29 02:39:05,732 801E16000 ironscanner.main   Option: button-2
INFO   2018-07-29 02:39:05,732 801E16000 ironscanner.main     Title: Button 2
INFO   2018-07-29 02:39:05,732 801E16000 ironscanner.main     Desc: Button 2
INFO   2018-07-29 02:39:05,732 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Integer (1)
INFO   2018-07-29 02:39:05,732 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,732 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,732 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_detect, Advanced,]
INFO   2018-07-29 02:39:05,732 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : None (0)
INFO   2018-07-29 02:39:05,732 801E16000 ironscanner.main     Constraint: None
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=18)
[dll] sane_control_option(handle=0x8149aff10,option=18,action=0,value=0x810af02b8,info=0x810af03c8)
INFO   2018-07-29 02:39:05,733 801E16000 ironscanner.main     Value: 0
INFO   2018-07-29 02:39:05,733 801E16000 ironscanner.main   Option: original
INFO   2018-07-29 02:39:05,733 801E16000 ironscanner.main     Title: Type of original to scan
INFO   2018-07-29 02:39:05,733 801E16000 ironscanner.main     Desc: Type of original to scan
INFO   2018-07-29 02:39:05,733 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Integer (1)
INFO   2018-07-29 02:39:05,733 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,733 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,733 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_detect, Advanced,]
INFO   2018-07-29 02:39:05,733 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : None (0)
INFO   2018-07-29 02:39:05,733 801E16000 ironscanner.main     Constraint: None
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=19)
[dll] sane_control_option(handle=0x8149aff10,option=19,action=0,value=0x810af02b8,info=0x810af0230)
INFO   2018-07-29 02:39:05,734 801E16000 ironscanner.main     Value: 0
INFO   2018-07-29 02:39:05,734 801E16000 ironscanner.main   Option: target
INFO   2018-07-29 02:39:05,734 801E16000 ironscanner.main     Title: Target operation type
INFO   2018-07-29 02:39:05,734 801E16000 ironscanner.main     Desc: Target operation type
INFO   2018-07-29 02:39:05,734 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Integer (1)
INFO   2018-07-29 02:39:05,734 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,734 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,734 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_detect, Advanced,]
INFO   2018-07-29 02:39:05,734 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : None (0)
INFO   2018-07-29 02:39:05,734 801E16000 ironscanner.main     Constraint: None
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=20)
[dll] sane_control_option(handle=0x8149aff10,option=20,action=0,value=0x810af02b8,info=0x810af03c8)
INFO   2018-07-29 02:39:05,735 801E16000 ironscanner.main     Value: 0
INFO   2018-07-29 02:39:05,735 801E16000 ironscanner.main   Option: scan-resolution
INFO   2018-07-29 02:39:05,735 801E16000 ironscanner.main     Title: Scan resolution
INFO   2018-07-29 02:39:05,735 801E16000 ironscanner.main     Desc: Scan resolution
INFO   2018-07-29 02:39:05,735 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Integer (1)
INFO   2018-07-29 02:39:05,735 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : None (0)
INFO   2018-07-29 02:39:05,735 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,735 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_detect, Advanced,]
INFO   2018-07-29 02:39:05,735 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : None (0)
INFO   2018-07-29 02:39:05,735 801E16000 ironscanner.main     Constraint: None
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=21)
[dll] sane_control_option(handle=0x8149aff10,option=21,action=0,value=0x810af02b8,info=0x810af0230)
INFO   2018-07-29 02:39:05,736 801E16000 ironscanner.main     Value: 0
INFO   2018-07-29 02:39:05,736 801E16000 ironscanner.main   Option: threshold
INFO   2018-07-29 02:39:05,736 801E16000 ironscanner.main     Title: Threshold
INFO   2018-07-29 02:39:05,736 801E16000 ironscanner.main     Desc: Select minimum-brightness to get a white point
INFO   2018-07-29 02:39:05,736 801E16000 ironscanner.main     Type: <class 'pyinsane2.sane.rawapi.SaneValueType'> : Integer (1)
INFO   2018-07-29 02:39:05,736 801E16000 ironscanner.main     Unit: <class 'pyinsane2.sane.rawapi.SaneUnit'> : Percent (5)
INFO   2018-07-29 02:39:05,736 801E16000 ironscanner.main     Size: 4
INFO   2018-07-29 02:39:05,736 801E16000 ironscanner.main     Capabilities: <class 'pyinsane2.sane.rawapi.SaneCapabilities'> :[ Soft_select, Soft_detect, Automatic, Inactive,]
INFO   2018-07-29 02:39:05,736 801E16000 ironscanner.main     Constraint type: <class 'pyinsane2.sane.rawapi.SaneConstraintType'> : Range (1)
INFO   2018-07-29 02:39:05,736 801E16000 ironscanner.main     Constraint: (0, 100, 1)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=23)
[dll] sane_control_option(handle=0x8149aff10,option=23,action=0,value=0x810af02b8,info=0x810af03c8)
ERROR  2018-07-29 02:39:05,737 801E16000 ironscanner.log === UNCATCHED EXCEPTION ===
Traceback (most recent call last):
  File "/usr/local/lib/python3.6/site-packages/ironscanner/main.py", line 352, in _on_scanner_selected
    value = str(opt.value)
  File "/usr/local/lib/python3.6/site-packages/pyinsane2/sane/abstract.py", line 92, in _get_value
    val = rawapi.sane_get_option_value(sane_dev_handle[1], self.idx)
  File "/usr/local/lib/python3.6/site-packages/pyinsane2/sane/rawapi.py", line 630, in sane_get_option_value
    raise SaneException(SaneStatus(status))
pyinsane2.sane.rawapi.SaneException: <class 'pyinsane2.sane.rawapi.SaneStatus'> : Data is invalid (4)

During handling of the above exception, another exception occurred:

Traceback (most recent call last):
  File "/usr/local/lib/python3.6/site-packages/ironscanner/main.py", line 353, in _on_scanner_selected
    except pyinsane2.PyinsaneException as exc:
AttributeError: module 'pyinsane2.sane.abstract' has no attribute 'PyinsaneException'
ERROR  2018-07-29 02:39:05,738 801E16000 ironscanner.log ===========================
INFO   2018-07-29 02:39:11,135 801E16000 ironscanner.main Preparing summary
ERROR  2018-07-29 02:39:11,135 801E16000 ironscanner.log === UNCATCHED EXCEPTION ===
Traceback (most recent call last):
  File "/usr/local/lib/python3.6/site-packages/ironscanner/main.py", line 700, in _on_assistant_page_prepare
    values.update(src.get_user_info())
  File "/usr/local/lib/python3.6/site-packages/ironscanner/main.py", line 518, in get_user_info
    self.widget_tree.get_object('comboboxResolutions').get_active()
  File "/usr/local/lib/python3.6/site-packages/gi/overrides/Gtk.py", line 801, in __getitem__
    aiter = self._getiter(key)
  File "/usr/local/lib/python3.6/site-packages/gi/overrides/Gtk.py", line 781, in _getiter
    raise IndexError("row index is out of bounds: %d" % key)
IndexError: row index is out of bounds: -1
ERROR  2018-07-29 02:39:11,142 801E16000 ironscanner.log ===========================
INFO   2018-07-29 02:39:13,482 814857200 ironscanner.main ### SCAN TEST ###
INFO   2018-07-29 02:39:13,482 814857200 ironscanner.main Maximizing scan area ...
DEBUG  2018-07-29 02:39:13,482 814856800 ironscanner.trace /usr/local/lib/python3.6/site-packages/pyinsane2/__init__.py:maximize_scan_area()@148[TraceThread(<function maximize_scan_area at 0x807ff4510>)]
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=11)
[dll] sane_control_option(handle=0x8149aff10,option=11,action=1,value=0x810beba28,info=0x810bebab0)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=12)
[dll] sane_control_option(handle=0x8149aff10,option=12,action=1,value=0x810beb918,info=0x810beb9a0)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=13)
[dll] sane_control_option(handle=0x8149aff10,option=13,action=1,value=0x810bebab0,info=0x810beba28)
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=14)
[dll] sane_control_option(handle=0x8149aff10,option=14,action=1,value=0x810beb9a0,info=0x810beb918)
INFO   2018-07-29 02:39:13,483 814857200 ironscanner.main Starting scan session ...
DEBUG  2018-07-29 02:39:13,483 81630EE00 ironscanner.trace /usr/local/lib/python3.6/site-packages/pyinsane2/sane/abstract.py:scan()@447[TraceThread(<bound method Scanner.scan of <pyinsane2.sane.abstract.Scanner object at 0x810ae4e80>>)]
[dll] sane_get_option_descriptor(handle=0x8149aff10,option=4)
[dll] sane_control_option(handle=0x8149aff10,option=4,action=0,value=0x810af8130,info=0x810bebab0)
[dll] sane_start(handle=0x8149aff10)
[dll] sane_get_parameters(handle=0x8149aff10,params=0x810a886f0)
INFO   2018-07-29 02:39:13,484 814857200 ironscanner.main Expected image size: (638, 877)
INFO   2018-07-29 02:39:13,484 814857200 ironscanner.main Scanning page 0
DEBUG  2018-07-29 02:39:13,484 814652000 ironscanner.trace /usr/local/lib/python3.6/site-packages/pyinsane2/sane/abstract.py:read()@281[TraceThread(<bound method SingleScan.read of <pyinsane2.sane.abstract.SingleScan object at 0x810af94a8>>)]
[dll] sane_read(handle=0x8149aff10,data=0x816a27000,maxlen=524288,lenp=0x810beb918)
ERROR  2018-07-29 02:39:13,511 814652000 ironscanner.trace Unexpected exception while calling <bound method SingleScan.read of <pyinsane2.sane.abstract.SingleScan object at 0x810af94a8>>
Traceback (most recent call last):
  File "/usr/local/lib/python3.6/site-packages/ironscanner/trace.py", line 35, in run
    self.ret = self.func(*self.args, **self.kwargs)
  File "/usr/local/lib/python3.6/site-packages/pyinsane2/sane/abstract.py", line 281, in read
    def read(self):
  File "/usr/local/lib/python3.6/site-packages/pyinsane2/sane/abstract.py", line 201, in read
    read = rawapi.sane_read(sane_dev_handle[1], SANE_READ_BUFSIZE)
  File "/usr/local/lib/python3.6/site-packages/pyinsane2/sane/rawapi.py", line 713, in sane_read
    raise SaneException(SaneStatus(status))
pyinsane2.sane.rawapi.SaneException: <class 'pyinsane2.sane.rawapi.SaneStatus'> : Error during device I/O (9)
INFO   2018-07-29 02:39:13,511 814857200 ironscanner.main ### SCAN TEST FAILED ###
Traceback (most recent call last):
  File "/usr/local/lib/python3.6/site-packages/ironscanner/main.py", line 762, in run
    trace.trace(scan_session.scan.read)
  File "/usr/local/lib/python3.6/site-packages/ironscanner/trace.py", line 77, in trace
    raise thread.exc
  File "/usr/local/lib/python3.6/site-packages/ironscanner/trace.py", line 35, in run
    self.ret = self.func(*self.args, **self.kwargs)
  File "/usr/local/lib/python3.6/site-packages/pyinsane2/sane/abstract.py", line 281, in read
    def read(self):
  File "/usr/local/lib/python3.6/site-packages/pyinsane2/sane/abstract.py", line 201, in read
    read = rawapi.sane_read(sane_dev_handle[1], SANE_READ_BUFSIZE)
  File "/usr/local/lib/python3.6/site-packages/pyinsane2/sane/rawapi.py", line 713, in sane_read
    raise SaneException(SaneStatus(status))
pyinsane2.sane.rawapi.SaneException: <class 'pyinsane2.sane.rawapi.SaneStatus'> : Error during device I/O (9)
INFO   2018-07-29 02:40:15,600 81630EE00 ironscanner.main Building report ...
INFO   2018-07-29 02:40:15,600 81630EE00 ironscanner.main * User info
INFO   2018-07-29 02:40:15,600 81630EE00 ironscanner.main * Scanner settings
INFO   2018-07-29 02:40:15,602 81630EE00 ironscanner.main No image attached to report
INFO   2018-07-29 02:40:15,602 81630EE00 ironscanner.main * System configuration
WARNING 2018-07-29 02:40:15,675 81630EE00 ironscanner.main Failed to get python module version: module 'pyinsane2.sane.abstract' has no attribute '__version__'
Traceback (most recent call last):
  File "/usr/local/lib/python3.6/site-packages/ironscanner/main.py", line 649, in complete_report
    'scan_library': "pyinsane2 " + pyinsane2.__version__,
AttributeError: module 'pyinsane2.sane.abstract' has no attribute '__version__'
INFO   2018-07-29 02:40:15,676 81630EE00 ironscanner.main * Scan test result
INFO   2018-07-29 02:40:15,676 81630EE00 ironscanner.main * User comment
INFO   2018-07-29 02:40:15,677 81630EE00 ironscanner.main * Traces