Re: [squid-users] Squid icap preview problem

From: akinf <fatih.akin_at_turkcellteknoloji.com.tr>
Date: Wed, 11 Nov 2009 06:55:41 -0800 (PST)

Thank you for reply,
what i mean was, i set the preivew to 0 but, squid still sent me the whole
message.
But know i solved,it , in the options response i set to preview size to 10
bytes,
Now it sends me messages in preview mode, but this time i faced another two
problems.

First of all, it alway sends previes size as 0, but in my concinfguration i
set it to 23 bytes , and in operionts
repsosne set it to 10 bytes. This is rdiciculos, but i made it for just
testing.

Actuall this is not a big problem for me, preview size is ok. But i just
report it to understand wehter i am doing stg. wrong.

Now i am able to work in preview mode. But this time,
when squid forwards me respmod for resposnes like 302 , i reply it, but
squid gives error . Here are the logs:

On squid logs what i see for 302 is,

2009/11/11 15:29:21.010| errorConvert: %%U --> 'http://m.goal.com/'
2009/11/11 15:29:21.010| errorConvert: %%E --> '(11) Resource temporarily
unavailable'
2009/11/11 15:29:21.010| errorConvert: %%T --> 'Wed, 11 Nov 2009 13:29:21
GMT'
2009/11/11 15:29:21.010| errorConvert: %%h --> 'miepdev'
2009/11/11 15:29:21.010| errorConvert: %%s --> 'squid/3.1.0.8'
2009/11/11 15:29:21.010| errorConvert: %%c --> 'ERR_ICAP_FAILURE'
2009/11/11 15:29:21.010| StoreEntry::replaceHttpReply: http://m.goal.com/
2009/11/11 15:29:21.010| storeWrite: writing 36 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.010| storeGetMemSpace: Starting, need 1 pages
2009/11/11 15:29:21.010| storeGetMemSpace stats:
2009/11/11 15:29:21.010| 25 HOT objects
2009/11/11 15:29:21.010| 0 were released
2009/11/11 15:29:21.011| storeWrite: writing 6 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 13 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 12 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 3 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 4 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 29 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 12 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 9 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 14 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 4 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 7 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 29 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 13 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 19 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.011| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.012| storeWrite: writing 4 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.012| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.012| storeWrite: writing 15 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'
2009/11/11 15:29:21.012| storeWrite: writing 2 bytes for
'370A3A77F58ED7995DBD4F5F238A976A'

