Daily Usenet report for news.ripco.com

Sep 24 00:01:02 -- Sep 24 23:57:45

Unknown entries from news log file:

First 50 / 66 lines (75.8%)

Sep 24 00:14:37 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 05:54:26 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 06:19:44 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 06:47:38 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 06:54:06 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 06:58:22 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 07:02:55 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 07:05:03 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 07:29:08 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 07:32:48 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 07:56:36 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 08:08:38 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 08:12:58 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 08:21:07 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 08:25:28 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 08:30:35 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 08:34:44 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 08:37:44 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 08:48:28 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 08:56:56 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:07:56 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:10:33 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:23:03 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:24:40 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:27:35 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:32:31 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:37:42 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:41:09 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:43:04 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:49:50 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 09:56:22 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 10:01:49 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 10:03:57 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 10:05:48 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 10:07:49 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 10:08:47 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 10:11:12 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 10:16:30 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 10:24:41 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 10:26:50 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 10:33:03 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 12:27:43 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 12:50:25 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 12:56:51 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 13:47:30 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 14:10:39 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 14:23:28 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 14:27:35 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 14:27:35 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping
Sep 24 14:27:35 remote5bge0 overchan[10809]: [ID 702911 news.error] input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
inn 19036 32.6%3.8 MB 40.9%
innd 18485 31.6%2.9 MB 31.4%
nnrpd 17226 29.5%1.8 MB 19.4%
innfeed 3658 6.3%774.5 KB 8.2%
overchan 66 0.1%9.0 KB 0.1%
controlchan 2 0.0%0.2 KB 0.0%
TOTAL: 6 58473 100.0%9.2 MB100.0%

History cache:

ReasonCount%Count
Do not exist 185226 57.1%
Cache misses 139346 42.9%
Negative hits 0 0.0%
Positive hits 0 0.0%
TOTAL: 4 324572 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.000 0.0%40 0.000 0.000 0.000
article cleanup00:00:00.486 0.0%37768 0.000 0.013 0.050
article logging00:00:00.824 0.0%38150 0.000 0.022 0.157
article parse00:00:01.364 0.0%96644 0.000 0.014 0.029
article write00:01:26.150 0.0%29454 1.481 2.925 57.600
artlog/artparse00:00:00.000 0.0%4 0.000 0.000 0.000
data move00:00:00.430 0.0%333326 0.000 0.001 0.007
hishave/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:02.722 0.0%325616 0.003 0.008 0.017
history sync00:00:00.222 0.0%800 0.000 0.278 2.000
history write00:00:04.642 0.0%37772 0.000 0.123 2.142
hiswrite/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
idle47:56:52.408 99.8%374854 279.638 460.479 1316.496
nntp read00:00:03.002 0.0%373854 0.000 0.008 0.019
overview write00:00:00.284 0.0%29454 0.000 0.010 0.065
perl filter00:00:56.866 0.0%37768 1.183 1.506 2.806
python filter00:00:01.456 0.0%37772 0.000 0.039 0.143
site send00:00:02.160 0.0%88302 0.000 0.024 0.046
TOTAL: 48:02:05.21647:59:33.016 99.9%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.154 0.0%29678 0.000 0.005 0.053
article prepare00:00:00.008 0.0%7224 0.000 0.001 0.028
article read00:00:00.366 0.0%1450 0.000 0.252 24.000
backlog stats00:00:00.272 0.0%392356 0.000 0.001 0.003
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:02.662 0.0%246748 0.002 0.011 0.029
data write00:00:04.310 0.0%217776 0.009 0.020 0.249
idle47:34:02.296100.0%392356 232.814 436.446 1234.836
status file00:00:04.194 0.0%360 1.000 11.650 105.600
TOTAL: 47:34:37.02847:34:14.262100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle02:47:49.164 96.0%18188 8.333 553.616 20004.063
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:05.994 0.1%502262 0.000 0.012 1.000
readart00:00:21.612 0.2%2460 1.750 8.785 36.000
TOTAL: 02:54:44.24202:48:16.770 96.3%----

Control commands to INND:

