Skip site navigation (1)Skip section navigation (2)
Date:      Wed, 24 Jan 2001 23:27:01 +0000
From:      Tony Byrne <tony@nua.ie>
To:        David Malone <dwmalone@maths.tcd.ie>
Cc:        Andrew J Caines <A.J.Caines@altavista.net>, freebsd-stable@freebsd.org
Subject:   Re: syslogd throwing a hissy fit
Message-ID:  <5qou6tkiba9jk6nbjepe9hn2g45hq560ep@4ax.com>
In-Reply-To: <20010124223705.A92362@gosset.maths.tcd.ie>
References:  <20010121021039.A442@hal9000.bsdonline.org> <7q9u6t0tkj5ktplad6k8468koar3j8jvi9@4ax.com> <s7hu6torq3c79usoqpgig3b56gg9d5n6jr@4ax.com> <20010124223705.A92362@gosset.maths.tcd.ie>

next in thread | previous in thread | raw e-mail | index | archive | help
On Wed, 24 Jan 2001 22:37:05 +0000, you wrote:

>On Wed, Jan 24, 2001 at 09:43:59PM +0000, Tony Byrne wrote:
>
>> My investigations using "syslogd -v" show that the all of the looped =
and
>> corrupt log lines that I am seeing are of the LOG_CONSOLE facility =
with
>> the 'info' priority.  (console.info) (14.6)
>>=20
>> It's my guess that syslogd is entering a tight loop whenever =
syslog.conf
>> is configured so that a log message with facility LOG_CONSOLE is
>> directed to /dev/console.  The committer seems to have been aware of =
the
>> problem, but maybe an incorrectly configured syslog.conf would
>> circumvent the checks within the code?
>
>There should be code to prevent this looping, as you point out.
>Can you send me the output of syslogd -d while it's looping and
>I'll try to figure out what is going on.
>
>	David.

Here is the output that is going to the console and to my messages file:

Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus /kernel: Jan
24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
 /kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:4
9 cerberus /kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:48
cerberus /kernel: Jan 24 23:14:48 cerberus /kernel: Jan=20
24 23:14:48 cerberus /kernel: Jan 24 23:14:48 cerberus /kernel: Jan 24
23:14:48 cerberus /kernel: Jan 24 23:14:48 cerberus /ke
rnel: Jan 24 23:14:48 cerberus /kernel: Jan 24 23:14:48 cerberus
/kernel: Jan 24 23:14:48 cerberus /kernel: Jan 24 23:14:48 ce
rberus /kernel: Jan 24 23:14:48 cerberus /kernel: Jan 24 23:14:48
cerberus /kernel: Jan 24 23:14:48 cerberus /kernel: Jan 24 2
3:14:48 cerberus /kernel: Jan 24 23:14:48 cerberus /kernel: Jan 24
23:14:48 cerberus /kernel: Jan 24 23:14:48 cerberus /kernel : Jan 24
23:14:47 cerberus /kernel: Jan 24 23:14:47 cerberus /kernel: Jan 24
23:14:47 cerberus /kernel: Jan 24 23:14:47 cerber us /kernel: Jan 24
23:14:47 cerberus /ker

Note the lack of linefeeds and the corruption.

The following is the output of 'syslogd -d'.  The log messages are
interspersed with the debug output:

