Daily Usenet report for news.ripco.com

Dec 11 00:01:02 -- Dec 11 23:57:45

Unknown entries from news log file:

First 3 / 3 lines (100.0%)

Dec 11 06:13:24 remote5bge0 overchan[25461]: [ID 702911 news.error] input line too long, skipping
Dec 11 17:22:56 remote5bge0 overchan[25461]: [ID 702911 news.error] input line too long, skipping
Dec 11 18:09:03 remote5bge0 overchan[25461]: [ID 702911 news.error] input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
innd 20540 32.4%3.2 MB 33.5%
inn 20440 32.3%3.6 MB 37.6%
nnrpd 18708 29.5%2.0 MB 20.8%
innfeed 3668 5.8%781.0 KB 8.0%
overchan 3 0.0%0.4 KB 0.0%
controlchan 2 0.0%0.2 KB 0.0%
TOTAL: 6 63361 100.0%9.5 MB100.0%

History cache:

ReasonCount%Count
Do not exist 174996 52.3%
Cache misses 159572 47.7%
Negative hits 0 0.0%
Positive hits 0 0.0%
TOTAL: 4 334568 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.000 0.0%168 0.000 0.000 0.000
article cleanup00:00:00.346 0.0%40394 0.000 0.009 0.049
article logging00:00:00.772 0.0%40840 0.000 0.019 1.286
article parse00:00:01.460 0.0%98518 0.000 0.015 0.033
article write00:01:20.494 0.0%29520 0.815 2.727 131.615
artlog/artparse00:00:00.000 0.0%2 0.000 0.000 0.000
data move00:00:00.246 0.0%343156 0.000 0.001 0.004
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.796 0.0%336356 0.001 0.008 0.019
history sync00:00:00.172 0.0%772 0.000 0.223 1.500
history write00:00:02.886 0.0%40394 0.010 0.071 0.452
hiswrite/artparse00:00:00.000 0.0%0 0.000 0.000 0.000
idle47:38:38.250 99.9%381134 193.324 450.021 1159.832
nntp read00:00:02.060 0.0%379832 0.001 0.005 0.016
overview write00:00:00.200 0.0%29520 0.000 0.007 0.042
perl filter00:00:56.214 0.0%40392 1.084 1.392 2.515
python filter00:00:01.078 0.0%40404 0.000 0.027 0.075
site send00:00:02.538 0.0%88544 0.000 0.029 0.092
TOTAL: 47:42:00.92647:41:09.512100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.114 0.0%29582 0.000 0.004 0.022
article prepare00:00:00.002 0.0%5184 0.000 0.000 0.036
article read00:00:00.730 0.0%1008 0.000 0.724 153.000
backlog stats00:00:00.250 0.0%364188 0.000 0.001 0.003
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:01.802 0.0%237836 0.000 0.008 0.020
data write00:00:04.280 0.0%208782 0.008 0.020 0.041
idle47:34:12.004100.0%364188 267.182 470.230 1088.058
status file00:00:01.260 0.0%356 0.000 3.539 25.000
TOTAL: 47:34:30.93847:34:20.442100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle03:54:04.414 98.9%19726 19.224 711.975190653.833
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:08.624 0.1%912486 0.000 0.009 1.000
readart00:00:27.450 0.2%3830 0.250 7.167 39.500
TOTAL: 03:56:43.60203:54:40.488 99.1%----

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 1146 31530 8356 19318 3856 26%94:39:16
2news.snarked.org 48 27952 8114 18620 1218 29%53:39:42
3feeder3.feed-ams.uzoreto.com 574 18606 6808 10400 1398 36%47:08:48
4newsfeed.neva.ru 608 41388 4974 33200 3214 12%276:21:28
5newsfeed.fu-berlin.de 2 13384 566 12794 24 4%44:30:14
6news-in.rahul.net 574 16832 254 16536 42 1%47:20:18
7news.lightlink.com 2 10064 180 9796 88 1%50:52:50
8news.cmpublishers.com 50 8114 62 8010 42 0%48:00:08
9ripco-out.feeder.erje.net 574 31056 24 30070 962 0%47:16:28
10localhost 158 12 12 0 0 100%00:00:00
TOTAL: 10 3736 198938 29350 158744 10844 14%709:49:12
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1news.snarked.org23.7 MB0.0 KB3.2 MB26.9 MB 87%3.0 KB
2ripco-out.feed.uzoreto.com22.0 MB0.0 KB8.9 MB30.9 MB 71%2.6 KB
3feeder3.feed-ams.uzoreto.com18.3 MB0.0 KB4.3 MB22.6 MB 80%2.8 KB
4newsfeed.neva.ru13.8 MB0.0 KB16.8 MB30.6 MB 45%3.8 KB
5news-in.rahul.net7.6 MB0.0 KB1.3 MB8.9 MB 85%30.7 KB
6newsfeed.fu-berlin.de3.0 MB0.0 KB351.4 KB3.4 MB 89%5.8 KB
7news.lightlink.com2.6 MB0.0 KB5.1 MB7.8 MB 33%29.7 KB
8news.cmpublishers.com188.3 KB0.0 KB60.9 KB249.2 KB 75%2.4 KB
9ripco-out.feeder.erje.net156.6 KB0.0 KB10.2 MB10.4 MB 1%10.8 KB
10localhost25.5 KB0.0 KB0.0 KB25.5 KB100%2.1 KB
TOTAL: 1091.4 MB0.0 KB50.3 MB141.7 MB 64%3.6 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Dec 11 00:01:02 - 00:59:59 406 2.7% 0.111.2 MB 2.7% 0.35
Dec 11 01:00:00 - 01:59:59 543 3.7% 0.152.2 MB 4.7% 0.62
Dec 11 02:00:00 - 02:59:59 546 3.7% 0.151.5 MB 3.2% 0.42
Dec 11 03:00:00 - 03:59:59 555 3.8% 0.151.4 MB 3.0% 0.39
Dec 11 04:00:00 - 04:59:59 586 4.0% 0.162.0 MB 4.3% 0.56
Dec 11 05:00:00 - 05:59:59 600 4.1% 0.171.7 MB 3.6% 0.47
Dec 11 06:00:00 - 06:59:59 598 4.0% 0.171.8 MB 3.9% 0.51
Dec 11 07:00:00 - 07:59:59 646 4.4% 0.182.2 MB 4.8% 0.63
Dec 11 08:00:00 - 08:59:59 784 5.3% 0.222.3 MB 5.1% 0.66
Dec 11 09:00:00 - 09:59:59 962 6.5% 0.272.5 MB 5.5% 0.71
Dec 11 10:00:00 - 10:59:59 869 5.9% 0.243.2 MB 7.0% 0.91
Dec 11 11:00:00 - 11:59:59 759 5.1% 0.212.5 MB 5.5% 0.71
Dec 11 12:00:00 - 12:59:59 755 5.1% 0.212.0 MB 4.4% 0.57
Dec 11 13:00:00 - 13:59:59 744 5.0% 0.212.2 MB 4.9% 0.64
Dec 11 14:00:00 - 14:59:59 931 6.3% 0.262.7 MB 5.9% 0.77
Dec 11 15:00:00 - 15:59:59 841 5.7% 0.232.6 MB 5.6% 0.73
Dec 11 16:00:00 - 16:59:59 744 5.0% 0.212.6 MB 5.6% 0.73
Dec 11 17:00:00 - 17:59:59 624 4.2% 0.172.0 MB 4.3% 0.56
Dec 11 18:00:00 - 18:59:59 545 3.7% 0.151.5 MB 3.2% 0.42
Dec 11 19:00:00 - 19:59:59 368 2.5% 0.101.1 MB 2.3% 0.30
Dec 11 20:00:00 - 20:59:59 427 2.9% 0.121.9 MB 4.1% 0.53
Dec 11 21:00:00 - 21:59:59 347 2.3% 0.101.1 MB 2.3% 0.30
Dec 11 22:00:00 - 22:59:59 307 2.1% 0.09994.1 KB 2.1% 0.28
Dec 11 23:00:00 - 23:57:45 286 1.9% 0.08881.7 KB 1.9% 0.25
TOTAL: 23:56:43 14773 100.0% 0.1745.7 MB 100.0% 0.54
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1ripco-out.feed.uzoreto.com 1937 1122 0 0 1 0 0 0 814
2newsfeed.neva.ru 1647 569 0 0 2 0 0 0 1076
3feeder3.feed-ams.uzoreto.com 699 256 0 0 1 0 0 0 442
4news.snarked.org 630 468 0 0 0 0 0 0 162
5ripco-out.feeder.erje.net 481 479 0 0 0 0 0 0 2
6newsfeed.fu-berlin.de 185 0 0 0 0 0 0 0 185
7news.lightlink.com 46 0 0 1 0 0 0 0 45
8news.cmpublishers.com 21 1 0 0 0 0 0 0 20
9news-in.rahul.net 21 3 0 0 0 0 0 0 18
TOTAL: 9 5667 2898 0 1 4 0 0 0 2764