CommandNumber
L 2
flush 2
go 4
logmode 2
mode 9
name 2
pause 2
paused 2
reserve 4
TOTAL: 9 29

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1ripco-out.feed.uzoreto.com 1148 37300 16900 15406 4994 45%94:49:14
2newsfeed.neva.ru 620 17310 6216 9814 1280 35%276:19:30
3feeder3.feed-ams.uzoreto.com 574 10324 4066 5364 894 39%47:19:02
4ripco-out.news.tnetconsulting.net 2 29382 802 28470 110 2%40:48:14
5newsfeed.fu-berlin.de 2 14926 642 14254 30 4%50:00:28
6news-in.rahul.net 574 16642 206 16412 24 1%47:19:32
7news.lightlink.com 2 10322 170 9824 328 1%52:29:26
8ripco-out.feeder.erje.net 574 30508 76 29774 658 0%47:17:38
9news.cmpublishers.com 52 8266 28 8206 32 0%47:59:50
10localhost 150 4 4 0 0 100%00:00:00
TOTAL: 10 3698 174984 29110 137524 8350 16%704:22:54
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1ripco-out.feed.uzoreto.com45.0 MB0.0 KB10.5 MB55.4 MB 81%2.6 KB
2newsfeed.neva.ru20.3 MB0.0 KB3.5 MB23.8 MB 85%3.2 KB
3feeder3.feed-ams.uzoreto.com12.0 MB0.0 KB2.1 MB14.0 MB 85%2.9 KB
4ripco-out.news.tnetconsulting.net11.7 MB0.0 KB780.2 KB12.4 MB 93%14.0 KB
5newsfeed.fu-berlin.de3.6 MB0.0 KB1.6 MB5.2 MB 69%7.9 KB
6news.lightlink.com2.4 MB0.0 KB11.9 MB14.3 MB 16%29.3 KB
7news-in.rahul.net2.3 MB0.0 KB318.6 KB2.6 MB 87%11.5 KB
8ripco-out.feeder.erje.net378.3 KB0.0 KB4.2 MB4.6 MB 8%6.4 KB
9news.cmpublishers.com123.4 KB0.0 KB90.0 KB213.4 KB 57%3.6 KB
10localhost12.4 KB0.0 KB0.0 KB12.4 KB100%3.1 KB
TOTAL: 1097.7 MB0.0 KB34.9 MB132.5 MB 73%3.6 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Sep 24 00:01:02 - 00:59:59 288 2.0% 0.08982.5 KB 2.0% 0.28
Sep 24 01:00:00 - 01:59:59 381 2.6% 0.111.0 MB 2.1% 0.30
Sep 24 02:00:00 - 02:59:59 564 3.8% 0.162.6 MB 5.4% 0.75
Sep 24 03:00:00 - 03:59:59 632 4.3% 0.181.9 MB 3.8% 0.53
Sep 24 04:00:00 - 04:59:59 764 5.2% 0.212.1 MB 4.2% 0.59
Sep 24 05:00:00 - 05:59:59 646 4.4% 0.181.9 MB 3.9% 0.55
Sep 24 06:00:00 - 06:59:59 662 4.5% 0.182.1 MB 4.3% 0.59
Sep 24 07:00:00 - 07:59:59 736 5.0% 0.202.4 MB 4.9% 0.68
Sep 24 08:00:00 - 08:59:59 778 5.3% 0.222.2 MB 4.4% 0.62
Sep 24 09:00:00 - 09:59:59 840 5.7% 0.233.7 MB 7.5% 1.05
Sep 24 10:00:00 - 10:59:59 925 6.3% 0.262.7 MB 5.6% 0.78
Sep 24 11:00:00 - 11:59:59 839 5.7% 0.232.9 MB 6.0% 0.83
Sep 24 12:00:00 - 12:59:59 830 5.6% 0.232.2 MB 4.5% 0.63
Sep 24 13:00:00 - 13:59:59 775 5.3% 0.222.3 MB 4.7% 0.66
Sep 24 14:00:00 - 14:59:59 788 5.4% 0.222.3 MB 4.7% 0.66
Sep 24 15:00:00 - 15:59:59 736 5.0% 0.202.1 MB 4.2% 0.59
Sep 24 16:00:00 - 16:59:59 731 5.0% 0.202.2 MB 4.5% 0.63
Sep 24 17:00:00 - 17:59:59 602 4.1% 0.172.1 MB 4.3% 0.61
Sep 24 18:00:00 - 18:59:59 429 2.9% 0.122.0 MB 4.2% 0.58
Sep 24 19:00:00 - 19:59:59 370 2.5% 0.101.2 MB 2.5% 0.35
Sep 24 20:00:00 - 20:59:59 349 2.4% 0.101.8 MB 3.6% 0.50
Sep 24 21:00:00 - 21:59:59 338 2.3% 0.091.3 MB 2.6% 0.36
Sep 24 22:00:00 - 22:59:59 282 1.9% 0.081.1 MB 2.3% 0.32
Sep 24 23:00:00 - 23:57:45 413 2.8% 0.121.9 MB 3.8% 0.55
TOTAL: 23:56:43 14698 100.0% 0.1749.1 MB 100.0% 0.58
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1ripco-out.feed.uzoreto.com 2514 1658 0 0 4 0 0 0 852
2newsfeed.neva.ru 677 346 0 0 7 0 0 0 324
3feeder3.feed-ams.uzoreto.com 450 183 0 0 0 0 0 0 267
4ripco-out.feeder.erje.net 328 325 0 0 0 0 0 0 3
5newsfeed.fu-berlin.de 147 0 0 0 0 0 0 0 147
6news.lightlink.com 133 1 0 0 0 0 0 0 132
7ripco-out.news.tnetconsulting.net 60 17 0 0 0 0 0 0 43
8news.cmpublishers.com 17 2 0 0 0 0 0 0 15
9news-in.rahul.net 12 0 0 0 0 0 0 0 12
TOTAL: 9 4338 2532 0 0 11 0 0 0 1795