2009/11/11 15:29:21.008| ModXact.cc:732: exception: preview.enabled() &&
preview.done() && !preview.ieof()
2009/11/11 15:29:21.008| AsyncJob.cc(218) dial:
Adaptation::Icap::Xaction::noteCommRead threw exception: preview.enabled()
&& preview.done() && !preview.ieof()
2009/11/11 15:29:21.008| Adaptation::Icap::ModXact will stop, reason:
exception
2009/11/11 15:29:21.008| Adaptation::Icap::Xaction::noteCommRead(FD 11,
data=0x16e6ecd8, size=25, buf=0x2aefdc668010) ends job [FD 11;rw(4)/RP(ieof)
icapx31]
2009/11/11 15:29:21.008| ModXact.cc(1012) swanSong: swan sings [FD
11;rw(4)/RP(ieof) icapx31]
2009/11/11 15:29:21.008| comm_remove_close_handler: FD 11,
AsyncCall=0x16e9c3c0*2
2009/11/11 15:29:21.008| Xaction.cc(152) closeConnection: not reusing pconn
due to pending I/O [FD 11;r/RwP(ieof)S icapx31]
2009/11/11 15:29:21.009| Xaction.cc(167) closeConnection: closing pconn [FD
11;r/RwP(ieof)S icapx31]
2009/11/11 15:29:21.009| comm_close: start closing FD 11
2009/11/11 15:29:21.009| The AsyncCall comm_close_start constructed,
this=0x16e7b0e0 [call291]
2009/11/11 15:29:21.009| comm.cc(1594) will call comm_close_start(FD 11)
[call291]
2009/11/11 15:29:21.009| comm.cc(1178) commSetTimeout: FD 11 timeout -1
2009/11/11 15:29:21.009| comm.cc(1189) commSetTimeout: FD 11 timeout -1
2009/11/11 15:29:21.009| commCallCloseHandlers: FD 11
2009/11/11 15:29:21.009| The AsyncCall comm_close_complete constructed,
this=0x16e9e080 [call292]
2009/11/11 15:29:21.009| comm.cc(1626) will call comm_close_complete(FD 11)
[call292]
2009/11/11 15:29:21.009| The AsyncCall Initiator::noteAdaptationQueryAbort
constructed, this=0x16e7f6b0 [call293]
2009/11/11 15:29:21.009| Initiate.cc(82) will call
Initiator::noteAdaptationQueryAbort(1) [call293]
2009/11/11 15:29:21.009| Initiate.cc(51) swanSong: swan sings [/RwP(ieof)S
icapx31]
2009/11/11 15:29:21.009| Initiate.cc(58) swanSong: swan sang [/RwP(ieof)S
icapx31]
2009/11/11 15:29:21.009| Adaptation::Icap::ModXact destructed,
this=0x16e6ecd8 [icapx31]
2009/11/11 15:29:21.009| leaving Adaptation::Icap::Xaction::noteCommRead(FD
11, data=0x16e6ecd8, size=25, buf=0x2aefdc668010)
2009/11/11 15:29:21.009| entering comm_close_start(FD 11)
2009/11/11 15:29:21.009| AsyncCall.cc(32) make: make call comm_close_start
[call291]
2009/11/11 15:29:21.009| leaving comm_close_start(FD 11)
2009/11/11 15:29:21.009| entering comm_close_complete(FD 11)
2009/11/11 15:29:21.009| AsyncCall.cc(32) make: make call
comm_close_complete [call292]
2009/11/11 15:29:21.009| fd_close FD 11 icap://localhost:1344/echosimpre
2009/11/11 15:29:21.009| leaving comm_close_complete(FD 11)
2009/11/11 15:29:21.009| entering Initiator::noteAdaptationQueryAbort(1)
2009/11/11 15:29:21.009| AsyncCall.cc(32) make: make call
Initiator::noteAdaptationQueryAbort [call293]
2009/11/11 15:29:21.009| Adaptation::Icap::ModXactLauncher status in: [
job30]
2009/11/11 15:29:21.009| Launcher.cc(72) noteAdaptationQueryAbort: cannot
retry the failed ICAP xaction; tries: 1; final: 1
2009/11/11 15:29:21.009| Initiator::noteAdaptationQueryAbort(1) ends job [
job30]
2009/11/11 15:29:21.009| The AsyncCall Initiator::noteAdaptationQueryAbort
constructed, this=0x16e9e080 [call294]
2009/11/11 15:29:21.009| Initiate.cc(82) will call
Initiator::noteAdaptationQueryAbort(1) [call294]
2009/11/11 15:29:21.009| Initiate.cc(51) swanSong: swan sings [ job30]
2009/11/11 15:29:21.009| Initiate.cc(58) swanSong: swan sang [ job30]
2009/11/11 15:29:21.009| leaving Initiator::noteAdaptationQueryAbort(1)
2009/11/11 15:29:21.009| entering Initiator::noteAdaptationQueryAbort(1)
2009/11/11 15:29:21.009| AsyncCall.cc(32) make: make call
Initiator::noteAdaptationQueryAbort [call294]
2009/11/11 15:29:21.009| HttpStateData status in: [ job28]
2009/11/11 15:29:21.009| Server.cc(737) handleAdaptationAborted:
handleAdaptationAborted; bypassable: 0, entry empty: 1
2009/11/11 15:29:21.009| forward.cc(279) fail: ERR_ICAP_FAILURE "Internal
Server Error"
        http://m.goal.com/
