[hylafax-users] Incoming faxes sometimes result in invalid TIFF documents

["Adam Randall" <randalla@xxxxxxxxx>]

Where I work we have a fax server using version 4.4.4 of HylaFAX, with
version 3.8.2 of libtiff. All this is running on a Gentoo system that
is updated weekly (aka, everything on there is up to date).

The system is only used for receiving faxes, converting the TIFF
documents to PDF and then sending them via email to a collection
server for post processing. This works great, with one hickup:
Randomly, an incoming FAX will be successfully received, but the TIFF
that was written out will not be valid. This of course makes for an
invalid PDF. tiff2ps reports not errors when it converts the file to
postscript format, so I don't know what's with that.

Here is a log from one of these bad TIFF faxes:

Dec 04 12:28:09.78: [ 5606]: SESSION BEGIN 000125174 XXXXXXX3599
Dec 04 12:28:09.78: [ 5606]: HylaFAX (tm) Version 4.4.4
Dec 04 12:28:09.78: [ 5606]: <-- [4:ATA\r]
Dec 04 12:28:15.78: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:15.78: [ 5606]: ANSWER: FAX CONNECTION  DEVICE '/dev/ttyS8'
Dec 04 12:28:15.78: [ 5606]: RECV FAX: begin
Dec 04 12:28:15.79: [ 5606]: <-- data [32]
Dec 04 12:28:15.79: [ 5606]: <-- data [2]
Dec 04 12:28:17.80: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:17.80: [ 5606]: <-- data [23]
Dec 04 12:28:17.80: [ 5606]: <-- data [2]
Dec 04 12:28:18.63: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:18.63: [ 5606]: <-- data [13]
Dec 04 12:28:18.63: [ 5606]: <-- data [2]
Dec 04 12:28:19.28: [ 5606]: --> [2:OK]
Dec 04 12:28:19.28: [ 5606]: <-- [9:AT+FRH=3\r]
Dec 04 12:28:20.29: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:21.74: [ 5606]: --> [2:OK]
Dec 04 12:28:21.74: [ 5606]: REMOTE TSI "XXXXXXXXXXXX"
Dec 04 12:28:21.74: [ 5606]: RECV recv TSI (sender id)
Dec 04 12:28:21.74: [ 5606]: <-- [9:AT+FRH=3\r]
Dec 04 12:28:21.77: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:22.17: [ 5606]: --> [2:OK]
Dec 04 12:28:22.17: [ 5606]: REMOTE wants 14400 bit/s
Dec 04 12:28:22.17: [ 5606]: REMOTE wants A4 page width (215 mm)
Dec 04 12:28:22.17: [ 5606]: REMOTE wants unlimited page length
Dec 04 12:28:22.17: [ 5606]: REMOTE wants 3.85 line/mm
Dec 04 12:28:22.17: [ 5606]: REMOTE wants JBIG
Dec 04 12:28:22.17: [ 5606]: REMOTE wants T.30 Annex A, 256-byte ECM
Dec 04 12:28:22.17: [ 5606]: RECV recv DCS (command signal)
Dec 04 12:28:22.17: [ 5606]: RECV training at v.17 14400 bit/s
Dec 04 12:28:22.17: [ 5606]: <-- [11:AT+FRM=145\r]
Dec 04 12:28:23.88: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:25.47: [ 5606]: RECV: TCF 2813 bytes, 0% non-zero, 2787 zero-run
Dec 04 12:28:25.47: [ 5606]: --> [10:NO CARRIER]
Dec 04 12:28:25.47: [ 5606]: <-- [9:AT+FRS=7\r]
Dec 04 12:28:25.60: [ 5606]: --> [2:OK]
Dec 04 12:28:25.60: [ 5606]: TRAINING succeeded
Dec 04 12:28:25.60: [ 5606]: <-- [9:AT+FTH=3\r]
Dec 04 12:28:25.66: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:25.66: [ 5606]: <-- data [3]
Dec 04 12:28:25.66: [ 5606]: <-- data [2]
Dec 04 12:28:26.97: [ 5606]: --> [2:OK]
Dec 04 12:28:26.97: [ 5606]: <-- [11:AT+FRM=146\r]
Dec 04 12:28:28.09: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:28.47: [ 5606]: RECV received frame number 0
Dec 04 12:28:28.62: [ 5606]: RECV received frame number 1
Dec 04 12:28:28.78: [ 5606]: RECV received frame number 2
Dec 04 12:28:28.94: [ 5606]: RECV received frame number 3
Dec 04 12:28:29.10: [ 5606]: RECV received frame number 4
Dec 04 12:28:29.25: [ 5606]: RECV received frame number 5
Dec 04 12:28:29.40: [ 5606]: RECV received frame number 6
Dec 04 12:28:29.56: [ 5606]: RECV received frame number 7
Dec 04 12:28:29.72: [ 5606]: RECV received frame number 8
Dec 04 12:28:29.88: [ 5606]: RECV received frame number 9
Dec 04 12:28:29.96: [ 5606]: RECV received frame number 10
Dec 04 12:28:30.12: [ 5606]: RECV received frame number 11
Dec 04 12:28:30.28: [ 5606]: RECV received frame number 12
Dec 04 12:28:30.42: [ 5606]: RECV received frame number 13
Dec 04 12:28:30.58: [ 5606]: RECV received frame number 14
Dec 04 12:28:30.74: [ 5606]: RECV received frame number 15
Dec 04 12:28:30.88: [ 5606]: RECV received frame number 16
Dec 04 12:28:31.04: [ 5606]: RECV received frame number 17
Dec 04 12:28:31.20: [ 5606]: RECV received frame number 18
Dec 04 12:28:31.35: [ 5606]: RECV received frame number 19
Dec 04 12:28:31.51: [ 5606]: RECV received frame number 20
Dec 04 12:28:31.66: [ 5606]: RECV received frame number 21
Dec 04 12:28:31.74: [ 5606]: RECV received frame number 22
Dec 04 12:28:31.90: [ 5606]: RECV received frame number 23
Dec 04 12:28:32.06: [ 5606]: RECV received frame number 24
Dec 04 12:28:32.22: [ 5606]: RECV received frame number 25
Dec 04 12:28:32.37: [ 5606]: RECV received frame number 26
Dec 04 12:28:32.51: [ 5606]: RECV received frame number 27
Dec 04 12:28:32.66: [ 5606]: RECV received frame number 28
Dec 04 12:28:32.80: [ 5606]: RECV received frame number 29
Dec 04 12:28:32.96: [ 5606]: RECV received frame number 30
Dec 04 12:28:33.10: [ 5606]: RECV received frame number 31
Dec 04 12:28:33.25: [ 5606]: RECV received frame number 32
Dec 04 12:28:33.41: [ 5606]: RECV received frame number 33
Dec 04 12:28:33.57: [ 5606]: RECV received frame number 34
Dec 04 12:28:33.73: [ 5606]: RECV received frame number 35
Dec 04 12:28:33.89: [ 5606]: RECV received frame number 36
Dec 04 12:28:34.03: [ 5606]: RECV received frame number 37
Dec 04 12:28:34.19: [ 5606]: RECV received frame number 38
Dec 04 12:28:34.27: [ 5606]: RECV received frame number 39
Dec 04 12:28:34.49: [ 5606]: RECV received frame number 40
Dec 04 12:28:34.57: [ 5606]: RECV received frame number 41
Dec 04 12:28:34.73: [ 5606]: RECV received frame number 42
Dec 04 12:28:34.88: [ 5606]: RECV received frame number 43
Dec 04 12:28:35.04: [ 5606]: RECV received frame number 44
Dec 04 12:28:35.20: [ 5606]: RECV received frame number 45
Dec 04 12:28:35.35: [ 5606]: RECV received frame number 46
Dec 04 12:28:35.51: [ 5606]: RECV received frame number 47
Dec 04 12:28:35.67: [ 5606]: RECV received frame number 48
Dec 04 12:28:35.75: [ 5606]: RECV received frame number 49
Dec 04 12:28:35.91: [ 5606]: RECV received frame number 50
Dec 04 12:28:36.06: [ 5606]: RECV received frame number 51
Dec 04 12:28:36.22: [ 5606]: RECV received frame number 52
Dec 04 12:28:36.38: [ 5606]: RECV received frame number 53
Dec 04 12:28:36.52: [ 5606]: RECV received frame number 54
Dec 04 12:28:36.67: [ 5606]: RECV received frame number 55
Dec 04 12:28:36.83: [ 5606]: RECV received frame number 56
Dec 04 12:28:36.99: [ 5606]: RECV received frame number 57
Dec 04 12:28:37.14: [ 5606]: RECV received frame number 58
Dec 04 12:28:37.29: [ 5606]: RECV received frame number 59
Dec 04 12:28:37.45: [ 5606]: RECV received frame number 60
Dec 04 12:28:37.53: [ 5606]: RECV received frame number 61
Dec 04 12:28:37.68: [ 5606]: RECV received frame number 62
Dec 04 12:28:37.84: [ 5606]: RECV received frame number 63
Dec 04 12:28:37.99: [ 5606]: RECV received frame number 64
Dec 04 12:28:38.15: [ 5606]: RECV received frame number 65
Dec 04 12:28:38.30: [ 5606]: RECV received frame number 66
Dec 04 12:28:38.46: [ 5606]: RECV received frame number 67
Dec 04 12:28:38.63: [ 5606]: RECV received frame number 68
Dec 04 12:28:38.63: [ 5606]: RECV received RCP frame
Dec 04 12:28:38.63: [ 5606]: --> [10:NO CARRIER]
Dec 04 12:28:38.63: [ 5606]: <-- [9:AT+FRH=3\r]
Dec 04 12:28:39.00: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:40.03: [ 5606]: --> [2:OK]
Dec 04 12:28:40.03: [ 5606]: RECV recv PPS (partial page signal)
Dec 04 12:28:40.03: [ 5606]: RECV recv MPS (more pages, same document)
Dec 04 12:28:40.03: [ 5606]: RECV received 69 frames of block 1 of page 1
Dec 04 12:28:40.03: [ 5606]: RECV: 17664 bytes of data, 1092 total lines
Dec 04 12:28:40.04: [ 5606]: <-- [9:AT+FRS=7\r]
Dec 04 12:28:40.16: [ 5606]: --> [2:OK]
Dec 04 12:28:40.16: [ 5606]: <-- [9:AT+FTH=3\r]
Dec 04 12:28:40.22: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:40.22: [ 5606]: RECV send MCF (message confirmation)
Dec 04 12:28:40.22: [ 5606]: RECV FAX (000125174): from XXXXXXXXXXXX,
page 1 in 0:25, INF, 3.85 line/mm, JBIG, 14400 bit/s
Dec 04 12:28:40.22: [ 5606]: <-- data [3]
Dec 04 12:28:40.22: [ 5606]: <-- data [2]
Dec 04 12:28:41.53: [ 5606]: --> [2:OK]
Dec 04 12:28:41.53: [ 5606]: <-- [11:AT+FRM=146\r]
Dec 04 12:28:42.64: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:43.07: [ 5606]: RECV received frame number 0
Dec 04 12:28:43.23: [ 5606]: RECV received frame number 1
Dec 04 12:28:43.38: [ 5606]: RECV received frame number 2
Dec 04 12:28:43.53: [ 5606]: RECV received frame number 3
Dec 04 12:28:43.68: [ 5606]: RECV received frame number 4
Dec 04 12:28:43.76: [ 5606]: RECV received frame number 5
Dec 04 12:28:43.91: [ 5606]: RECV received frame number 6
Dec 04 12:28:44.07: [ 5606]: RECV received frame number 7
Dec 04 12:28:44.22: [ 5606]: RECV received frame number 8
Dec 04 12:28:44.38: [ 5606]: RECV received frame number 9
Dec 04 12:28:44.52: [ 5606]: RECV received frame number 10
Dec 04 12:28:44.67: [ 5606]: RECV received frame number 11
Dec 04 12:28:44.82: [ 5606]: RECV received frame number 12
Dec 04 12:28:44.97: [ 5606]: RECV received frame number 13
Dec 04 12:28:45.12: [ 5606]: RECV received frame number 14
Dec 04 12:28:45.27: [ 5606]: RECV received frame number 15
Dec 04 12:28:45.43: [ 5606]: RECV received frame number 16
Dec 04 12:28:45.59: [ 5606]: RECV received frame number 17
Dec 04 12:28:45.73: [ 5606]: RECV received frame number 18
Dec 04 12:28:45.89: [ 5606]: RECV received frame number 19
Dec 04 12:28:46.05: [ 5606]: RECV received frame number 20
Dec 04 12:28:46.20: [ 5606]: RECV received frame number 21
Dec 04 12:28:46.36: [ 5606]: RECV received frame number 22
Dec 04 12:28:46.44: [ 5606]: RECV received frame number 23
Dec 04 12:28:46.60: [ 5606]: RECV received frame number 24
Dec 04 12:28:46.75: [ 5606]: RECV received frame number 25
Dec 04 12:28:46.91: [ 5606]: RECV received frame number 26
Dec 04 12:28:47.07: [ 5606]: RECV received frame number 27
Dec 04 12:28:47.23: [ 5606]: RECV received frame number 28
Dec 04 12:28:47.38: [ 5606]: RECV received frame number 29
Dec 04 12:28:47.52: [ 5606]: RECV received frame number 30
Dec 04 12:28:47.68: [ 5606]: RECV received frame number 31
Dec 04 12:28:47.84: [ 5606]: RECV received frame number 32
Dec 04 12:28:47.92: [ 5606]: RECV received frame number 33
Dec 04 12:28:48.07: [ 5606]: RECV received frame number 34
Dec 04 12:28:48.28: [ 5606]: RECV received frame number 35
Dec 04 12:28:48.43: [ 5606]: RECV received frame number 36
Dec 04 12:28:48.59: [ 5606]: RECV received frame number 37
Dec 04 12:28:48.67: [ 5606]: RECV received frame number 38
Dec 04 12:28:48.89: [ 5606]: RECV received frame number 39
Dec 04 12:28:48.97: [ 5606]: RECV received frame number 40
Dec 04 12:28:49.13: [ 5606]: RECV received frame number 41
Dec 04 12:28:49.29: [ 5606]: RECV received frame number 42
Dec 04 12:28:49.44: [ 5606]: RECV received frame number 43
Dec 04 12:28:49.59: [ 5606]: RECV received frame number 44
Dec 04 12:28:49.74: [ 5606]: RECV received frame number 45
Dec 04 12:28:49.89: [ 5606]: RECV received frame number 46
Dec 04 12:28:50.04: [ 5606]: RECV received frame number 47
Dec 04 12:28:50.20: [ 5606]: RECV received frame number 48
Dec 04 12:28:50.36: [ 5606]: RECV received frame number 49
Dec 04 12:28:50.51: [ 5606]: RECV received frame number 50
Dec 04 12:28:50.66: [ 5606]: RECV received frame number 51
Dec 04 12:28:50.81: [ 5606]: RECV received frame number 52
Dec 04 12:28:50.95: [ 5606]: RECV received frame number 53
Dec 04 12:28:51.10: [ 5606]: RECV received frame number 54
Dec 04 12:28:51.25: [ 5606]: RECV received frame number 55
Dec 04 12:28:51.40: [ 5606]: RECV received frame number 56
Dec 04 12:28:51.54: [ 5606]: RECV received frame number 57
Dec 04 12:28:51.70: [ 5606]: RECV received frame number 58
Dec 04 12:28:51.85: [ 5606]: RECV received frame number 59
Dec 04 12:28:52.00: [ 5606]: RECV received frame number 60
Dec 04 12:28:52.16: [ 5606]: RECV received frame number 61
Dec 04 12:28:52.31: [ 5606]: RECV received frame number 62
Dec 04 12:28:52.38: [ 5606]: RECV received frame number 63
Dec 04 12:28:52.54: [ 5606]: RECV received frame number 64
Dec 04 12:28:52.69: [ 5606]: RECV received frame number 65
Dec 04 12:28:52.85: [ 5606]: RECV received frame number 66
Dec 04 12:28:53.00: [ 5606]: RECV received frame number 67
Dec 04 12:28:53.19: [ 5606]: RECV received frame number 68
Dec 04 12:28:53.19: [ 5606]: RECV received RCP frame
Dec 04 12:28:53.19: [ 5606]: --> [10:NO CARRIER]
Dec 04 12:28:53.19: [ 5606]: <-- [9:AT+FRH=3\r]
Dec 04 12:28:53.55: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:54.49: [ 5606]: --> [2:OK]
Dec 04 12:28:54.49: [ 5606]: RECV recv PPS (partial page signal)
Dec 04 12:28:54.49: [ 5606]: RECV recv EOP (no more pages or documents)
Dec 04 12:28:54.49: [ 5606]: RECV received 69 frames of block 1 of page 2
Dec 04 12:28:54.49: [ 5606]: RECV: 17664 bytes of data, 1092 total lines
Dec 04 12:28:54.49: [ 5606]: <-- [9:AT+FRS=7\r]
Dec 04 12:28:54.62: [ 5606]: --> [2:OK]
Dec 04 12:28:54.62: [ 5606]: <-- [9:AT+FTH=3\r]
Dec 04 12:28:54.68: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:54.68: [ 5606]: <-- data [3]
Dec 04 12:28:54.68: [ 5606]: <-- data [2]
Dec 04 12:28:55.99: [ 5606]: --> [2:OK]
Dec 04 12:28:55.99: [ 5606]: RECV send MCF (message confirmation)
Dec 04 12:28:55.99: [ 5606]: RECV FAX (000125174): from XXXXXXXXXXXX,
page 2 in 0:14, INF, 3.85 line/mm, JBIG, 14400 bit/s
Dec 04 12:28:55.99: [ 5606]: RECV FAX (000125174):
recvq/fax000125802.tif from XXXXXXXXXXXX, route to <unspecified>, 2
pages in 0:40
Dec 04 12:28:55.99: [ 5606]: <-- [9:AT+FRH=3\r]
Dec 04 12:28:56.59: [ 5606]: --> [7:CONNECT]
Dec 04 12:28:57.50: [ 5606]: --> [2:OK]
Dec 04 12:28:57.50: [ 5606]: RECV recv DCN (disconnect)
Dec 04 12:28:57.50: [ 5606]: RECV FAX: bin/faxrcvd
"recvq/fax000125802.tif" "ttyS8" "000125174" ""
Dec 04 12:28:57.51: [ 5606]: RECV FAX: end
Dec 04 12:28:57.51: [ 5606]: SESSION END

While I would love to send the TIFF along, or put it somewhere, I
can't since the document contains very private information about a
client.

If anyone has any information that might help me track this down,
please let me know. I searched the archives for something like this,
but was not able to find anything.

--
Adam Randall


____________________ HylaFAX(tm) Users Mailing List _______________________
  To subscribe/unsubscribe, click http://lists.hylafax.org/cgi-bin/lsg2.cgi
 On UNIX: mail -s unsubscribe hylafax-users-request@xxxxxxxxxxx < /dev/null
  *To learn about commercial HylaFAX(tm) support, mail sales@xxxxxxxxx*