Unwanted newsgroups [Top 20]:

NewsgroupCount
free.usenet 1847
alt.binaries.ftd 131
fido7.su.pol.news 40
scinet.stats 29
alt.bestjobsusa.computer.jobs 24
alt.binaries.e-book 23
scot.general 23
free.software 22
it.tlc.cellulari.android 21
free.it.scienza.fisica 16
alt.binaries.test.yenc 13
it.comp.os.win.windows10 13
alt.binaries.humor.skewed 11
alt.jobs.jobsearch 10
alt.binaries.nospam.breasts.natural 10
de.soc.arbeitslos 10
alt.binaries.pictures.erotica.transexual.action 9
alt.binaries.pictures.earlmiller 9
abg.test04 9
alt.binaries.mac.osx.apps 8
TOTAL: 132 2532

Supposedly-moderated groups with unmoderated postings [Top 20]:

GroupsCount
pl.praca.oferowana 10
bit.listserv.catholic 1
TOTAL: 2 11

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 1468
Too many newsgroups 1190
EMP (phl) 330
Binary in non-binary group 120
Scoring filter (8) 32
HTML post 20
Scoring filter (9) 18
Scoring filter (10) 18
Scoring filter (15) 4
Scoring filter (12) 2
Scoring filter (11) 2
TOTAL: 11 3204

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Bad Message-ID's offered
ripco-out.feeder.erje.net 28
ripco-out.feed.uzoreto.com 10
feeder3.feed-ams.uzoreto.com 4
TOTAL: 3 42
Including strange strings
newsfeed.fu-berlin.de 133
newsfeed.neva.ru 37
ripco-out.feed.uzoreto.com 18
feeder3.feed-ams.uzoreto.com 3
TOTAL: 4 191
No colon-space in header
feeder3.feed-ams.uzoreto.com 1
ripco-out.feed.uzoreto.com 1
TOTAL: 2 2
TOTAL: 3 235

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1rahul.net 24622 620 13722 14 0 0 2%47:40:02
2news.lightlink.com 11960 328 7360 40 0 0 2%47:44:24
3feeder.erje.net 31482 174 27576 34 0 0 0%47:40:02
4news.cmpublishers.com 42394 54 28526 352 0 428 0%47:40:04
5news.uzoreto.com 8238 26 7862 72 0 0 0%47:34:00
6newsfeed.neva.ru 23990 24 23030 6 0 0 0%47:40:06
7fu-berlin.de 26680 24 26656 0 0 0 0%47:40:08
8news.tnetconsulting.net 48858 22 28172 4 0 38 0%47:37:34
9remote6hme0.ripco.com 12 6 0 6 0 0 50%01:32:14
10news.snarked.org 0 0 0 0 0 29068 0%47:40:02
TOTAL: 10 218236 1278 162904 528 0 29534 0%430:28:36
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1rahul.net6.9 MB358.8 KB7.2 MB0.0 KB/s11.7 KB47:40:02
2news.lightlink.com1.2 MB240.2 KB1.4 MB0.0 KB/s4.0 KB47:44:24
3feeder.erje.net456.5 KB131.1 KB587.7 KB0.0 KB/s2.8 KB47:40:02
4news.cmpublishers.com152.3 KB915.3 KB1.0 MB0.0 KB/s2.6 KB47:40:04
5news.uzoreto.com123.1 KB135.0 KB258.1 KB0.0 KB/s2.6 KB47:34:00
6news.tnetconsulting.net103.1 KB11.7 KB114.8 KB0.0 KB/s4.4 KB47:37:34
7newsfeed.neva.ru102.4 KB10.9 KB113.4 KB0.0 KB/s3.8 KB47:40:06
8fu-berlin.de99.4 KB0.0 KB99.4 KB0.0 KB/s4.1 KB47:40:08
9remote6hme0.ripco.com10.9 KB20.9 KB31.9 KB0.0 KB/s2.7 KB01:32:14
10news.snarked.org0.0 KB0.0 KB0.0 KB0.0 KB/s047:40:02
TOTAL: 109.1 MB1.8 MB10.9 MB0.0 KB/s6.2 KB430:28:36
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1ftupet.com 286 9742.5 MB 414 2 000:11:52
2shell3.ripco.com 14 5101.3 MB 40 2 002:42:40
TOTAL: 2 300 14843.8 MB 454 4 002:54:34

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.com 286 9742.5 MB 414 2 000:11:52
2*.ripco.com 14 5101.3 MB 40 2 002:42:40
TOTAL: 2 300 14843.8 MB 454 4 002:54:33

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
shell3.ripco.com 3.514 2.338 0.00002:42:40
ftupet.com 46.756 21.050 0.00000:11:52
scan-141.security.ipip.net 0.206 0.056 0.00000:00:00
c-73-45-53-23.hsd1.il.comcast.net 0.200 0.050 0.00000:00:00
worker-18.sfj.censys-scanner.com 0.200 0.048 0.00000:00:00
TOTAL: 5 50.876 23.542 0.00002:54:34