Unwanted newsgroups [Top 20]:

NewsgroupCount
free.usenet 1792
alt.binaries.boneless 264
alt.binaries.ftd 224
fido7.su.pol.news 48
alt.binaries.nl 42
it.tlc.cellulari.android 40
perl.cpan.uploads 31
free.it.scienza.fisica 27
de.soc.arbeitslos 27
scot.general 24
it.comp.os.win.windows10 21
test.post 17
it.comp.os.win.windows7 16
free.willey 14
alt.binaries.pictures.purebeauty 13
alt.binaries.pictures.scenic 11
alt.binaries.pictures.rail 11
alt.binaries.e-book 11
linux.debian.ports.68k 10
alt.binaries.nospam.female.bodyhair.pubes 9
TOTAL: 124 2898

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

GroupsCount
fr.comp.lang.php 2
alt.penthouse.sex.fetish.tickling 1
bit.listserv.catholic 1
TOTAL: 3 4

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 2448
Binary in non-binary group 1214
Too many newsgroups 1098
EMP (phl) 142
Scoring filter (8) 102
Scoring filter (9) 20
Scoring filter (11) 18
Scoring filter (10) 10
HTML post 10
Scoring filter (18) 8
Scoring filter (14) 6
Scoring filter (13) 2
Scoring filter (12) 2
TOTAL: 13 5080

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Bad Message-ID's offered
ripco-out.feeder.erje.net 18
TOTAL: 1 18
Including strange strings
newsfeed.fu-berlin.de 174
newsfeed.neva.ru 40
ripco-out.feed.uzoreto.com 10
feeder3.feed-ams.uzoreto.com 1
TOTAL: 4 225
No colon-space in header
ripco-out.feed.uzoreto.com 1
TOTAL: 1 1
TOTAL: 3 244

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1rahul.net 23190 602 13710 28 0 6 2%47:40:12
2news.lightlink.com 11320 384 6858 8 0 0 3%47:33:42
3feeder.erje.net 28284 34 27964 32 0 0 0%47:41:18
4news.snarked.org 34650 28 21088 6 0 70 0%47:48:14
5fu-berlin.de 27248 22 27226 0 0 0 0%47:48:02
6newsfeed.neva.ru 24770 18 24508 10 0 16 0%47:51:50
7news.uzoreto.com 14238 18 14040 4 0 0 0%47:40:02
8news.cmpublishers.com 44896 16 29074 86 0 36 0%47:35:12
9remote6hme0.ripco.com 0 0 0 0 0 6 0%47:40:02
TOTAL: 9 208596 1122 164468 174 0 134 0%429:18:34
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1rahul.net2.8 MB51.2 KB2.9 MB0.0 KB/s4.6 KB47:40:12
2news.lightlink.com1.2 MB28.1 KB1.3 MB0.0 KB/s3.3 KB47:33:42
3news.snarked.org148.5 KB14.1 KB162.6 KB0.0 KB/s4.8 KB47:48:14
4feeder.erje.net143.4 KB115.8 KB259.3 KB0.0 KB/s3.9 KB47:41:18
5fu-berlin.de106.5 KB0.0 KB106.5 KB0.0 KB/s4.8 KB47:48:02
6news.uzoreto.com90.9 KB15.6 KB106.5 KB0.0 KB/s4.8 KB47:40:02
7newsfeed.neva.ru48.4 KB75.8 KB124.3 KB0.0 KB/s4.4 KB47:51:50
8news.cmpublishers.com39.1 KB207.9 KB246.9 KB0.0 KB/s2.4 KB47:35:12
9remote6hme0.ripco.com0.0 KB0.0 KB0.0 KB0.0 KB/s047:40:02
TOTAL: 94.6 MB508.6 KB5.1 MB0.0 KB/s4.0 KB429:18:34
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1c-73-246-79-215.hsd1.il.comcast.net 2 12002.9 MB 8 0 000:07:10
2ftupet.com 286 10243.1 MB 454 10 000:07:47
3shell3 18 5681.5 MB 66 2 003:40:21
4108-237-13-94.lightspeed.cicril.sbcglobal.net 16 47.1 KB 2 0 000:00:07
TOTAL: 4 322 27967.5 MB 530 12 003:56:29

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.hsd1.il.comcast.net 2 12002.9 MB 8 0 000:07:10
2*.com 286 10243.1 MB 454 10 000:07:47
3? 18 5681.5 MB 66 2 003:40:21
4*.lightspeed.cicril.sbcglobal.net 16 47.1 KB 2 0 000:00:07
TOTAL: 4 322 27967.5 MB 530 12 003:55:26

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
shell3 5.232 2.604 0.00003:40:21
ftupet.com 45.958 7.768 0.00000:07:47
c-73-246-79-215.hsd1.il.comcast.net 0.398 0.202 0.00000:07:10
d54c176a7.access.telenet.be 32.134 7.318 0.00000:01:02
108-237-13-94.lightspeed.cicril.sbcglobal.net 1.736 0.346 0.00000:00:07
worker-18.sfj.corp.censys.io 0.200 0.040 0.00000:00:00
TOTAL: 6 85.658 18.278 0.00003:56:29