cerberus{tony}/var/log# syslogd -d
off & running....
init
cfline("*.*
/var/log/messages", f, "*", "*")
cfline("*.*
@gamekeeper.merrion.nua.net", f, "*", "*")
cfline("*.*
/var/log/syslog.debug", f, "*", "*")
cfline("*.info                                          /dev/console",
f, "*", "*")
cfline("security.*
/var/log/security", f, "*", "*")
cfline("mail.info
/var/log/maillog", f, "*", "*")
cfline("lpr.info
/var/log/lpd-errs", f, "*", "*")
cfline("cron.*                                          /var/log/cron",
f, "*", "*")
cfline("*.err                                           root", f, "*",
"*")
cfline("*.notice;news.err                               root", f, "*",
"*")
cfline("*.alert                                         root", f, "*",
"*")
cfline("*.emerg                                         *", f, "*", "*")
cfline("*.*
/var/log/slip.log", f, "startslip", "*")
cfline("*.*
/var/log/ppp.log", f, "ppp", "*")
8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 X FILE:
/var/log/messages
8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 X FORW:
gamekeeper.merrion.nua.net
8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 X FILE:
/var/log/syslog.debug
6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 6 X CONSOLE: /dev/console
X X X X X X X X X X X X X 8 X X X X X X X X X X X FILE:
/var/log/security
X X 6 X X X X X X X X X X X X X X X X X X X X X X FILE: /var/log/maillog
X X X X X X 6 X X X X X X X X X X X X X X X X X X FILE:
/var/log/lpd-errs
X X X X X X X X X 8 X X X X X X X X X X X X X X X FILE: /var/log/cron
3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 3 X USERS: root,=20
5 5 5 5 5 5 5 3 5 5 5 5 5 5 5 5 5 5 5 5 5 5 5 5 X USERS: root,=20
1 1 1 1 1 1 1 1 1 1 1 1 1 1 1 1 1 1 1 1 1 1 1 1 X USERS: root,=20
0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 X WALL:=20
8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 X FILE:
/var/log/slip.log (startslip)
8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 8 X FILE: /var/log/ppp.log
(ppp)
logmsg: pri 56, flags 4, from cerberus, msg syslogd: restart
Logging to FILE /var/log/messages
Logging to FORW gamekeeper.merrion.nua.net
Logging to FILE /var/log/syslog.debug
Logging to CONSOLE /dev/console
syslogd: restarted
logmsg: pri 2, flags 17, from cerberus, msg :17:23 cerberus /kernel: Jan
24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24
23:17:23 cerberus syslogd: restart
Logging to FILE /var/log/messages
Logging to FORW gamekeeper.merrion.nua.net
Logging to FILE /var/log/syslog.debug
Logging to USERS
Logging to USERS
logmsg: pri 166, flags 16, from cerberus, msg Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:48 cerberus /kernel: Jan 24 23:14:48 cerberus
/kernel: Jan 24 23:14:48 cerberus /kernel
Logging to FILE /var/log/messages
Logging to FORW gamekeeper.merrion.nua.net
Logging to FILE /var/log/syslog.debug
Logging to CONSOLE /dev/console
logmsg: pri 2, flags 17, from cerberus, msg : Jan 24 23:14:48 cerberus
/ker
Logging to FILE /var/log/messages
Logging to FORW gamekeeper.merrion.nua.net
Logging to FILE /var/log/syslog.debug
Logging to USERS
Logging to USERS
logmsg: pri 166, flags 16, from cerberus, msg Jan 24 23:17:23 cerberus
syslogd: exiting on signal 2
Logging to FILE /var/log/messages
Logging to FORW gamekeeper.merrion.nua.net
Logging to FILE /var/log/syslog.debug
Logging to CONSOLE /dev/console
logmsg: pri 166, flags 16, from cerberus, msg Jan 24 23:17:50 cerberus
syslogd: restart
Logging to FILE /var/log/messages
Logging to FORW gamekeeper.merrion.nua.net
Logging to FILE /var/log/syslog.debug
Logging to CONSOLE /dev/console
logmsg: pri 166, flags 16, from cerberus, msg Jan 24 23:17:50 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:17:23 cerberus /kernel: Jan 24 23:17:23 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:49 cerberus
/kernel: Jan 24 23:14:49 cerberus /kernel: Jan 24 23:14:48 cerberus
/kernel: Jan 24 23:14:48 cerberus /kernel
Logging to FILE /var/log/messages
Logging to FORW gamekeeper.merrion.nua.net
Logging to FILE /var/log/syslog.debug
Logging to CONSOLE /dev/console
logmsg: pri 2, flags 17, from cerberus, msg : Jan 24 23:14:48 cerberus
/ker
Logging to FILE /var/log/messages
Logging to FORW gamekeeper.merrion.nua.net
Logging to FILE /var/log/syslog.debug
msg repeated 1 times, 0 sec of 30
msg repeated 1 times, 0 sec of 30

Regards,

Tony.


To Unsubscribe: send mail to majordomo@FreeBSD.org
with "unsubscribe freebsd-stable" in the body of the message




Want to link to this message? Use this URL: <https://mail-archive.FreeBSD.org/cgi/mid.cgi?5qou6tkiba9jk6nbjepe9hn2g45hq560ep>