Тестирование логов: writer в буфер

Конструктор zerolog.New принимает io.Writer и не знает ничего про файлы и сеть — буфер подходит наравне с остальными. В тестах пишут logger := zerolog.New(&buf), и здесь важен именно указатель: метод Write объявлен на *bytes.Buffer и растит внутренний слайс, поэтому значением буфер в конструктор не подойдёт — компилятор напомнит сразу. Внутри New обычный writer заворачивается в LevelWriterAdapter, и логгер ставит себе порог TraceLevel: собственный порог никого не режет, а вот глобальный уровень по умолчанию равен DebugLevel — trace-записи без настройки до буфера не дойдут, но это уже раздел про глобальную подмену. Каждое событие уходит в буфер одной JSON-строкой с переводом строки на конце — так работают AppendEndMarker и AppendLineBreak в методе write события, и потому буфер после трёх вызовов Msg содержит три строки. Читается результат через buf.Bytes(); между подтестами буфер сбрасывается buf.Reset() — иначе в него доедут хвосты прошлых проверок, и очередь разбора собьётся. Нюанс конструктора: zerolog.New(nil) не паникует, а молча подставляет io.Discard — записи просто исчезнут. Если события пишут из горутин, буфер оборачивается в SyncWriter: сам bytes.Buffer под параллельными Write рвёт внутренний слайс, и это правило из урока про сублоггеры действует в тестах так же, как в проде.

Контракт ключей в записи фиксирован глобальными переменными zerolog: LevelFieldName равен level, MessageFieldName — message, ErrorFieldName — error. Поле level пишется у всех уровней, включая Trace: в newEvent уровня проверяется только условие level != NoLevel и непустое имя поля, поэтому trace-событие уезжает в буфер как level со значением trace — константа LevelTraceValue именно такова в globals.go. Не пишется уровень ровно в одном случае: события метода log.Log() создаются с уровнем NoLevel, и ключа level в их JSON нет вовсе. Событий Disabled не существует как записей: should() отсекает их до создания события — тест проверяет отсутствие строки, а не null-уровень. Сообщение — последний ключ строки: msg() дописывает его перед самым write, после всех полей цепочки. Порядок самих полей zerolog соблюдает в порядке добавления: сначала level, затем контекст из With, затем поля цепочки, в конце message. Но map[string]any этот порядок не сохраняет — раскладка по карте стирает след добавления, поэтому проверяйте по ключам, а не сравнением строки целиком; если порядок полей действительно нужен, читайте поток токенов json.Decoder.Token(). Разбор полей error и cause уже готов у вас из урока про ошибки — здесь он просто переехал в тест.

Один буфер за время теста накапливает столько строк, сколько событий прошло через пороги, и это меняет способ чтения. json.Unmarshal разбирает только первый объект и падает на втором с сообщением про недопустимый символ после верхнего значения — классическая ошибка при первом же переходе от одной записи к очереди. Для потока берётся json.NewDecoder(&buf): метод More() отвечает, есть ли следующий объект, Decode достаёт его в очередную карту, и цикл собирает слайс событий. Порядок событий при последовательном логировании детерминирован: каждый вызов Msg дописывает свою строку в буфер сразу, — сравнивайте очередь уровней или сообщений с ожидаемым списком. Альтернатива без json — bufio.Scanner: построчно читает буфер, а каждую строку вы отдаёте Unmarshal. Полезна и обратная проверка: после ожидаемого числа событий More() обязан вернуть false — так ловятся лишние события в конце ленты.

Код под тестом часто зовёт log.Info() напрямую из пакета github.com/rs/zerolog/log — то есть пишет через глобальный log.Logger. Его подменяют как любую глобальную переменную: old := log.Logger, затем log.Logger = zerolog.New(&buf) и defer-восстановление в конце теста — без него следующий тест пакета унаследует буфер и начнёт видеть чужие записи. Вторая ручка — zerolog.SetGlobalLevel: она меняет атомарную переменную gLevel, чьё нулевое значение равно DebugLevel, и trace-записи по умолчанию до буфера не доходят. Тест, проверяющий поле level у трассировки, поднимает планку SetGlobalLevel(zerolog.TraceLevel) и возвращает её defer-ом — восстановленное значение и есть дефолт DebugLevel. Та же механика — основа тестов конфигурации из урока про окружение: собрали логгер по переменным окружения, прогнали событие, проверили уровень в карте. Когда нужно посчитать события по уровням без JSON, берётся хук: интерфейс zerolog.Hook с методом Run(e *Event, level Level, message string) и адаптер HookFunc для функции. Хук срабатывает в момент Msg до записи в writer — собирайте уровень и сообщение из параметров, а не из буфера события: JSON в этот момент ещё не дописан. Логгер с io.Discard и хуком-счётчиком — тихий детектор шумных веток: ни одной строки в stdout, зато точные числа по уровням.

Проверка логов в тестах — фундамент, на который дальше ложатся метрики и трейсы: урок про Prometheus добавит счётчик рядом с событием, урок про трейсы — корреляцию записей одного запроса. Справочное закрепление: возьмите функцию с двумя ветками — успех и отказ — и напишите тест, который в одной очереди проверяет оба события: поля, уровни, отсутствие лишних записей. Затем сломайте контракт — уберите поле или смените уровень — и убедитесь, что тест падает с внятным сообщением, а не молча проходит. Если сам go test для вас новый инструмент, вернитесь к основам в курсе по основам Go: один тест на буфер стоит дешевле одной ночной пересборки инцидента.