NNRP no permission clients:

SystemConn
worker-18.sfj.censys-scanner.com 2
c-73-45-53-23.hsd1.il.comcast.net 2
scan-141.security.ipip.net 2
TOTAL: 3 6

NNRP unrecognized commands (by host):

SystemConn
shell3.ripco.com 4
TOTAL: 1 4

NNRP unrecognized commands (by command):

CommandCount
XTHREAD DBINIT 4
TOTAL: 1 4

NNRP client timeouts [Top 20]:

SystemConnPeer
shell3.ripco.com 2 0
TOTAL: 1 2 0

Newsgroup request counts (by category):

CategoryCountPct
1rec 1280 86.3%
2alt 78 5.3%
3misc 48 3.2%
4comp 36 2.4%
5sci 28 1.9%
6chi 12 0.8%
7news 2 0.1%
TOTAL: 7 1484100.0%

Newsgroup request counts (by newsgroup) [Top 100]:

NewsgroupCount
1rec.arts.tv 786
2rec.food.cooking 376
3rec.bicycles.tech 92
4alt.comp.os.windows-10 64
5misc.phone.mobile.iphone 32
6sci.electronics.repair 28
7comp.mobile.android 20
8misc.consumers.frugal-living 16
9rec.radio.broadcasting 10
10comp.mail.sendmail 10
11alt.stupidity 8
12rec.outdoors.rv-travel 8
13chi.weather 6
14chi.forsale 6
15comp.unix.bsd.freebsd.misc 4
16alt.satellite.gps.garmin 2
17alt.free.newsservers 2
18rec.radio.shortwave 2
19rec.bicycles.misc 2
20rec.gardens.edible 2
21alt.security.alarms 2
22comp.sys.mac.vintage 2
23news.admin.net-abuse.misc 2
24rec.radio.swap 2
TOTAL: 24 1484