2009/11/11 15:29:21.009| http.cc(2063) abortTransaction: aborting
transaction for ICAP failure; FD -1, this 0x16e98338
2009/11/11 15:29:21.010| handleUnregisteredServerEnd: self=0x16e87c28*2
err=0x16e9e3a8 http://m.goal.com/
2009/11/11 15:29:21.010| HttpStateData will NOT delete in-call job, reason:
HttpStateData::abortTransaction
2009/11/11 15:29:21.010| Initiator::noteAdaptationQueryAbort(1) ends job
[Stopped, reason:HttpStateData::abortTransaction job28]
2009/11/11 15:29:21.010| Server.cc(548) cleanAdaptation: cleaning ICAP; ACL:
0
2009/11/11 15:29:21.010| http.cc(157) ~HttpStateData: HttpStateData
0x16e98338 destroyed; FD -1
2009/11/11 15:29:21.010| StoreEntry::unlock: key
'370A3A77F58ED7995DBD4F5F238A976A' count=2
2009/11/11 15:29:21.010| forward.cc(159) ~FwdState: FwdState destructor
starting
2009/11/11 15:29:21.010| Creating an error page for entry 0x2aefdc55d970
with errorstate 0x16e9e3a8 page id 35
2009/11/11 15:29:21.010| StoreEntry::lock: key
'370A3A77F58ED7995DBD4F5F238A976A' count=3
2009/11/11 15:29:21.010| file_open: FD 11
2009/11/11 15:29:21.010| fd_open() FD 11
/usr/local/squid/share/errors/tr/ERR_ICAP_FAILURE
2009/11/11 15:29:21.010| file_close: FD 11 really closing

2009/11/11 15:29:21.010| fd_close FD 11
/usr/local/squid/share/errors/tr/ERR_ICAP_FAILURE
2009/11/11 15:29:21.010| errorConvert: %%l --> '/*
 Stylesheet for Squid Error pages
 Adapted from design by Free CSS Templates
 http://www.freecsstemplates.org
 Released for free under a Creative Commons Attribution 2.5 License
*/

/* Page basics */
* {
        font-family: verdana, sans-serif;
}

html body {
        margin: 0;
        padding: 0;
        background: #efefef;
        font-size: 12px;
        color: #1e1e1e;
}

/* Page displayed title area */
#titles {
        margin-left: 15px;
        padding: 10px;
        padding-left: 100px;
        background: url('http://www.squid-cache.org/Artwork/SN.png')
no-repeat left;
}

/* initial title */
#titles h1 {
        color: #000000;
}
#titles h2 {
        color: #000000;
}

/* special event: FTP success page titles */
#titles ftpsuccess {
        background-color:#00ff00;
        width:100%;
}

/* Page displayed body content area */
#content {
        padding: 10px;
        background: #ffffff;
}

/* General text */
p {
}

/* error brief description */
#error p {
}

/* some data which may have caused the problem */
#data {
}

/* the error message received from the system or other software */
#sysmsg {
}

pre {
    font-family:sans-serif;
}

/* special event: FTP directory listing */
#ftplisting tr.entry td.icon,td.filename,td.size,td.date {
    border-bottom: groove;
}
#ftplisting td.size {
    width: 50px;
    text-align: right;
    padding-right: 5px;
}

/* horizontal lines */
hr {
        margin: 0;
}

/* page displayed footer area */
#footer {
        font-size: 9px;
        padding-left: 10px;
}
'
2009/11/11 15:29:21.010| errorConvert: %%; --> '%;'
2009/11/11 15:29:21.010| errorConvert: %%U --> 'http://m.goal.com/'