NNRP no permission clients:

SystemConn
d54c176a7.access.telenet.be 320
worker-18.sfj.corp.censys.io 2
TOTAL: 2 322

NNRP unrecognized commands (by host):

SystemConn
shell3 2
TOTAL: 1 2

NNRP unrecognized commands (by command):

CommandCount
XTHREAD DBINIT 2
TOTAL: 1 2

NNRP client timeouts [Top 20]:

SystemConnPeer
shell3 6 0
TOTAL: 1 6 0

Newsgroup request counts (by category):

CategoryCountPct
1rec 1312 46.9%
2misc 1072 38.3%
3sci 170 6.1%
4comp 118 4.2%
5news 72 2.6%
6chi 40 1.4%
7alt 10 0.4%
8gnu 2 0.1%
TOTAL: 8 2796100.0%

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

NewsgroupCount
1misc.phone.mobile.iphone 952
2rec.arts.tv 762
3rec.food.cooking 386
4sci.electronics.repair 170
5rec.bicycles.tech 134
6misc.consumers.frugal-living 118
7comp.sys.mac.system 72
8news.software.nntp 56
9chi.general 30
10comp.mobile.android 28
11comp.mobile.ipad 12
12news.admin.net-abuse.email 10
13chi.weather 10
14rec.gardens.edible 10
15alt.stupidity 8
16rec.antiques.radio+phono 6
17rec.puzzles 6
18rec.radio.swap 4
19comp.security.ssh 4
20news.groups.questions 4
21rec.radio.broadcasting 2
22misc.transport.rail.americas 2
23rec.bicycles.misc 2
24gnu.utils.bug 2
25news.admin.net-abuse.usenet 2
26comp.protocols.dns.bind 2
27alt.dbs.directv 2
TOTAL: 27 2796