Paul J Stevens wrote:
Dan Stilts wrote:
Hey Guys;
Just wanted to let you know what else I just found after doing the
latest cvs checkout dbmail...
When I install it in place with the same configuration as before, the
message is now getting some extra weirdness, and no body text is
displayed
X-Invalid-Header: X-Invalid-Header: <message body line 1>
X-Invalid-Header: <message body line 2>
X-Invalid-Header: <message body line 3>
...and so on.
This did happen for a very brief period last week. I thought I could
convert incoming messages LF->CRLF before actually parsing them with
gmime. The output you show told me that gmime didn't really like CRLF
very much in parsing messages. So this was fixed immediately. Are you
sure you're using cvs as of today or even yesterday?
I've been running 2.1-cvs and it's been behaving nicely. There was a
small issue with NAMESPACE when I refactored _ic_list yesterday
(factor 3 speedup), but that's been resolved also.
Hi Paul,
I just now did another cvs checkout dbmail and the same problem
exists...attached is a TRACE=5 on SMTP. Any ideas?
Thanks,
Dan
Oct 13 01:17:48 ded3 postfix/smtpd[8466]: connect from
adsl-67-117-138-190.dsl.snfc21.pacbell.net[67.117.138.190]
Oct 13 01:17:48 ded3 postfix/smtpd[8466]: 87386289986:
client=adsl-67-117-138-190.dsl.snfc21.pacbell.net[67.117.138.190]
Oct 13 01:17:48 ded3 postfix/cleanup[8470]: 87386289986: message-id=<[EMAIL
PROTECTED]>
Oct 13 01:17:48 ded3 postfix/qmgr[8464]: 87386289986: from=<[EMAIL PROTECTED]>,
size=637, nrcpt=1 (queue active)
Oct 13 01:17:48 ded3 spamd[779]: connection from localhost [127.0.0.1] at port
45554
Oct 13 01:17:48 ded3 postfix/smtpd[8466]: disconnect from
adsl-67-117-138-190.dsl.snfc21.pacbell.net[67.117.138.190]
Oct 13 01:17:48 ded3 spamd[8473]: info: setuid to dbmail succeeded
Oct 13 01:17:48 ded3 spamd[8473]: Creating default_prefs
[/dev/null/.spamassassin/user_prefs]
Oct 13 01:17:48 ded3 spamd[8473]: Cannot write to
/dev/null/.spamassassin/user_prefs: Not a directory
Oct 13 01:17:48 ded3 spamd[8473]: Couldn't create readable default_prefs for
[/dev/null/.spamassassin/user_prefs]
Oct 13 01:17:48 ded3 spamd[8473]: processing message <[EMAIL PROTECTED]> for
dbmail:105.
Oct 13 01:17:48 ded3 dbmail/imap4d[8317]: PerformChildTask(): incoming
connection from [67.117.138.190 (adsl-67-117-138-190.dsl.snfc21.pacbell.net)]
Oct 13 01:17:48 ded3 dbmail/imap4d[8317]: IMAPD [PID 8317]: user (id 3, name
dstilts) login accepted @ 2004-10-13 01:17:48
Oct 13 01:17:49 ded3 spamd[8473]: clean message (0.0/5.0) for dbmail:105 in 0.5
seconds, 619 bytes.
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): searching value for
config item [host]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): found value
[localhost]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): searching value for
config item [db]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): found value [dbmail]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): searching value for
config item [user]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): found value [dbmail]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): searching value for
config item [pass]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): found value
[password_stripped]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): searching value for
config item [sqlport]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): item not found
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): searching value for
config item [sqlsocket]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): item not found
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): searching value for
config item [table_prefix]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): item not found
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_connect: MySQL host is set
to localhost, but no mysql_socket has been set. Use sqlsocket=... in
dbmail.conf. Connecting will be attempted using the default socket.
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: mime_readheader(): entering mime loop
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: mime_readheader(): mimeloop finished
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: *** mime_readheader() done ***
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT user_idnr FROM dbmail_users WHERE userid='[EMAIL PROTECTED]']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: authsql.c,auth_check_user_ext: checking
user [EMAIL PROTECTED] in alias table
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: authsql.c,auth_check_user_ext: checks
[-1]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT deliver_to FROM dbmail_aliases WHERE lower(alias) = lower('[EMAIL
PROTECTED]')]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: authsql.c,auth_check_user_ext: into
checking loop
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: authsql.c,auth_check_user_ext: checking
user [EMAIL PROTECTED] to !/usr/bin/procmail
/etc/procmail_users/dstilts.procmailrc
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: authsql.c,auth_check_user_ext: checking
user [!/usr/bin/procmail /etc/procmail_users/dstilts.procmailrc] in alias table
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: authsql.c,auth_check_user_ext: checks
[1]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT deliver_to FROM dbmail_aliases WHERE lower(alias) =
lower('!/usr/bin/procmail /etc/procmail_users/dstilts.procmailrc')]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: authsql.c,auth_check_user_ext: adding
[!/usr/bin/procmail /etc/procmail_users/dstilts.procmailrc] to deliver_to
address
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dsn.c, dsnuser_resolve: user [EMAIL
PROTECTED] found total of [1] aliases
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[BEGIN]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT user_idnr FROM dbmail_users WHERE userid='[EMAIL PROTECTED]@__']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: misc.c,create_unique_id: created:
701816680e98e05978e5c6bf568afa51
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT mailbox_idnr FROM dbmail_mailboxes WHERE name='INBOX' AND
owner_idnr='1']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: db.c, db_find_create_mailbox: mailbox
[INBOX] found
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[INSERT INTO dbmail_physmessage (messagesize, internal_date) VALUES ('0',
CURRENT_TIMESTAMP)]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[INSERT INTO dbmail_messages(mailbox_idnr, physmessage_id,
unique_id,recent_flag, status) VALUES ('5', '47117',
'701816680e98e05978e5c6bf568afa51', '1', '5')]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT physmessage_id FROM dbmail_messages WHERE message_idnr = '76345']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[INSERT INTO dbmail_messageblks(is_header, messageblk,blocksize,
physmessage_id)VALUES ('1','Received: from [192.168.1.62]
(adsl-67-117-138-190.dsl.snfc21.pacbell.net [67.117.138.190])^I^I\n^Iby
imap.allmopars.com (Postfix) with ESMTP id 87386289986^I^I\n^Ifor <[EMAIL
PROTECTED]>; Wed, 13 Oct 2004 01:17:48 -0700 (PDT)\nMessage-ID: <[EMAIL
PROTECTED]>\nDate: Wed, 13 Oct 2004 01:18:13 -0700\nFrom: Dan <[EMAIL
PROTECTED]>\nUser-Agent: Mozilla Thunderbird 0.8
(Windows/20040913)\nX-Accept-Language: en-us, en\nTo: [EMAIL PROTECTED]:
test\nX-Spam-Checker-Version: SpamAssassin 2.63 (2004-01-11) on
ded3.netdojo.com\nX-Spam-Level: \nX-Spam-Status: No, hits=0.0 required=5.0
tests=none autolearn=no\n^Iversion=2.63\nMIME-Version: 1.0\nContent-Type:
text/plain; charset=ISO-8859-1; format=flowed\nContent-Transfer-Encoding:
7bit\n', '743', '47117')]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: store_message_temp(): allocating
[524288] bytes of memory for readblock
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: pipe.c,store_message_in_blocks:
inserting message: line 1 line 2 line 3 Let's see if this works...
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT physmessage_id FROM dbmail_messages WHERE message_idnr = '76345']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[INSERT INTO dbmail_messageblks(is_header, messageblk,blocksize,
physmessage_id)VALUES ('0','\nline 1\nline 2\nline 3\nLet\'s see if this
works...\n', '49', '47117')]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[UPDATE dbmail_messages SET unique_id = '701816680e98e05978e5c6bf568afa51',
status = '0' WHERE message_idnr = '76345']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT physmessage_id FROM dbmail_messages WHERE message_idnr = '76345']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[UPDATE dbmail_physmessage SET messagesize = '792', rfcsize = '814' WHERE id =
'47117']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT dbmail_mailboxes.owner_idnr FROM dbmail_mailboxes, dbmail_messages
WHERE dbmail_mailboxes.mailbox_idnr = dbmail_messages.mailbox_idnr AND
dbmail_messages.message_idnr = '76345']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: db.c,db_add_quotum_used: adding 792 to
mailsize
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: db.c.user_idnr_is_delivery_user_idnr:
looking up user_idnr for [EMAIL PROTECTED]@__
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT user_idnr FROM dbmail_users WHERE userid='[EMAIL PROTECTED]@__']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: pipe.c, insert_messages: temporary
msgidnr is [76345]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: insert_messages(): we need to deliver
[1] messages to external addresses
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: insert_messages(): delivering to
external addresses
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): searching value for
config item [SENDMAIL]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: GetConfigValue(): found value
[/usr/sbin/sendmail]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: forward.c,forward: delivering to [1]
external addresses
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: forward.c,forward: opening pipe to
command /usr/bin/procmail /etc/procmail_users/dstilts.procmailrc
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: forward.c,forward: call to popen()
successfully opened pipe [6]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: forward.c,forward: appending mbox style
from header to pipe returnpath : [EMAIL PROTECTED]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: forward.c,forward: sending message id
number [76345] to forward pipe
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: forward.c,forward: ferror reports 0,
feof reports 0 on pipe 6
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: forward.c,forward: sending lines from
message 76345 on pipe 6
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: db.c,db_send_message_lines: request for
[-2] lines
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT physmessage_id FROM dbmail_messages WHERE message_idnr = '76345']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: db.c,db_send_message_lines: executing
query [SELECT messageblk FROM dbmail_messageblks WHERE physmessage_id='47117'
ORDER BY messageblk_idnr ASC]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT messageblk FROM dbmail_messageblks WHERE physmessage_id='47117' ORDER
BY messageblk_idnr ASC]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: db.c,db_send_message_lines: sending
[-2] lines from message [76345]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: db.c,db_send_message_lines: getting
nextblock [1]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: db.c,db_send_message_lines: getting
nextblock [2]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: forward.c,forward: closing pipes
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [host]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): found value
[localhost]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [db]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): found value [dbmail]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [user]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): found value [dbmail]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [pass]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): found value
[password_stripped]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [sqlport]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): item not found
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [sqlsocket]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): item not found
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [table_prefix]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): NULL item value in
item-list
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): item not found
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_connect: MySQL host is set
to localhost, but no mysql_socket has been set. Use sqlsocket=... in
dbmail.conf. Connecting will be attempted using the default socket.
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mime_readheader(): entering mime loop
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mime_readheader(): mimeloop finished
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: *** mime_readheader() done ***
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): mimelist currently has
[20] nodes
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): mail address parser
starting
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): total fields in header
20
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): scanning for
Return-Path
Oct 13 01:17:49 ded3 last message repeated 19 times
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): found 0 emailaddresses
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): mail address parser
finished
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): mimelist currently has
[20] nodes
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): mail address parser
starting
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): total fields in header
20
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): scanning for From
Oct 13 01:17:49 ded3 last message repeated 15 times
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): found [EMAIL
PROTECTED], next in list is <null>
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): scanning for From
Oct 13 01:17:49 ded3 last message repeated 3 times
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): found 1 emailaddresses
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: mail_adr_list(): mail address parser
finished
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: main(): setting mailbox for all
deliveries to [INBOX]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT user_idnr FROM dbmail_users WHERE userid='dstilts']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dsn.c, dsnuser_resolve: added user
[dstilts] id [3] to delivery list
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[BEGIN]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT user_idnr FROM dbmail_users WHERE userid='[EMAIL PROTECTED]@__']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: misc.c,create_unique_id: created:
701816680e98e05978e5c6bf568afa51
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT mailbox_idnr FROM dbmail_mailboxes WHERE name='INBOX' AND
owner_idnr='1']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: db.c, db_find_create_mailbox: mailbox
[INBOX] found
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[INSERT INTO dbmail_physmessage (messagesize, internal_date) VALUES ('0',
CURRENT_TIMESTAMP)]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[INSERT INTO dbmail_messages(mailbox_idnr, physmessage_id,
unique_id,recent_flag, status) VALUES ('5', '47118',
'701816680e98e05978e5c6bf568afa51', '1', '5')]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT physmessage_id FROM dbmail_messages WHERE message_idnr = '76346']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[INSERT INTO dbmail_messageblks(is_header, messageblk,blocksize,
physmessage_id)VALUES ('1','From [EMAIL PROTECTED] Wed Oct 13 01: 17:49
2004\nReceived: from [192.168.1.62] (adsl-67-117-138-190.dsl.snfc21.pacbell.net
[67.117.138.190])^I^I\r^I^I\n^Iby imap.allmopars.com (Postfix) with ESMTP id
87386289986^I^I\r^I^I\n^Ifor <[EMAIL PROTECTED]>; Wed, 13 Oct 2004 01:17:48
-0700 (PDT)\nMessage-ID: <[EMAIL PROTECTED]>\nDate: Wed, 13 Oct 2004 01:18:13
-0700\nFrom: Dan <[EMAIL PROTECTED]>\nUser-Agent: Mozilla Thunderbird 0.8
(Windows/20040913)\nX-Accept-Language: en-us, en\nTo: [EMAIL PROTECTED]:
test\nX-Spam-Checker-Version: SpamAssassin 2.63 (2004-01-11) on
ded3.netdojo.com\nX-Spam-Level: \nX-Spam-Status: No, hits=0.0 required=5.0
tests=none autolearn=no\r\n^Iversion=2.63\nX-Invalid-Header:
\nX-Invalid-Header: line 1\nX-Invalid-Header: line 2\nX-Invalid-Header: line
3\nX-Invalid-Header: Let\'s see if this
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: store_message_temp(): allocating
[524288] bytes of memory for readblock
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: pipe.c,store_message_in_blocks:
inserting message:
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT physmessage_id FROM dbmail_messages WHERE message_idnr = '76346']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[INSERT INTO dbmail_messageblks(is_header, messageblk,blocksize,
physmessage_id)VALUES ('0','\n', '1', '47118')]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[UPDATE dbmail_messages SET unique_id = '701816680e98e05978e5c6bf568afa51',
status = '0' WHERE message_idnr = '76346']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT physmessage_id FROM dbmail_messages WHERE message_idnr = '76346']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[UPDATE dbmail_physmessage SET messagesize = '944', rfcsize = '967' WHERE id =
'47118']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT dbmail_mailboxes.owner_idnr FROM dbmail_mailboxes, dbmail_messages
WHERE dbmail_mailboxes.mailbox_idnr = dbmail_messages.mailbox_idnr AND
dbmail_messages.message_idnr = '76346']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: db.c,db_add_quotum_used: adding 944 to
mailsize
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: db.c.user_idnr_is_delivery_user_idnr:
looking up user_idnr for [EMAIL PROTECTED]@__
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT user_idnr FROM dbmail_users WHERE userid='[EMAIL PROTECTED]@__']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: pipe.c, insert_messages: temporary
msgidnr is [76346]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: pipe.c, insert_messages: calling
sort_and_deliver for useridnr [3]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [SQLREGEX]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): item not found
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [LIBSIEVE]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): item not found
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT mailbox_idnr FROM dbmail_mailboxes WHERE name='INBOX' AND
owner_idnr='3']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: db.c, db_find_create_mailbox: mailbox
[INBOX] found
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT pm.messagesize FROM dbmail_physmessage pm, dbmail_messages msg WHERE
pm.id = msg.physmessage_id AND message_idnr = '76346']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT 1 FROM dbmail_users WHERE user_idnr = '3' AND (maxmail_size > 0) AND
(curmail_size + '944' > maxmail_size)]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: misc.c,create_unique_id: created:
f6186e830174307051888d8e35c7f144
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[INSERT INTO dbmail_messages (mailbox_idnr,physmessage_id, seen_flag,
answered_flag, deleted_flag, flagged_flag, recent_flag, draft_flag, unique_id,
status) SELECT '2', physmessage_id, seen_flag, answered_flag, deleted_flag,
flagged_flag, recent_flag, draft_flag, 'f6186e830174307051888d8e35c7f144',
status FROM dbmail_messages WHERE message_idnr = '76346']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: db.c,db_add_quotum_used: adding 944 to
mailsize
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: db.c.user_idnr_is_delivery_user_idnr:
no need to look up user_idnr for [EMAIL PROTECTED]@__
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[UPDATE dbmail_users SET curmail_size = curmail_size + '944' WHERE user_idnr =
'3']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: sort.c, sort_and_deliver: message
id=76347, size=944 is inserted
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: pipe.c, insert_messages: successful
sort_and_deliver for useridnr [3]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [AUTO_NOTIFY]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): found value [no]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): searching value for
config item [AUTO_REPLY]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: GetConfigValue(): found value [no]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: insert_messages(): we need to deliver
[0] messages to external addresses
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT physmessage_id FROM dbmail_messages WHERE message_idnr = '76346']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[DELETE FROM dbmail_messages WHERE message_idnr = '76346']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[SELECT message_idnr FROM dbmail_messages WHERE physmessage_id = '47118']
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: insert_messages(): temporary message
deleted from database
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: insert_messages(): End of function
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dbmysql.c,db_query: executing query
[COMMIT]
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: main(): freeing dsnuser list
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: dsn.c, dsnuser_free: dsnuser freed
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: main(): freeing all other lists
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: main(): freeing memory blocks
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: main(): they're all free. we're done.
Oct 13 01:17:49 ded3 dbmail/smtp[8477]: main(): exit code is [0].
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: forward.c,forward: pipe closed
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT physmessage_id FROM dbmail_messages WHERE message_idnr = '76345']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[DELETE FROM dbmail_messages WHERE message_idnr = '76345']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[SELECT message_idnr FROM dbmail_messages WHERE physmessage_id = '47117']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[DELETE FROM dbmail_physmessage WHERE id = '47117']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[DELETE FROM dbmail_messageblks WHERE physmessage_id = '47117']
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: insert_messages(): temporary message
deleted from database
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: insert_messages(): End of function
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dbmysql.c,db_query: executing query
[COMMIT]
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: main(): freeing dsnuser list
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: dsn.c, dsnuser_free: dsnuser freed
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: main(): freeing all other lists
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: main(): freeing memory blocks
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: main(): they're all free. we're done.
Oct 13 01:17:49 ded3 dbmail/smtp[8472]: main(): exit code is [0].
Oct 13 01:17:49 ded3 postfix/pipe[8471]: 87386289986: to=<[EMAIL PROTECTED]>,
relay=dbmail-smtp, delay=1, status=sent (allmopars.com)
Oct 13 01:17:49 ded3 postfix/qmgr[8464]: 87386289986: removed