My icap server logs seems fine,
=================
2009-11-11 15:29:21,002 DEBUG [ReadWriteDispatcherImpl-Thread-3]
ReadWriteDispatcherImpl handled 0 active key(s)
2009-11-11 15:29:21,002 DEBUG [ReadWriteDispatcherImpl-Thread-3]
ReadWriteDispatcherImpl handled 0 active key(s)
2009-11-11 15:29:21,002 DEBUG [ReadWriteDispatcherImpl-Thread-3]
ReadWriteDispatcherImpl handled 0 active key(s)
2009-11-11 15:29:21,003 DEBUG [ReadWriteDispatcherImpl-Thread-3]
ReadWriteDispatcherImpl handled 0 job(s)
2009-11-11 15:29:21,003 DEBUG [ReadWriteDispatcherImpl-Thread-3]
ReadWriteDispatcherImpl read ready on
java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336]
2009-11-11 15:29:21,005 DEBUG [ReadWriteDispatcherImpl-Thread-3]
SelectableSocketEndpoint read 1241 bytes on
java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336]:
0000 52 45 53 50 4d 4f 44 20 69 63 61 70 3a 2f 2f 6c RESPMOD icap://l
0010 6f 63 61 6c 68 6f 73 74 3a 31 33 34 34 2f 65 63 ocalhost :1344/ec
0020 68 6f 73 69 6d 70 72 65 20 49 43 41 50 2f 31 2e hosimpre ICAP/1.
0030 30 0d 0a 48 6f 73 74 3a 20 6c 6f 63 61 6c 68 6f 0..Host: localho
0040 73 74 3a 31 33 34 34 0d 0a 44 61 74 65 3a 20 57 st:1344. .Date: W
0050 65 64 2c 20 31 31 20 4e 6f 76 20 32 30 30 39 20 ed, 11 N ov 2009
0060 31 33 3a 32 39 3a 32 30 20 47 4d 54 0d 0a 45 6e 13:29:20 GMT..En
0070 63 61 70 73 75 6c 61 74 65 64 3a 20 72 65 71 2d capsulat ed: req-
0080 68 64 72 3d 30 2c 20 72 65 73 2d 68 64 72 3d 35 hdr=0, r es-hdr=5
0090 36 31 2c 20 6e 75 6c 6c 2d 62 6f 64 79 3d 31 30 61, null -body=10
00a0 32 36 0d 0a 50 72 65 76 69 65 77 3a 20 30 0d 0a 26..Prev iew: 0..
00b0 41 6c 6c 6f 77 3a 20 32 30 34 0d 0a 58 2d 43 6c Allow: 2 04..X-Cl
00c0 69 65 6e 74 2d 49 50 3a 20 31 30 2e 35 32 2e 34 ient-IP: 10.52.4
00d0 33 2e 38 0d 0a 0d 0a 47 45 54 20 68 74 74 70 3a 3.8....G ET http:
00e0 2f 2f 6d 2e 67 6f 61 6c 2e 63 6f 6d 2f 20 48 54 //m.goal .com/ HT
00f0 54 50 2f 31 2e 31 0d 0a 48 6f 73 74 3a 20 6d 2e TP/1.1.. Host: m.
0100 67 6f 61 6c 2e 63 6f 6d 0d 0a 41 63 63 65 70 74 goal.com ..Accept
0110 3a 20 74 65 78 74 2f 68 74 6d 6c 2c 61 70 70 6c : text/h tml,appl
0120 69 63 61 74 69 6f 6e 2f 78 68 74 6d 6c 2b 78 6d ication/ xhtml+xm
0130 6c 2c 74 65 78 74 2f 63 73 73 2c 20 2a 2f 2a 0d l,text/c ss, */*.
0140 0a 41 63 63 65 70 74 2d 43 68 61 72 73 65 74 3a .Accept- Charset:
0150 20 69 73 6f 2d 38 38 35 39 2d 31 2c 20 75 74 66 iso-885 9-1, utf
0160 2d 38 3b 20 71 3d 30 2e 37 2c 20 2a 3b 20 71 3d -8; q=0. 7, *; q=
0170 30 2e 37 0d 0a 41 63 63 65 70 74 2d 45 6e 63 6f 0.7..Acc ept-Enco
0180 64 69 6e 67 3a 20 67 7a 69 70 2c 20 64 65 66 6c ding: gz ip, defl
0190 61 74 65 2c 20 78 2d 67 7a 69 70 2c 20 69 64 65 ate, x-g zip, ide
01a0 6e 74 69 74 79 3b 20 71 3d 30 2e 39 0d 0a 41 63 ntity; q =0.9..Ac
01b0 63 65 70 74 2d 4c 61 6e 67 75 61 67 65 3a 20 74 cept-Lan guage: t
01c0 72 3b 71 3d 31 2e 30 2c 65 6e 3b 71 3d 30 2e 35 r;q=1.0, en;q=0.5
01d0 2c 66 72 3b 71 3d 30 2e 35 2c 64 65 3b 71 3d 30 ,fr;q=0. 5,de;q=0
01e0 2e 35 2c 69 74 3b 71 3d 30 2e 35 2c 6e 6c 3b 71 .5,it;q= 0.5,nl;q
01f0 3d 30 2e 35 0d 0a 43 6f 6f 6b 69 65 3a 20 6d 5f =0.5..Co okie: m_
0200 67 6f 61 6c 5f 63 6f 6d 3d 61 25 33 41 32 25 33 goal_com =a%3A2%3
0210 41 25 37 42 73 25 33 41 36 25 33 41 25 32 32 72 A%7Bs%3A 6%3A%22r
0220 65 67 69 6f 6e 25 32 32 25 33 42 73 25 33 41 32 egion%22 %3Bs%3A2
0230 25 33 41 25 32 32 54 52 25 32 32 25 33 42 73 25 %3A%22TR %22%3Bs%
0240 33 41 31 35 25 33 41 25 32 32 75 73 65 72 5f 73 3A15%3A% 22user_s
0250 65 73 73 69 6f 6e 5f 69 64 25 32 32 25 33 42 73 ession_i d%22%3Bs
0260 25 33 41 32 35 25 33 41 25 32 32 31 32 35 37 39 %3A25%3A %2212579
0270 32 39 37 34 34 32 31 32 2e 32 35 32 2e 32 33 34 29744212 .252.234
0280 2e 31 36 32 25 32 32 25 33 42 25 37 44 0d 0a 43 .162%22% 3B%7D..C
0290 6f 6f 6b 69 65 32 3a 20 24 56 65 72 73 69 6f 6e ookie2: $Version
02a0 3d 31 0d 0a 55 73 65 72 2d 41 67 65 6e 74 3a 20 =1..User -Agent:
02b0 4d 6f 7a 69 6c 6c 61 2f 35 2e 30 20 28 53 79 6d Mozilla/ 5.0 (Sym
02c0 62 69 61 6e 4f 53 2f 39 2e 31 3b 20 55 3b 20 65 bianOS/9 .1; U; e
02d0 6e 2d 75 73 29 20 41 70 70 6c 65 57 65 62 4b 69 n-us) Ap pleWebKi
02e0 74 2f 34 31 33 20 28 4b 48 54 4d 4c 2c 20 6c 69 t/413 (K HTML, li
02f0 6b 65 20 47 65 63 6b 6f 29 20 53 61 66 61 72 69 ke Gecko ) Safari
0300 2f 34 31 33 0d 0a 0d 0a 48 54 54 50 2f 31 2e 31 /413.... HTTP/1.1
0310 20 33 30 32 20 4d 6f 76 65 64 20 54 65 6d 70 6f 302 Mov ed Tempo
0320 72 61 72 69 6c 79 0d 0a 44 61 74 65 3a 20 57 65 rarily.. Date: We
0330 64 2c 20 31 31 20 4e 6f 76 20 32 30 30 39 20 31 d, 11 No v 2009 1
0340 33 3a 32 34 3a 31 35 20 47 4d 54 0d 0a 53 65 72 3:24:15 GMT..Ser
0350 76 65 72 3a 20 41 70 61 63 68 65 2f 32 2e 32 2e ver: Apa che/2.2.
0360 33 20 28 44 65 62 69 61 6e 29 20 44 41 56 2f 32 3 (Debia n) DAV/2
0370 20 53 56 4e 2f 31 2e 34 2e 32 20 6d 6f 64 5f 6a SVN/1.4 .2 mod_j
0380 6b 2f 31 2e 32 2e 31 38 20 6d 6f 64 5f 70 79 74 k/1.2.18 mod_pyt
0390 68 6f 6e 2f 33 2e 32 2e 31 30 20 50 79 74 68 6f hon/3.2. 10 Pytho
03a0 6e 2f 32 2e 34 2e 34 20 6d 6f 64 5f 73 73 6c 2f n/2.4.4 mod_ssl/
03b0 32 2e 32 2e 33 20 4f 70 65 6e 53 53 4c 2f 30 2e 2.2.3 Op enSSL/0.
03c0 39 2e 38 63 20 6d 6f 64 5f 70 65 72 6c 2f 32 2e 9.8c mod _perl/2.
03d0 30 2e 32 20 50 65 72 6c 2f 76 35 2e 38 2e 38 0d 0.2 Perl /v5.8.8.
03e0 0a 45 78 70 69 72 65 73 3a 20 54 68 75 2c 20 31 .Expires : Thu, 1
03f0 39 20 4e 6f 76 20 31 39 38 31 20 30 38 3a 35 32 9 Nov 19 81 08:52
0400 3a 30 30 20 47 4d 54 0d 0a 43 61 63 68 65 2d 43 :00 GMT. .Cache-C
0410 6f 6e 74 72 6f 6c 3a 20 6e 6f 2d 73 74 6f 72 65 ontrol: no-store
0420 2c 20 6e 6f 2d 63 61 63 68 65 2c 20 6d 75 73 74 , no-cac he, must
0430 2d 72 65 76 61 6c 69 64 61 74 65 2c 20 70 6f 73 -revalid ate, pos
0440 74 2d 63 68 65 63 6b 3d 30 2c 20 70 72 65 2d 63 t-check= 0, pre-c
0450 68 65 63 6b 3d 30 0d 0a 50 72 61 67 6d 61 3a 20 heck=0.. Pragma:
0460 6e 6f 2d 63 61 63 68 65 0d 0a 4c 6f 63 61 74 69 no-cache ..Locati
0470 6f 6e 3a 20 2f 3f 53 49 44 3d 61 34 62 36 65 62 on: /?SI D=a4b6eb
0480 66 35 61 38 66 32 34 64 35 36 32 38 39 36 30 32 f5a8f24d 56289602
0490 33 31 34 61 66 65 39 30 64 32 0d 0a 43 6f 6e 74 314afe90 d2..Cont
04a0 65 6e 74 2d 4c 65 6e 67 74 68 3a 20 30 0d 0a 43 ent-Leng th: 0..C
04b0 6f 6e 74 65 6e 74 2d 54 79 70 65 3a 20 74 65 78 ontent-T ype: tex
04c0 74 2f 68 74 6d 6c 3b 20 63 68 61 72 73 65 74 3d t/html; charset=
04d0 55 54 46 2d 38 0d 0a 0d 0a UTF-8... .

2009-11-11 15:29:21,006 DEBUG [ReadWriteDispatcherImpl-Thread-3]
IcapContextualHandler received event REQUEST_HDR_RECEIVED for
java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336], processing state is READING_MIMEHEADERS
2009-11-11 15:29:21,006 DEBUG [ReadWriteDispatcherImpl-Thread-3]
UriBoundIcapServiceManager looking for an ICAP service matching URI
icap://localhost:1344/echosimpre
2009-11-11 15:29:21,006 DEBUG [ReadWriteDispatcherImpl-Thread-3]
UriBoundIcapServiceManager ICAP request
com.brimarx.icap10.stack.impl.IcapRequestImpl_at_352be6 has service name
'/echosimpre'
2009-11-11 15:29:21,006 DEBUG [ReadWriteDispatcherImpl-Thread-3]
UriBoundIcapServiceManager ICAP service name '/echosimpre' matching
service'Echo-Service'
2009-11-11 15:29:21,006 DEBUG [ReadWriteDispatcherImpl-Thread-3]
IcapContextualHandler delegating new ICAP request to service Echo-Service
for java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336]
2009-11-11 15:29:21,007 DEBUG [ReadWriteDispatcherImpl-Thread-3]
IcapContextualHandler received event REQUEST_PREVIEW_COMPLETE for
java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336], processing state is READING_BODY
2009-11-11 15:29:21,007 DEBUG [ReadWriteDispatcherImpl-Thread-3]
IcapContextualHandler received serialization event SEND_PREVIEW_CONTINUE for
java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336]
2009-11-11 15:29:21,011 DEBUG [ReadWriteDispatcherImpl-Thread-3]
SelectableSocketEndpoint wrote 25 bytes out of 25 on
java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336]:
0000 49 43 41 50 2f 31 2e 30 20 31 30 30 20 43 6f 6e ICAP/1.0 100 Con
0010 74 69 6e 75 65 0d 0a 0d 0a tinue... .

2009-11-11 15:29:21,011 DEBUG [ReadWriteDispatcherImpl-Thread-3] WriteJob
doWrite() returning true
2009-11-11 15:29:21,011 DEBUG [ReadWriteDispatcherImpl-Thread-3]
IcapContextualHandler All data have been succesfully writen in foreground
mode on java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336]
2009-11-11 15:29:21,011 DEBUG [ReadWriteDispatcherImpl-Thread-3]
IcapContextualHandler received event REQUEST_ENCAP_HDR_RECEIVED for
java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336], processing state is READING_BODY
2009-11-11 15:29:21,011 DEBUG [ReadWriteDispatcherImpl-Thread-3]
IcapContextualHandler received event REQUEST_COMPLETE for
java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336], processing state is COMPLETE
2009-11-11 15:29:21,016 DEBUG [ReadWriteDispatcherImpl-Thread-3]
TTechProxyIcap IcapRespmod Response Headers :
Raw Message: HTTP/1.1 302 Moved Temporarily
HttpResponseStatus:302 HttpResponseMessage:Moved Temporarily
Content-Length:0
Expires:Thu, 19 Nov 1981 08:52:00 GMT
Location:/?SID=a4b6ebf5a8f24d56289602314afe90d2
Server:Apache/2.2.3 (Debian) DAV/2 SVN/1.4.2 mod_jk/1.2.18 mod_python/3.2.10
Python/2.4.4 mod_ssl/2.2.3 OpenSSL/0.9.8c mod_perl/2.0.2 Perl/v5.8.8
Pragma:no-cache
Cache-Control:no-store, no-cache, must-revalidate, post-check=0, pre-check=0
Date:Wed, 11 Nov 2009 13:24:15 GMT
Content-Type:text/html; charset=UTF-8

2009-11-11 15:29:21,016 DEBUG [ReadWriteDispatcherImpl-Thread-3]
IcapContextualHandler received serialization event SEND_BODY_COMPLETE for
java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336]
2009-11-11 15:29:21,018 DEBUG [ReadWriteDispatcherImpl-Thread-3]
SelectableSocketEndpoint wrote 544 bytes out of 544 on
java.nio.channels.SocketChannel[connected local=/127.0.0.1:1344
remote=/127.0.0.1:40336]:
0000 49 43 41 50 2f 31 2e 30 20 32 30 34 20 6f 6b 0d ICAP/1.0 204 ok.
0010 0a 4f 70 74 69 6f 6e 73 2d 54 54 4c 3a 20 33 36 .Options -TTL: 36
0020 30 30 30 0d 0a 45 6e 63 61 70 73 75 6c 61 74 65 000..Enc apsulate
0030 64 3a 20 72 65 73 2d 68 64 72 3d 30 2c 20 6e 75 d: res-h dr=0, nu
0040 6c 6c 2d 62 6f 64 79 3d 34 36 35 0d 0a 0d 0a ll-body= 465....
0050 48 54 54 50 2f 31 2e 31 20 33 30 32 20 4d 6f 76 HTTP/1.1 302 Mov
0060 65 64 20 54 65 6d 70 6f 72 61 72 69 6c 79 0d 0a ed Tempo rarily..
0070 44 61 74 65 3a 20 57 65 64 2c 20 31 31 20 4e 6f Date: We d, 11 No
0080 76 20 32 30 30 39 20 31 33 3a 32 34 3a 31 35 20 v 2009 1 3:24:15
0090 47 4d 54 0d 0a 53 65 72 76 65 72 3a 20 41 70 61 GMT..Ser ver: Apa
00a0 63 68 65 2f 32 2e 32 2e 33 20 28 44 65 62 69 61 che/2.2. 3 (Debia
00b0 6e 29 20 44 41 56 2f 32 20 53 56 4e 2f 31 2e 34 n) DAV/2 SVN/1.4
00c0 2e 32 20 6d 6f 64 5f 6a 6b 2f 31 2e 32 2e 31 38 .2 mod_j k/1.2.18
00d0 20 6d 6f 64 5f 70 79 74 68 6f 6e 2f 33 2e 32 2e mod_pyt hon/3.2.
00e0 31 30 20 50 79 74 68 6f 6e 2f 32 2e 34 2e 34 20 10 Pytho n/2.4.4
00f0 6d 6f 64 5f 73 73 6c 2f 32 2e 32 2e 33 20 4f 70 mod_ssl/ 2.2.3 Op
0100 65 6e 53 53 4c 2f 30 2e 39 2e 38 63 20 6d 6f 64 enSSL/0. 9.8c mod
0110 5f 70 65 72 6c 2f 32 2e 30 2e 32 20 50 65 72 6c _perl/2. 0.2 Perl
0120 2f 76 35 2e 38 2e 38 0d 0a 45 78 70 69 72 65 73 /v5.8.8. .Expires
0130 3a 20 54 68 75 2c 20 31 39 20 4e 6f 76 20 31 39 : Thu, 1 9 Nov 19
0140 38 31 20 30 38 3a 35 32 3a 30 30 20 47 4d 54 0d 81 08:52 :00 GMT.
0150 0a 43 61 63 68 65 2d 43 6f 6e 74 72 6f 6c 3a 20 .Cache-C ontrol:
0160 6e 6f 2d 73 74 6f 72 65 2c 20 6e 6f 2d 63 61 63 no-store , no-cac
0170 68 65 2c 20 6d 75 73 74 2d 72 65 76 61 6c 69 64 he, must -revalid
0180 61 74 65 2c 20 70 6f 73 74 2d 63 68 65 63 6b 3d ate, pos t-check=
0190 30 2c 20 70 72 65 2d 63 68 65 63 6b 3d 30 0d 0a 0, pre-c heck=0..
01a0 50 72 61 67 6d 61 3a 20 6e 6f 2d 63 61 63 68 65 Pragma: no-cache
01b0 0d 0a 4c 6f 63 61 74 69 6f 6e 3a 20 2f 3f 53 49 ..Locati on: /?SI
01c0 44 3d 61 34 62 36 65 62 66 35 61 38 66 32 34 64 D=a4b6eb f5a8f24d
01d0 35 36 32 38 39 36 30 32 33 31 34 61 66 65 39 30 56289602 314afe90
01e0 64 32 0d 0a 43 6f 6e 74 65 6e 74 2d 4c 65 6e 67 d2..Cont ent-Leng
01f0 74 68 3a 20 30 0d 0a 43 6f 6e 74 65 6e 74 2d 54 th: 0..C ontent-T
0200 79 70 65 3a 20 74 65 78 74 2f 68 74 6d 6c 3b 20 ype: tex t/html;
0210 63 68 61 72 73 65 74 3d 55 54 46 2d 38 0d 0a 0d charset= UTF-8...

My squid.conf is
===================
icap_enable on
icap_send_client_ip on
icap_preview_enable on
icap_preview_size 23
#icap_service service_1 reqmod_precache 0 icap://localhost:1344/echosimpre
#adaptation_service_set service_set_1 service_1
#adaptation_access service_set_1 allow all

#icap_service service_2 respmod_precache 0 icap://localhost:1344/echosimpre
#adaptation_service_set service_set_2 service_2
#adaptation_access service_set_2 allow all

-- 
View this message in context: http://old.nabble.com/Squid-icap-preview-problem-tp26286006p26302570.html
Sent from the Squid - Users mailing list archive at Nabble.com.
Received on Wed Nov 11 2009 - 14:55:48 MST

This archive was generated by hypermail 2.2.0 : Wed Nov 11 2009 - 12:00:03 MST