builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-078 starttime: 1505304684.94 results: success (0) revision: be059eaafd1a908cc9a57f5b93a2f0f258c73f7a ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:24.946046) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:24.946938) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:24.947239) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:25.050057) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:25.050373) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=dac658600622fd96716c9acf000001b3-1505302147.882449-517250158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-13 05:11:25-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 17.3M=0.001s 2017-09-13 05:11:25 (17.3 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.139780 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:25.218973) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:25.222772) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=dac658600622fd96716c9acf000001b3-1505302147.882449-517250158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019784 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:25.276202) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:25.276566) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev be059eaafd1a908cc9a57f5b93a2f0f258c73f7a --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev be059eaafd1a908cc9a57f5b93a2f0f258c73f7a --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=dac658600622fd96716c9acf000001b3-1505302147.882449-517250158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-13 05:11:25,341 truncating revision to first 12 chars 2017-09-13 05:11:25,342 Setting DEBUG logging. 2017-09-13 05:11:25,342 attempt 1/10 2017-09-13 05:11:25,342 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/be059eaafd1a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-13 05:11:25,804 unpacking tar archive at: mozilla-beta-be059eaafd1a/testing/mozharness/ program finished with exit code 0 elapsedTime=0.720734 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:26.030531) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:26.030885) ========= script_repo_revision: be059eaafd1a908cc9a57f5b93a2f0f258c73f7a ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:26.031322) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:26.031637) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-13 05:11:26.045244) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2017-09-13 05:11:26.045606) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=dac658600622fd96716c9acf000001b3-1505302147.882449-517250158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:11:26 INFO - MultiFileLogger online at 20170913 05:11:26 in /builds/slave/test 05:11:26 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta-Non-PGO 05:11:26 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:11:26 INFO - {'append_to_log': False, 05:11:26 INFO - 'base_work_dir': '/builds/slave/test', 05:11:26 INFO - 'blob_upload_branch': 'Mozilla-Beta-Non-PGO', 05:11:26 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:11:26 INFO - 'branch': 'Mozilla-Beta-Non-PGO', 05:11:26 INFO - 'buildbot_json_path': 'buildprops.json', 05:11:26 INFO - 'code_coverage': False, 05:11:26 INFO - 'config_files': ('talos/linux_config.py',), 05:11:26 INFO - 'default_actions': ('clobber', 05:11:26 INFO - 'read-buildbot-config', 05:11:26 INFO - 'download-and-extract', 05:11:26 INFO - 'populate-webroot', 05:11:26 INFO - 'create-virtualenv', 05:11:26 INFO - 'install', 05:11:26 INFO - 'setup-mitmproxy', 05:11:26 INFO - 'run-tests'), 05:11:26 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:11:26 INFO - 'disable_ccov_upload': False, 05:11:26 INFO - 'download_minidump_stackwalk': True, 05:11:26 INFO - 'download_symbols': 'ondemand', 05:11:26 INFO - 'enable_stylo': False, 05:11:26 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:11:26 INFO - 'tooltool.py': '/tools/tooltool.py', 05:11:26 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:11:26 INFO - '/tools/misc-python/virtualenv.py')}, 05:11:26 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:11:26 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:11:26 INFO - 'gecko_profile': False, 05:11:26 INFO - 'gecko_profile_interval': 0, 05:11:26 INFO - 'installer_path': 'installer.exe', 05:11:26 INFO - 'log_level': 'info', 05:11:26 INFO - 'log_name': 'talos', 05:11:26 INFO - 'log_to_console': True, 05:11:26 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:11:26 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:11:26 INFO - 'opt_config_files': (), 05:11:26 INFO - 'pip_index': False, 05:11:26 INFO - 'suite': 'dromaeojs-e10s', 05:11:26 INFO - 'system_bits': '32', 05:11:26 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:11:26 INFO - 'title': 'talos-linux64-ix-078', 05:11:26 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:11:26 INFO - 'use_talos_json': True, 05:11:26 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:11:26 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:11:26 INFO - 'work_dir': 'build'} 05:11:26 INFO - [mozharness: 2017-09-13 12:11:26.198628Z] Running clobber step. 05:11:26 INFO - Running pre-action listener: _resource_record_pre_action 05:11:26 INFO - Running main action method: clobber 05:11:26 INFO - rmtree: /builds/slave/test/build 05:11:26 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:11:27 INFO - Running post-action listener: _resource_record_post_action 05:11:27 INFO - [mozharness: 2017-09-13 12:11:27.733369Z] Finished clobber step (success) 05:11:27 INFO - [mozharness: 2017-09-13 12:11:27.733472Z] Running read-buildbot-config step. 05:11:27 INFO - Running pre-action listener: _resource_record_pre_action 05:11:27 INFO - Running main action method: read_buildbot_config 05:11:27 INFO - Using buildbot properties: 05:11:27 INFO - { 05:11:27 INFO - "project": "", 05:11:27 INFO - "product": "firefox", 05:11:27 INFO - "who": "ffxbld@noreply.mozilla.org", 05:11:27 INFO - "installer_path": "public/build/target.tar.bz2", 05:11:27 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 05:11:27 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-beta", 05:11:27 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta talos dromaeojs-e10s", 05:11:27 INFO - "stage_platform": "linux64", 05:11:27 INFO - "basedir": "/builds/slave/test", 05:11:27 INFO - "buildnumber": 79, 05:11:27 INFO - "platform": "ubuntu64_hw", 05:11:27 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 05:11:27 INFO - "slavebuilddir": "test", 05:11:27 INFO - "taskId": "RZPHwcWgSa2ETAJxNe9nuw", 05:11:27 INFO - "branch": "mozilla-beta", 05:11:27 INFO - "script_repo_revision": "production", 05:11:27 INFO - "revision": "be059eaafd1a908cc9a57f5b93a2f0f258c73f7a", 05:11:27 INFO - "slavename": "talos-linux64-ix-078", 05:11:27 INFO - "repo_path": "releases/mozilla-beta" 05:11:27 INFO - } 05:11:27 INFO - Finding installer, test and symbols from parent task. 05:11:27 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RZPHwcWgSa2ETAJxNe9nuw'}, attempt #1 05:11:28 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RZPHwcWgSa2ETAJxNe9nuw'}, attempt #1 05:11:28 INFO - Task dependencies: PcHb8D8WQ7CpRTiLR8nJfQ 05:11:28 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ'}, attempt #1 05:11:29 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.tar.bz2 05:11:29 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.test_packages.json 05:11:29 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.crashreporter-symbols.zip 05:11:29 INFO - Running post-action listener: _resource_record_post_action 05:11:29 INFO - [mozharness: 2017-09-13 12:11:29.249737Z] Finished read-buildbot-config step (success) 05:11:29 INFO - [mozharness: 2017-09-13 12:11:29.249960Z] Running download-and-extract step. 05:11:29 INFO - Running pre-action listener: _resource_record_pre_action 05:11:29 INFO - Running main action method: download_and_extract 05:11:29 INFO - mkdir: /builds/slave/test/build/tests 05:11:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:29 INFO - trying https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.test_packages.json 05:11:29 INFO - Downloading https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 05:11:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 05:11:29 INFO - Downloaded 989 bytes. 05:11:29 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 05:11:29 INFO - Using the following test package requirements: 05:11:29 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 05:11:29 INFO - u'common': [u'target.common.tests.zip'], 05:11:29 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 05:11:29 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 05:11:29 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 05:11:29 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 05:11:29 INFO - u'mozbase': [u'target.common.tests.zip'], 05:11:29 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 05:11:29 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 05:11:29 INFO - u'web-platform': [u'target.common.tests.zip', 05:11:29 INFO - u'target.web-platform.tests.tar.gz'], 05:11:29 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 05:11:29 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 05:11:29 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.common.tests.zip 05:11:29 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 05:11:29 INFO - Fetch https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.common.tests.zip into memory 05:11:32 INFO - Content-Length response header: 72853100 05:11:32 INFO - Bytes received: 72853100 05:11:43 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.talos.tests.zip 05:11:43 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 05:11:43 INFO - Fetch https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.talos.tests.zip into memory 05:11:44 INFO - Content-Length response header: 14496472 05:11:44 INFO - Bytes received: 14496472 05:11:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:44 INFO - trying https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.tar.bz2 05:11:44 INFO - Downloading https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 05:11:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 05:11:47 INFO - Downloaded 54101937 bytes. 05:11:47 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.tar.bz2 05:11:47 INFO - mkdir: /builds/slave/test/properties 05:11:47 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:11:47 INFO - Writing to file /builds/slave/test/properties/build_url 05:11:47 INFO - Contents: 05:11:47 INFO - build_url:https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.tar.bz2 05:11:47 INFO - Running post-action listener: _resource_record_post_action 05:11:47 INFO - Running post-action listener: set_extra_try_arguments 05:11:47 INFO - [mozharness: 2017-09-13 12:11:47.323757Z] Finished download-and-extract step (success) 05:11:47 INFO - [mozharness: 2017-09-13 12:11:47.323882Z] Running populate-webroot step. 05:11:47 INFO - Running pre-action listener: _resource_record_pre_action 05:11:47 INFO - Running main action method: populate_webroot 05:11:47 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:11:47 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:11:47 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 05:11:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:11:47 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 05:11:47 INFO - 'tests': ['damp', 'tps']}, 05:11:47 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:11:47 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 05:11:47 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 05:11:47 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 05:11:47 INFO - 'other-e10s': {'tests': ['a11yr', 05:11:47 INFO - 'ts_paint', 05:11:47 INFO - 'tpaint', 05:11:47 INFO - 'sessionrestore', 05:11:47 INFO - 'sessionrestore_many_windows', 05:11:47 INFO - 'sessionrestore_no_auto_restore', 05:11:47 INFO - 'tabpaint']}, 05:11:47 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 05:11:47 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 05:11:47 INFO - 'quantum-pageload-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 05:11:47 INFO - 'talos_options': ['--mitmproxy', 05:11:47 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 05:11:47 INFO - '--firstNonBlankPaint'], 05:11:47 INFO - 'tests': ['quantum_pageload_google', 05:11:47 INFO - 'quantum_pageload_youtube', 05:11:47 INFO - 'quantum_pageload_amazon', 05:11:47 INFO - 'quantum_pageload_facebook']}, 05:11:47 INFO - 'quantum-pageload-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 05:11:47 INFO - 'talos_options': ['--stylo', 05:11:47 INFO - '--mitmproxy', 05:11:47 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 05:11:47 INFO - '--firstNonBlankPaint'], 05:11:47 INFO - 'tests': ['quantum_pageload_google', 05:11:47 INFO - 'quantum_pageload_youtube', 05:11:47 INFO - 'quantum_pageload_amazon', 05:11:47 INFO - 'quantum_pageload_facebook']}, 05:11:47 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:11:47 INFO - 'tsvgr_opacity', 05:11:47 INFO - 'tart', 05:11:47 INFO - 'tscrollx', 05:11:47 INFO - 'cart', 05:11:47 INFO - 'tsvg_static']}, 05:11:47 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 05:11:47 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 05:11:47 INFO - 'talos_options': ['--stylo', 05:11:47 INFO - '--stylo-threads=1', 05:11:47 INFO - '--mitmproxy', 05:11:47 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 05:11:47 INFO - '--firstNonBlankPaint'], 05:11:47 INFO - 'tests': ['tp6_google', 05:11:47 INFO - 'tp6_youtube', 05:11:47 INFO - 'tp6_amazon', 05:11:47 INFO - 'tp6_facebook']}, 05:11:47 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 05:11:47 INFO - 'talos_options': ['--xperf_path', 05:11:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:11:47 INFO - 'tests': ['tp5n']}}} 05:11:47 INFO - Running post-action listener: _resource_record_post_action 05:11:47 INFO - [mozharness: 2017-09-13 12:11:47.333840Z] Finished populate-webroot step (success) 05:11:47 INFO - [mozharness: 2017-09-13 12:11:47.333931Z] Running create-virtualenv step. 05:11:47 INFO - Running pre-action listener: _resource_record_pre_action 05:11:47 INFO - Running main action method: create_virtualenv 05:11:47 INFO - Creating virtualenv /builds/slave/test/build/venv 05:11:47 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 05:11:47 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:11:47 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 05:11:47 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:11:47 INFO - Using real prefix '/usr' 05:11:47 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:11:47 INFO - Installing distribute.............................................................................................................................................................................................done. 05:11:49 INFO - Installing pip.................done. 05:11:49 INFO - Return code: 0 05:11:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 05:11:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 05:11:50 INFO - Reading from file tmpfile_stdout 05:11:50 INFO - Output received: 05:11:50 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 05:11:50 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:11:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:11:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:11:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xa121f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xbdea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd81eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:11:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 05:11:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 05:11:50 INFO - Using env: {'DISPLAY': ':0', 05:11:50 INFO - 'HOME': '/home/cltbld', 05:11:50 INFO - 'LANG': 'en_US.UTF-8', 05:11:50 INFO - 'LANGUAGE': 'en_US:en', 05:11:50 INFO - 'LOGNAME': 'cltbld', 05:11:50 INFO - 'MAIL': '/var/mail/cltbld', 05:11:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:11:50 INFO - 'MOZ_NO_REMOTE': '1', 05:11:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:11:50 INFO - 'NO_EM_RESTART': '1', 05:11:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:11:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:11:50 INFO - 'PWD': '/builds/slave/test', 05:11:50 INFO - 'SHELL': '/bin/bash', 05:11:50 INFO - 'SHLVL': '1', 05:11:50 INFO - 'TERM': 'linux', 05:11:50 INFO - 'TMOUT': '86400', 05:11:50 INFO - 'USER': 'cltbld', 05:11:50 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:11:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:11:50 INFO - '_': '/tools/buildbot/bin/python'} 05:11:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:11:50 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 05:11:50 INFO - Cleaning up... 05:11:50 INFO - Return code: 0 05:11:50 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 05:11:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:11:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:11:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xa121f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xbdea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd81eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:11:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 05:11:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 05:11:50 INFO - Using env: {'DISPLAY': ':0', 05:11:50 INFO - 'HOME': '/home/cltbld', 05:11:50 INFO - 'LANG': 'en_US.UTF-8', 05:11:50 INFO - 'LANGUAGE': 'en_US:en', 05:11:50 INFO - 'LOGNAME': 'cltbld', 05:11:50 INFO - 'MAIL': '/var/mail/cltbld', 05:11:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:11:50 INFO - 'MOZ_NO_REMOTE': '1', 05:11:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:11:50 INFO - 'NO_EM_RESTART': '1', 05:11:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:11:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:11:50 INFO - 'PWD': '/builds/slave/test', 05:11:50 INFO - 'SHELL': '/bin/bash', 05:11:50 INFO - 'SHLVL': '1', 05:11:50 INFO - 'TERM': 'linux', 05:11:50 INFO - 'TMOUT': '86400', 05:11:50 INFO - 'USER': 'cltbld', 05:11:50 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:11:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:11:50 INFO - '_': '/tools/buildbot/bin/python'} 05:11:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:11:50 INFO - Downloading/unpacking psutil>=3.1.1 05:11:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:11:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:11:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:11:51 INFO - Installing collected packages: psutil 05:11:51 INFO - Running setup.py install for psutil 05:11:51 INFO - building 'psutil._psutil_linux' extension 05:11:51 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 05:11:52 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 05:11:52 INFO - building 'psutil._psutil_posix' extension 05:11:52 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 05:11:52 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 05:11:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:11:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:11:54 INFO - Successfully installed psutil 05:11:54 INFO - Cleaning up... 05:11:54 INFO - Return code: 0 05:11:54 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 05:11:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:11:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:11:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xa121f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xbdea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd81eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:11:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 05:11:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 05:11:54 INFO - Using env: {'DISPLAY': ':0', 05:11:54 INFO - 'HOME': '/home/cltbld', 05:11:54 INFO - 'LANG': 'en_US.UTF-8', 05:11:54 INFO - 'LANGUAGE': 'en_US:en', 05:11:54 INFO - 'LOGNAME': 'cltbld', 05:11:54 INFO - 'MAIL': '/var/mail/cltbld', 05:11:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:11:54 INFO - 'MOZ_NO_REMOTE': '1', 05:11:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:11:54 INFO - 'NO_EM_RESTART': '1', 05:11:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:11:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:11:54 INFO - 'PWD': '/builds/slave/test', 05:11:54 INFO - 'SHELL': '/bin/bash', 05:11:54 INFO - 'SHLVL': '1', 05:11:54 INFO - 'TERM': 'linux', 05:11:54 INFO - 'TMOUT': '86400', 05:11:54 INFO - 'USER': 'cltbld', 05:11:54 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:11:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:11:54 INFO - '_': '/tools/buildbot/bin/python'} 05:11:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:11:55 INFO - Downloading/unpacking mozsystemmonitor==0.3 05:11:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:56 INFO - Downloading mozsystemmonitor-0.3.tar.gz 05:11:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:11:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 05:11:56 INFO - Installing collected packages: mozsystemmonitor 05:11:56 INFO - Running setup.py install for mozsystemmonitor 05:11:56 INFO - Successfully installed mozsystemmonitor 05:11:56 INFO - Cleaning up... 05:11:56 INFO - Return code: 0 05:11:56 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 05:11:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:11:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:11:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xa121f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xbdea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd81eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:11:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 05:11:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 05:11:56 INFO - Using env: {'DISPLAY': ':0', 05:11:56 INFO - 'HOME': '/home/cltbld', 05:11:56 INFO - 'LANG': 'en_US.UTF-8', 05:11:56 INFO - 'LANGUAGE': 'en_US:en', 05:11:56 INFO - 'LOGNAME': 'cltbld', 05:11:56 INFO - 'MAIL': '/var/mail/cltbld', 05:11:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:11:56 INFO - 'MOZ_NO_REMOTE': '1', 05:11:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:11:56 INFO - 'NO_EM_RESTART': '1', 05:11:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:11:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:11:56 INFO - 'PWD': '/builds/slave/test', 05:11:56 INFO - 'SHELL': '/bin/bash', 05:11:56 INFO - 'SHLVL': '1', 05:11:56 INFO - 'TERM': 'linux', 05:11:56 INFO - 'TMOUT': '86400', 05:11:56 INFO - 'USER': 'cltbld', 05:11:56 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:11:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:11:56 INFO - '_': '/tools/buildbot/bin/python'} 05:11:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:11:56 INFO - Downloading/unpacking jsonschema==2.5.1 05:11:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:57 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:11:57 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 05:11:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:57 INFO - Downloading functools32-3.2.3-2.tar.gz 05:11:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:11:57 INFO - warning: no files found matching '*.txt' 05:11:57 INFO - no previously-included directories found matching 'build' 05:11:57 INFO - no previously-included directories found matching 'dist' 05:11:57 INFO - no previously-included directories found matching '.git*' 05:11:57 INFO - Installing collected packages: jsonschema, functools32 05:11:57 INFO - Running setup.py install for functools32 05:11:57 INFO - warning: no files found matching '*.txt' 05:11:57 INFO - no previously-included directories found matching 'build' 05:11:57 INFO - no previously-included directories found matching 'dist' 05:11:57 INFO - no previously-included directories found matching '.git*' 05:11:57 INFO - Successfully installed jsonschema functools32 05:11:57 INFO - Cleaning up... 05:11:57 INFO - Return code: 0 05:11:57 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 05:11:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:11:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:11:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xa121f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xbdea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd81eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:11:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 05:11:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 05:11:58 INFO - Using env: {'DISPLAY': ':0', 05:11:58 INFO - 'HOME': '/home/cltbld', 05:11:58 INFO - 'LANG': 'en_US.UTF-8', 05:11:58 INFO - 'LANGUAGE': 'en_US:en', 05:11:58 INFO - 'LOGNAME': 'cltbld', 05:11:58 INFO - 'MAIL': '/var/mail/cltbld', 05:11:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:11:58 INFO - 'MOZ_NO_REMOTE': '1', 05:11:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:11:58 INFO - 'NO_EM_RESTART': '1', 05:11:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:11:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:11:58 INFO - 'PWD': '/builds/slave/test', 05:11:58 INFO - 'SHELL': '/bin/bash', 05:11:58 INFO - 'SHLVL': '1', 05:11:58 INFO - 'TERM': 'linux', 05:11:58 INFO - 'TMOUT': '86400', 05:11:58 INFO - 'USER': 'cltbld', 05:11:58 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:11:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:11:58 INFO - '_': '/tools/buildbot/bin/python'} 05:11:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:11:58 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 05:11:58 INFO - Cleaning up... 05:11:58 INFO - Return code: 0 05:11:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:11:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:11:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:11:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:11:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xa121f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xbdea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd81eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:11:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 05:11:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 05:11:58 INFO - Using env: {'DISPLAY': ':0', 05:11:58 INFO - 'HOME': '/home/cltbld', 05:11:58 INFO - 'LANG': 'en_US.UTF-8', 05:11:58 INFO - 'LANGUAGE': 'en_US:en', 05:11:58 INFO - 'LOGNAME': 'cltbld', 05:11:58 INFO - 'MAIL': '/var/mail/cltbld', 05:11:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:11:58 INFO - 'MOZ_NO_REMOTE': '1', 05:11:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:11:58 INFO - 'NO_EM_RESTART': '1', 05:11:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:11:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:11:58 INFO - 'PWD': '/builds/slave/test', 05:11:58 INFO - 'SHELL': '/bin/bash', 05:11:58 INFO - 'SHLVL': '1', 05:11:58 INFO - 'TERM': 'linux', 05:11:58 INFO - 'TMOUT': '86400', 05:11:58 INFO - 'USER': 'cltbld', 05:11:58 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:11:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:11:58 INFO - '_': '/tools/buildbot/bin/python'} 05:11:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:11:58 INFO - Downloading/unpacking blobuploader==1.2.4 05:11:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:59 INFO - Downloading blobuploader-1.2.4.tar.gz 05:11:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:11:59 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:11:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:11:59 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:11:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:11:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:11:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:00 INFO - Downloading docopt-0.6.1.tar.gz 05:12:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:12:00 INFO - Installing collected packages: blobuploader, requests, docopt 05:12:00 INFO - Running setup.py install for blobuploader 05:12:00 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:12:00 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:12:00 INFO - Running setup.py install for requests 05:12:00 INFO - Running setup.py install for docopt 05:12:00 INFO - Successfully installed blobuploader requests docopt 05:12:00 INFO - Cleaning up... 05:12:00 INFO - Return code: 0 05:12:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:12:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xa121f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xbdea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd81eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:12:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:12:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:12:00 INFO - Using env: {'DISPLAY': ':0', 05:12:00 INFO - 'HOME': '/home/cltbld', 05:12:00 INFO - 'LANG': 'en_US.UTF-8', 05:12:00 INFO - 'LANGUAGE': 'en_US:en', 05:12:00 INFO - 'LOGNAME': 'cltbld', 05:12:00 INFO - 'MAIL': '/var/mail/cltbld', 05:12:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:00 INFO - 'MOZ_NO_REMOTE': '1', 05:12:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:12:00 INFO - 'NO_EM_RESTART': '1', 05:12:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:12:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:00 INFO - 'PWD': '/builds/slave/test', 05:12:00 INFO - 'SHELL': '/bin/bash', 05:12:00 INFO - 'SHLVL': '1', 05:12:00 INFO - 'TERM': 'linux', 05:12:00 INFO - 'TMOUT': '86400', 05:12:00 INFO - 'USER': 'cltbld', 05:12:00 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:12:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:00 INFO - '_': '/tools/buildbot/bin/python'} 05:12:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:12:00 INFO - Running setup.py (path:/tmp/pip-weBXqR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:12:01 INFO - Running setup.py (path:/tmp/pip-WCTffR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:12:01 INFO - Running setup.py (path:/tmp/pip-ipe9pv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:12:01 INFO - Running setup.py (path:/tmp/pip-37z6lc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:12:01 INFO - Running setup.py (path:/tmp/pip-hbmTt_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:12:01 INFO - Running setup.py (path:/tmp/pip-mraEWR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:12:01 INFO - Running setup.py (path:/tmp/pip-Z8v8NL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:12:01 INFO - Running setup.py (path:/tmp/pip-ys8n3j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:12:01 INFO - Running setup.py (path:/tmp/pip-bl33wx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:12:01 INFO - Running setup.py (path:/tmp/pip-X8uks_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:12:01 INFO - Running setup.py (path:/tmp/pip-vfXfdM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:12:01 INFO - Running setup.py (path:/tmp/pip-MtQfQj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:12:01 INFO - Running setup.py (path:/tmp/pip-VzFddq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:12:01 INFO - Running setup.py (path:/tmp/pip-2nbvo6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:12:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:12:01 INFO - Running setup.py (path:/tmp/pip-mbArgI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:12:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:12:02 INFO - Running setup.py (path:/tmp/pip-mPEcYe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:12:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:12:02 INFO - Running setup.py (path:/tmp/pip-nKtM3b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:12:02 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:12:02 INFO - Running setup.py install for manifestparser 05:12:02 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:12:02 INFO - Running setup.py install for mozcrash 05:12:02 INFO - Running setup.py install for mozdebug 05:12:02 INFO - Running setup.py install for mozdevice 05:12:02 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:12:02 INFO - Running setup.py install for mozfile 05:12:02 INFO - Running setup.py install for mozhttpd 05:12:02 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:12:02 INFO - Running setup.py install for mozinfo 05:12:02 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:12:02 INFO - Running setup.py install for mozInstall 05:12:02 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:12:02 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:12:02 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:12:02 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:12:03 INFO - Running setup.py install for mozleak 05:12:03 INFO - Running setup.py install for mozlog 05:12:03 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:12:03 INFO - Running setup.py install for moznetwork 05:12:03 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:12:03 INFO - Running setup.py install for mozprocess 05:12:03 INFO - Running setup.py install for mozprofile 05:12:03 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:12:03 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:12:03 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:12:03 INFO - Running setup.py install for mozrunner 05:12:03 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:12:03 INFO - Running setup.py install for mozscreenshot 05:12:03 INFO - Running setup.py install for moztest 05:12:03 INFO - Running setup.py install for mozversion 05:12:03 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:12:03 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:12:03 INFO - Cleaning up... 05:12:03 INFO - Return code: 0 05:12:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:12:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xa121f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xbdea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd81eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:12:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:12:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:12:04 INFO - Using env: {'DISPLAY': ':0', 05:12:04 INFO - 'HOME': '/home/cltbld', 05:12:04 INFO - 'LANG': 'en_US.UTF-8', 05:12:04 INFO - 'LANGUAGE': 'en_US:en', 05:12:04 INFO - 'LOGNAME': 'cltbld', 05:12:04 INFO - 'MAIL': '/var/mail/cltbld', 05:12:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:04 INFO - 'MOZ_NO_REMOTE': '1', 05:12:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:12:04 INFO - 'NO_EM_RESTART': '1', 05:12:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:12:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:04 INFO - 'PWD': '/builds/slave/test', 05:12:04 INFO - 'SHELL': '/bin/bash', 05:12:04 INFO - 'SHLVL': '1', 05:12:04 INFO - 'TERM': 'linux', 05:12:04 INFO - 'TMOUT': '86400', 05:12:04 INFO - 'USER': 'cltbld', 05:12:04 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:12:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:04 INFO - '_': '/tools/buildbot/bin/python'} 05:12:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:12:04 INFO - Running setup.py (path:/tmp/pip-p8W6dD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:12:04 INFO - Running setup.py (path:/tmp/pip-fuw6Rl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:12:04 INFO - Running setup.py (path:/tmp/pip-Ql2sqH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:12:04 INFO - Running setup.py (path:/tmp/pip-ol37zj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:12:04 INFO - Running setup.py (path:/tmp/pip-uKHXdj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:12:04 INFO - Running setup.py (path:/tmp/pip-LEWQCS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:12:04 INFO - Running setup.py (path:/tmp/pip-_XSRJa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:12:04 INFO - Running setup.py (path:/tmp/pip-_aIudg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:12:04 INFO - Running setup.py (path:/tmp/pip-xp4s7i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:12:04 INFO - Running setup.py (path:/tmp/pip-OZWfGx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:12:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:12:04 INFO - Running setup.py (path:/tmp/pip-Otn0hk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 05:12:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:12:05 INFO - Running setup.py (path:/tmp/pip-bC97WS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 05:12:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:12:05 INFO - Running setup.py (path:/tmp/pip-yvjouc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 05:12:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:12:05 INFO - Running setup.py (path:/tmp/pip-yv4XeE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 05:12:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:12:05 INFO - Running setup.py (path:/tmp/pip-y9MUzq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 05:12:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:12:05 INFO - Running setup.py (path:/tmp/pip-8imDRr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 05:12:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:12:05 INFO - Running setup.py (path:/tmp/pip-s_DGPt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 05:12:05 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:12:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:06 INFO - Downloading blessings-1.6.tar.gz 05:12:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:12:06 INFO - Installing collected packages: blessings 05:12:06 INFO - Running setup.py install for blessings 05:12:06 INFO - Successfully installed blessings 05:12:06 INFO - Cleaning up... 05:12:06 INFO - Return code: 0 05:12:06 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:12:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:12:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:12:07 INFO - Reading from file tmpfile_stdout 05:12:07 INFO - Current package versions: 05:12:07 INFO - argparse == 1.2.1 05:12:07 INFO - blessings == 1.6 05:12:07 INFO - blobuploader == 1.2.4 05:12:07 INFO - docopt == 0.6.1 05:12:07 INFO - functools32 == 3.2.3-2 05:12:07 INFO - jsonschema == 2.5.1 05:12:07 INFO - manifestparser == 1.1 05:12:07 INFO - mozInstall == 1.13 05:12:07 INFO - mozcrash == 1.0 05:12:07 INFO - mozdebug == 0.1 05:12:07 INFO - mozdevice == 0.51 05:12:07 INFO - mozfile == 1.2 05:12:07 INFO - mozhttpd == 0.7 05:12:07 INFO - mozinfo == 0.10 05:12:07 INFO - mozleak == 0.1 05:12:07 INFO - mozlog == 3.5 05:12:07 INFO - moznetwork == 0.27 05:12:07 INFO - mozprocess == 0.25 05:12:07 INFO - mozprofile == 0.28 05:12:07 INFO - mozrunner == 6.13 05:12:07 INFO - mozscreenshot == 0.1 05:12:07 INFO - mozsystemmonitor == 0.3 05:12:07 INFO - moztest == 0.8 05:12:07 INFO - mozversion == 1.4 05:12:07 INFO - psutil == 3.1.1 05:12:07 INFO - requests == 1.2.3 05:12:07 INFO - wsgiref == 0.1.2 05:12:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:12:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xa121f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xbdea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd81eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:12:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 05:12:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:12:07 INFO - Using env: {'DISPLAY': ':0', 05:12:07 INFO - 'HOME': '/home/cltbld', 05:12:07 INFO - 'LANG': 'en_US.UTF-8', 05:12:07 INFO - 'LANGUAGE': 'en_US:en', 05:12:07 INFO - 'LOGNAME': 'cltbld', 05:12:07 INFO - 'MAIL': '/var/mail/cltbld', 05:12:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:07 INFO - 'MOZ_NO_REMOTE': '1', 05:12:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:12:07 INFO - 'NO_EM_RESTART': '1', 05:12:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:12:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:07 INFO - 'PWD': '/builds/slave/test', 05:12:07 INFO - 'SHELL': '/bin/bash', 05:12:07 INFO - 'SHLVL': '1', 05:12:07 INFO - 'TERM': 'linux', 05:12:07 INFO - 'TMOUT': '86400', 05:12:07 INFO - 'USER': 'cltbld', 05:12:07 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:12:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:07 INFO - '_': '/tools/buildbot/bin/python'} 05:12:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:12:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 05:12:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 05:12:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:12:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 05:12:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 05:12:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 05:12:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 05:12:07 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 05:12:07 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 05:12:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:12:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:12:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 05:12:08 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:12:08 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:12:08 INFO - Installing collected packages: simplejson 05:12:08 INFO - Running setup.py install for simplejson 05:12:08 INFO - building 'simplejson._speedups' extension 05:12:08 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 05:12:09 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 05:12:09 INFO - Successfully installed simplejson 05:12:09 INFO - Cleaning up... 05:12:09 INFO - Return code: 0 05:12:09 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:12:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:12:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:12:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xa121f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xbdea80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd81eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:12:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 05:12:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 05:12:09 INFO - Using env: {'DISPLAY': ':0', 05:12:09 INFO - 'HOME': '/home/cltbld', 05:12:09 INFO - 'LANG': 'en_US.UTF-8', 05:12:09 INFO - 'LANGUAGE': 'en_US:en', 05:12:09 INFO - 'LOGNAME': 'cltbld', 05:12:09 INFO - 'MAIL': '/var/mail/cltbld', 05:12:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:09 INFO - 'MOZ_NO_REMOTE': '1', 05:12:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:12:09 INFO - 'NO_EM_RESTART': '1', 05:12:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:12:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:09 INFO - 'PWD': '/builds/slave/test', 05:12:09 INFO - 'SHELL': '/bin/bash', 05:12:09 INFO - 'SHLVL': '1', 05:12:09 INFO - 'TERM': 'linux', 05:12:09 INFO - 'TMOUT': '86400', 05:12:09 INFO - 'USER': 'cltbld', 05:12:09 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:12:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:09 INFO - '_': '/tools/buildbot/bin/python'} 05:12:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:12:09 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 05:12:09 INFO - Cleaning up... 05:12:09 INFO - Return code: 0 05:12:09 INFO - Running post-action listener: _resource_record_post_action 05:12:09 INFO - Running post-action listener: _start_resource_monitoring 05:12:09 INFO - Starting resource monitoring. 05:12:09 INFO - [mozharness: 2017-09-13 12:12:09.747278Z] Finished create-virtualenv step (success) 05:12:09 INFO - [mozharness: 2017-09-13 12:12:09.747787Z] Running install step. 05:12:09 INFO - Running pre-action listener: _resource_record_pre_action 05:12:09 INFO - Running main action method: install 05:12:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:12:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:12:09 INFO - Reading from file tmpfile_stdout 05:12:09 INFO - Detecting whether we're running mozinstall >=1.0... 05:12:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:12:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:12:10 INFO - Reading from file tmpfile_stdout 05:12:10 INFO - Output received: 05:12:10 INFO - Usage: mozinstall [options] installer 05:12:10 INFO - Options: 05:12:10 INFO - -h, --help show this help message and exit 05:12:10 INFO - -d DEST, --destination=DEST 05:12:10 INFO - Directory to install application into. [default: 05:12:10 INFO - "/builds/slave/test"] 05:12:10 INFO - --app=APP Application being installed. [default: firefox] 05:12:10 INFO - mkdir: /builds/slave/test/build/application 05:12:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:12:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 05:12:24 INFO - Reading from file tmpfile_stdout 05:12:24 INFO - Output received: 05:12:24 INFO - /builds/slave/test/build/application/firefox/firefox 05:12:24 INFO - Running post-action listener: _resource_record_post_action 05:12:24 INFO - [mozharness: 2017-09-13 12:12:24.836581Z] Finished install step (success) 05:12:24 INFO - [mozharness: 2017-09-13 12:12:24.836735Z] Running setup-mitmproxy step. 05:12:24 INFO - Running pre-action listener: _resource_record_pre_action 05:12:24 INFO - Running main action method: setup_mitmproxy 05:12:24 INFO - Skipping: mitmproxy is not required 05:12:24 INFO - Running post-action listener: _resource_record_post_action 05:12:24 INFO - [mozharness: 2017-09-13 12:12:24.838276Z] Finished setup-mitmproxy step (success) 05:12:24 INFO - [mozharness: 2017-09-13 12:12:24.838592Z] Running run-tests step. 05:12:24 INFO - Running pre-action listener: _resource_record_pre_action 05:12:24 INFO - Running pre-action listener: _set_gcov_prefix 05:12:24 INFO - Running main action method: run_tests 05:12:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:12:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:12:24 INFO - Python 2.7.3 05:12:24 INFO - Return code: 0 05:12:24 INFO - grabbing minidump binary from tooltool 05:12:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:12:24 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7f050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7ff50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd803e0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:12:24 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 05:12:24 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 05:12:24 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 05:12:24 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:12:24 INFO - Return code: 0 05:12:24 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:12:24 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:12:24 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:12:24 INFO - ENV: RUST_BACKTRACE is now 1 05:12:24 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:12:24 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:12:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-078', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 05:12:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-078 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 05:12:24 INFO - Using env: {'DISPLAY': ':0', 05:12:24 INFO - 'HOME': '/home/cltbld', 05:12:24 INFO - 'LANG': 'en_US.UTF-8', 05:12:24 INFO - 'LANGUAGE': 'en_US:en', 05:12:24 INFO - 'LOGNAME': 'cltbld', 05:12:24 INFO - 'MAIL': '/var/mail/cltbld', 05:12:24 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:12:24 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:12:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:12:24 INFO - 'MOZ_NO_REMOTE': '1', 05:12:24 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:12:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:12:24 INFO - 'NO_EM_RESTART': '1', 05:12:24 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:12:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:12:24 INFO - 'PWD': '/builds/slave/test', 05:12:24 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:12:24 INFO - 'RUST_BACKTRACE': '1', 05:12:24 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 05:12:24 INFO - 'SHELL': '/bin/bash', 05:12:24 INFO - 'SHLVL': '1', 05:12:24 INFO - 'TERM': 'linux', 05:12:24 INFO - 'TMOUT': '86400', 05:12:24 INFO - 'USER': 'cltbld', 05:12:24 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1505302147.882449-517250158', 05:12:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:12:24 INFO - '_': '/tools/buildbot/bin/python'} 05:12:24 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-078', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 05:12:25 INFO - mozversion application_buildid: 20170913110023 05:12:25 INFO - mozversion application_changeset: be059eaafd1a908cc9a57f5b93a2f0f258c73f7a 05:12:25 INFO - mozversion application_display_name: Firefox 05:12:25 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:12:25 INFO - mozversion application_name: Firefox 05:12:25 INFO - mozversion application_remotingname: firefox 05:12:25 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 05:12:25 INFO - mozversion application_vendor: Mozilla 05:12:25 INFO - mozversion application_version: 56.0 05:12:25 INFO - mozversion platform_buildid: 20170913110023 05:12:25 INFO - mozversion platform_changeset: be059eaafd1a908cc9a57f5b93a2f0f258c73f7a 05:12:25 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 05:12:25 INFO - mozversion platform_version: 56.0 05:12:25 INFO - using testdate: 1505304745 05:12:25 INFO - actual date: 1505304745 05:12:25 INFO - starting webserver on 'localhost:53277' 05:12:25 INFO - SUITE-START | Running 2 tests 05:12:25 INFO - TEST-START | dromaeo_css 05:12:25 INFO - Initialising browser for dromaeo_css test... 05:12:25 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:53277/getInfo.html -profile /tmp/tmp8PnVKB/profile 05:12:25 INFO - TEST-INFO | started process 25268 (/builds/slave/test/build/application/firefox/firefox http://localhost:53277/getInfo.html) 05:12:30 INFO - TEST-INFO | 25268: exit 0 05:12:30 INFO - Browser initialized. 05:12:30 INFO - Running cycle 1/1 for dromaeo_css test... 05:12:30 INFO - TEST-INFO | started process 25429 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp8PnVKB/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 05:12:41 INFO - PID 25429 | RSS: Main: 152342528 05:12:41 INFO - PID 25429 | 05:15:39 INFO - PID 25429 | Cycle 1(1): loaded http://localhost:53277/tests/dromaeo/cssquery-dojo.html (next: http://localhost:53277/tests/dromaeo/cssquery-ext.html) 05:15:40 INFO - PID 25429 | RSS: Main: 161120256 05:15:40 INFO - PID 25429 | 05:18:42 INFO - PID 25429 | Cycle 1(1): loaded http://localhost:53277/tests/dromaeo/cssquery-ext.html (next: http://localhost:53277/tests/dromaeo/cssquery-jquery.html) 05:18:42 INFO - PID 25429 | RSS: Main: 158158848 05:18:42 INFO - PID 25429 | 05:21:44 INFO - PID 25429 | Cycle 1(1): loaded http://localhost:53277/tests/dromaeo/cssquery-jquery.html (next: http://localhost:53277/tests/dromaeo/cssquery-mootools.html) 05:21:45 INFO - PID 25429 | RSS: Main: 159780864 05:21:45 INFO - PID 25429 | 05:24:46 INFO - PID 25429 | Cycle 1(1): loaded http://localhost:53277/tests/dromaeo/cssquery-mootools.html (next: http://localhost:53277/tests/dromaeo/cssquery-prototype.html) 05:24:47 INFO - PID 25429 | RSS: Main: 159911936 05:24:47 INFO - PID 25429 | 05:27:50 INFO - PID 25429 | Cycle 1(1): loaded http://localhost:53277/tests/dromaeo/cssquery-prototype.html (next: http://localhost:53277/tests/dromaeo/cssquery-yui.html) 05:27:51 INFO - PID 25429 | RSS: Main: 161959936 05:27:51 INFO - PID 25429 | 05:30:52 INFO - PID 25429 | Cycle 1(1): loaded http://localhost:53277/tests/dromaeo/cssquery-yui.html (next: http://localhost:53277/tests/dromaeo/cssquery-dojo.html) 05:30:52 INFO - PID 25429 | RSS: Main: 164622336 05:30:52 INFO - PID 25429 | 05:30:52 INFO - PID 25429 | __start_tp_report 05:30:52 INFO - PID 25429 | _x_x_mozilla_page_load 05:30:52 INFO - PID 25429 | _x_x_mozilla_page_load_details 05:30:52 INFO - PID 25429 | |i|pagename|runs| 05:30:52 INFO - PID 25429 | |0;dojo.html;3598.15443370808;3627.709783217343;3628.437592173213;3630.3283892479885;3653.1232504199;6343.397377249165;6385.457236134928;6450.000249961257;6482.189726284215;6484.546081774278;6365.331640177784;6381.649009304487;6483.935160648392;6485.48116150708;6490.286068532458;5574;5582.665040097587;5618.0449323615085;5641;5642.407547207546;5639.407862174474;5656.434356564352;5678.148277758349;5705.058665320217;5712.2574065371655;5620;5673.149027645845;5714.1428785682065;5723.9713801430935;5725.713714314288;5576.525995290405;5611.102223644198;5627.409122042209;5641.294838145232;5665.5467562594895;5515.586331025189;5522.061249587539;5543.1408131739645;5557.694326812024;5564.081926482126;6174.5060395168275;6225.657588832612;6263.060540918853;6264.7807326743805;6272.341404152544;6750.594964302158;6793.150856142982;6831.69257383419;6839.1451068616425;6886.621235832027;6880.105586273752;6953.374196322356;6970.860582788367;7032.085828842269;7034.296570342976;6371.139896114058;6406.775762848324;6434.485241180694;6438.1630388049725;6454.451371633417;6922.480813938974;7101;7132.108486439195;7134.215236324104;7138.892916606255;6781.830454238585;6783.253842077367;6810.387065164159;6823.965880170666;6931.826704332432;6933.306669333027;6984.79045628632;6989;7000.054992576039;7021.824454388579;6760.864782704319;6835.487338449636;6838;6930.13373328334;6980.371766541036;6888.448924086061;6953.89569156463;6956.721731130698;6962.199347075151;6967.1291088613925;5066.746662666852;5085.364329458817;5123.538881500683;5130.4356520782685;5140.845774626767;4541.659375546781;4559.52125026874;4599.563041511051;4604.677672562889;4614.330922016289;6446.323136070645;6572.309907459648;6579;6613.074169616258;6615;7011.193712723;7014.473914456436;7019.543729657556;7025.89461158083;7038.3665470107935;6428.8071357859335;6501.252355979028;6522.804315870531;6590.3080176581725;6597;5748.540116790647;5809.767609295665;5834.299884013945;5869.236999190078;5870.207521984563;7078.893816592756;7088.113985751781;7098.538594991309;7099.89350159748;7107.8933815992805;6969.477289203229;7007.404370628554;7049.118860142482;7061.470389720689;7062.081929349151;7005.719771209095;7013.193482749549;7066.823329416806;7090.751823686146;7177.964110179416;6626.6686665667485;6731.124953755981;6767.560108593123;6803.93196068033;6859.279775623488;6905.309469053054;6906.723731050702;6931.584104953719;7001.054857594159;7051.964740176266;6771.3905748482875;6829;6836.589804611739;6841.076454678555;6846.383825455733;6733.966330168318;6739.629320387426;6753.088333074972;6815.795526134224;6820.147481564804;6709.496787741036;6749.628770417674;6762.8985565217545;6769.661516924232;6834.658267086726;6829;6883.483738719516;6908.3437073477935;6930.930690693231;6948.374646281859;6653.866922661617;6655.700493477708;6665.600063996176;6722;6731.293214212633 05:30:52 INFO - PID 25429 | |1;ext.html;904.0913881549044;937.1799675284126;952.8713623660806;972.7616733900192;977.3647129365906;42677.359839602395;43002.56997430025;43012.99999999996;43069;43475.56524434755;38598.61401385985;39047;39053.21893562134;39117.02207444808;39147.41278880812;7054.823629409255;7169.318914703121;7173.6771845267085;7177.425805935539;7181.85636287274;6956.686949087303;6984.511084224081;7056.54132481387;7060.011598376232;7060.576365418091;7567.924320756777;7658.119316278616;7669.539827610333;7671.501352412075;7671.961640191791;7519.624018799065;7626.38988880891;7653.579053152074;7663.540187588706;7673.53958762476;7522.210167932398;7600.125985511681;7611.505252158648;7612.961935190288;7618.238176182393;40620.59379406198;40799;40868;40876.18247635031;40969.38545921814;3617.1861331200535;3640.7815531067954;3670.8436842394563;3693.501377314055;3696.963030369716;30932.690673093206;31051;31132;31145.532817007763;31190.688093119006;4495.393121928563;4511.03012852235;4513.390692256569;4525.389072475239;4532.909341813145;212977;214716;221087.89456052778;222097;225066;52071.73964130155;52086.47913520892;52115.478845211066;52168.739156304735;52209.47790522046;55059;55070.173947390824;55132;55182.44817551853;55245.723771380886;17883.28466861311;18009.18958646838;18021.098945052956;18047.187876545588;18108.275668973358;14931.776023359658;15037.097774133586;15112.622184445478;15152.848471515365;15176.924115379352;14777;14949.402023918921;15025.924870375578;15067;15219.923900380427;6018.8194354169445;6094.360092190344;6104.725287362079;6146.678464130234;6167.198264225712;1102.1458369763498;1120.1151090638468;1127.0532752487786;1128.0975219824109;1128.7516746315798;25271;25275.62086568703;25357.112501062373;25360.746392536206;25515;1238.8451443569554;1240.1173487146482;1249.2192379762648;1253.8307328510716;1257.0948916779903;13360.131591446525;13385.263810490516;13406;18290.268389264547;18355.908220459078;295962;296844;299185;299311;300104;63715;63745.68127159427;63841.361586383544;64021.35978640247;64326.35673643297;1590.3161640494698;1634.0849124490323;1634.47696737043;1640.9343626254815;1649.389725801461;30697.693023069485;31145.532817007308;31296.530552041284;31410.371792564478;32415.351692965538;42649;42707.3593896098;42860.78569607132;42911.78544107259;42951.140977180905;241632;243440;243946;244726;244845;38283.425748613234;38803.80598096991;41336.1732765349;41449.1710165789;41489.1702165961;50714.492855070974;51595.742021289654;51986.22020669769;52261.216081758044;52290.47709522856;37121.81439092787;37234.813825930694;37323.50705971731;37439;37571.81214093912;37232.627673724;37376.62623373731;37583;37623.623763763106;37921;42649.57350426456;43701.56298437102;43992.34011489894;44004.55995440004;44112.77943610262;35584.28831423409;36022.27955440929;36286.45570316395;36445.27109457743;36754.81622591977;26773.33066673271;26836;26870;27318;27713.72286277192 05:30:52 INFO - PID 25429 | |2;jquery.html;595.1489370200611;612.6140531465177;613.267145760816;613.4478968927964;635.923689157301;23501.882490587544;24177.39556511086;24202.75797242027;24220.636690449657;24800.379990500245;29505.819767209287;30003.24991875204;30123.84938075312;30174.09477715672;30265.848670756615;6323.399277068671;6480.513961452886;6483.740650373979;6487.318831522693;6489.415952564268;6094.847628809293;6324.177856878599;6351.39661732137;6367.235931688181;6424.16485856838;6288.622682639033;6310.684465776716;6352.428281454668;6357.141785858896;6357.523185761063;6253.53098517613;6258.718357673893;6270.843228919268;6285.96857015712;6298.401651843091;5817.970910145465;5860.531157507389;5860.619059761102;5877.9118313225335;5878.5297176225795;32116.678833211838;32423.51364729531;32541.511877321624;32939.341213175605;33547.16132096693;2302.401375642345;2340.461693810416;2346.3547524430746;2352.023910077316;2359.917402890908;20100.195992160297;20881.269155579634;20905.8954705227;20955.8952205238;20967.895160524098;2391.1033362489065;2403.927882163538;2474.5545801755675;2479.7396273391396;2482.8510289382693;148444;153542;154739;154960.2251988733;154971;15759;16304.592385190464;16727.897132816743;16873.831261687472;17067.231974561175;26268.474630507666;26405;26544.203673889813;26566.46867062648;26579.33551661224;10222.335548189343;10236.692899213036;10368.896311036944;10370.585176593002;10456;9044.502552359552;9116.407433516933;9201.815963680689;9367.484788336571;9799.559019843982;8815.603297851612;10025.849612255823;10143;10178.506265964887;10501.684949451375;2800.8599570021415;2873.7700983921236;2913.8543072846273;2918.8102773319665;2948.8673009714616;1051.75283808305;1069.7379142110233;1070.1920050362082;1072.6771112416973;1088.8094583447864;22346.21788237404;22543.661845072336;22920.4269893254;23028.769712302663;23036.65445018326;1150.7640933608757;1152.0380482297207;1152.5793085523724;1156.8669602995594;1159.5593674403672;15124.39502419913;15726.135062571668;15751.44869929547;15970.36118555268;16224.675506489804;661676;662225;664160;674256;687435;143281;147922.26038869738;152154;153049;153235.23382383017;1323.563224136052;1345.2668295778628;1399.244408019658;1416.3201663201721;1417.9858201417853;22954.42613934665;24376.90303936292;24379.878100609385;24524.6321305177;24592.139275126;63855.680721596094;64038.35961640324;65288.347116528224;66292;68289.3171068283;78021;79083.20916790758;79084.60457697675;79193;79298;19058.904705476383;21282;22724.659130113392;23077;23924.760752392252;25961;26128.73871261263;27120;27365.179044628694;27403.725962740118;21667.674984874924;21975.23086691958;21980;22093.447663808533;22178;19039.333623323117;19655.606887861875;19691.310804121786;19975.80145191235;20479.59040819205;21671.566568668855;22436.214732484284;22680.432989175402;22855.428614284112;22880.885595571915;22842.42893927665;23504.882475587514;23593;23819.88090059608;23850.40373990664;18748.906255468635;20026;21260.681089783357;21666.67499987533;21678.132874685467 05:30:52 INFO - PID 25429 | |3;mootools.html;1450.6663467402498;1470.2060887120956;1517.2565442932953;1520.3386526860813;1543.9768403473956;15424.92287538562;16042.91978540107;16054.83945160548;16056.357745690188;16081.597960051005;15887.602809929758;16835.83164168358;16855;16875.240614172362;16879.49361519153;3028.1067085209916;3064.4943584308617;3099.380123975203;3121.375724855027;3122.8126312421214;2877.7985541012135;2884.480793457177;2927.077970439305;2993.536001919706;2995.026616349684;3022.2897619059504;3022.350194708137;3049.4815881300233;3052.0996306089755;3052.8931487397945;2733.1117386849255;2742.4103817679197;2907.3313137978384;2910.5925170476257;2994.7454466370386;2919.7664186865;2925.80982236154;2926.88292468301;2954.3057381515328;2966.9851650741607;15820.446284379992;15831;15835.60410989723;15929.203539823078;15946.362145514166;8742.475451472868;9036;9056.139666731717;9060.68287609937;9063.954680226556;5497.147942068986;5642.57680673947;5667.376588575254;5773.422657734235;5790.565707571906;1848.7042073268346;1867.4304337177155;1872.382113902409;1905.1522072677665;1909.5703466720015;27822.443551128865;27871.581926271123;28053.719462805315;28074.85962570174;28090.438191236266;7299.270072992765;7525.172231054579;7630.923690763021;7723.304902558797;7765.417593680384;18483.815161848208;18668.53328666767;18672.06639668011;18769.90615046916;18772.155253013374;8584.74245772628;8684.826303474021;8797.736067917973;8803.383763136648;8825.161609647073;7914.643841027168;8017;8135.1051384347675;8163.469374490758;8165.95917020423;5595.832125036255;5680.261565996477;5864.530837532987;6052.727627256784;6072.635641861502;1727.9654406912043;1761.6917039518032;1764.0474143962374;1783.3223375117373;1786.8391844734037;906.4334790755778;951.6383774165772;953.4803532075035;954.6229239450518;964.4454438697777;8956.776080597907;8967.955160224157;9042.954785226031;9113.817723645623;9126.543672816333;1047.7694907120422;1057.7144171073767;1103.9724006899892;1105.795427845851;1122.5004872831676;5478.233047373371;5597;5819.88360232793;5958.940410595838;6330.556861019684;23232;23327.650085248733;23748.287551373487;23980.52038959246;23990.52018959611;23174.1889033883;24127.51744965091;24144.758552414252;24156.154534591205;24159.879200603886;11157.497912593954;11334.149938754792;11637.592684256011;11810.527578896748;11888.583899563646;9314.44113353201;9392.95303523478;9464.95267523658;9538.046195380406;9966.053224943618;19904.50238744043;20204.19183232713;20328.59342813165;20395.286164984154;20602.690959635318;20668.793312066686;20737.377878663665;20825.583488329845;20861.478463038544;21362.252321168686;13085.345732713517;13331.866681333451;13454.327283635976;13461.461541538229;13498.325083745576;12213.595720900683;14588.562343129723;14720.19038952825;14737;14739.484118055816;11137;11570;12298.462692163479;12640.810387844005;12775.808362874379;11709.414529273672;11782.646520604396;11908.285502869856;11921.94039029834;12123.818142728043;10402.687919362432;10484.528196231035;10558.102561282378;10616.575336986434;10635.89364106349;8119.59402029908;8146.877796833171;8218.506889586644;8238.116374989373;8334.208250216463;8191.508509489449;8223.136570659995;8226;8253.380996425412;8257.21556452136 05:30:52 INFO - PID 25429 | |4;prototype.html;540.3272925208116;544.1918750655276;556.1990733343985;557.9302587176603;566.2129639800678;6316.115743795866;6347.206599175103;6350;6371.139896114023;6401.935980640193;6199.44205021548;6251.187345645071;6255.562110652245;6262.467690246334;6280.5289603279825;5013.573846223076;5039.445660977308;5048.1670524363435;5052.621053420999;5071;4813.446453657839;4924.630652701044;4925.655204135712;4937.432195297533;5004.223500657251;4832.806687732486;4836.992648051072;4871.757701786039;4902.436219834711;4917.606591472673;4841.709497430165;4846.224604063333;4893.168161412551;4900.529841047689;4904.852854414374;4429.424174857248;4470.329450582406;4485;4486.125205584913;4499.280115181588;6121.938780612181;6179.196704428396;6212.627242365473;6216.2540495140875;6223.6081335671715;5754.625949313281;5790.743803304567;5796.391378905197;5908.172855800191;5936.7328470218945;6620.238672552622;6630.303818099078;6666.799996000128;6678.565893216925;6717.395434410878;5015.8212819987275;5030.2957585938;5045.924311135336;5096.311997880276;5115.363083813181;6827.590344579291;6873.690683919235;6917.584944903271;7019.736447439459;7054.788356349318;5153.175491921274;5156.484351564814;5169;5204.193350030751;5243.973780131075;5199.610029247746;5212.50481204285;5289.127293996525;5325.946740532622;5342.492463215988;5859.736311865976;5861.794837180678;5868.559858010666;5868.794592189253;5895.941040589625;6675.897092415874;6731.899021514681;6770.830729231809;6772.69522871472;6819.454443644497;1823.717323814811;1825.2607693884;1832.2854086906118;1849.2972670385168;1852.7498787663762;1268.8033354830015;1285.4087119924752;1297.202220634303;1302.4008955880402;1322.9206247625173;6359.523035772336;6432.42108210254;6460.450861676716;6505.60966342021;6527.8694426111215;6660.090275909508;6739.52823302374;6792.184937807495;6801.857414914286;6880.58716477013;6315.715792789336;6389.6805159741825;6411.775587854403;6445.9355406446275;6468.870622587616;3582.390993531106;3623.655752703489;3649.9635003649623;3660.401115208232;3660.7986560739414;7065.682044308019;7067.89398159028;7097.964510177416;7135;7159.353348729717;6951.227437003532;7009.684564194624;7056.647167641598;7064.646767661597;7073.328033836778;7066.152061752623;7099.609521476368;7103.573785572882;7128.073350464407;7130.251323610946;6856.902895536889;6889.311068893271;6896.724131034703;6907.6184763048595;6939.653017349011;6698.464122870256;6792.150981127359;6815.897761533482;6826.283240259701;6829.556078854858;7030.191527974348;7068.11648543932;7076.22161562238;7111.466640001917;7132.216945763559;5227.634065615371;5257.973710131425;5260.6843589383225;5262.815801446931;5265.657732247391;6642.4021838034805;6819.488538359544;6863.691133898887;6998.1952075509935;7003.649817509002;6258.843528911631;6635.23694775107;6690.230623478362;6728.293529179366;6739.742186367425;6627.569208001464;6630.668466576748;6683.966580167068;6694.029365742038;6737.494687898329;6613.834654133685;6705;6709.93290067093;6726.428253598499;6742.741181703987;6625.668716564249;6701.798946031627;6740;6757;6795.082663840319;6471.2234531856475;6568.868622627425;6577.934220657732;6582.341765823379;6632.50256230775 05:30:52 INFO - PID 25429 | |5;yui.html;957.5116690487854;959.9616015359386;960.4765402855443;992.1071036067543;994.4431118573599;19306.51733706656;20289.898550507245;20304.89847550762;20343.084561194744;22395.768232747192;22691.432714182152;22800.77199228007;22873.542529149407;23070.65394019087;23117;1013.8327176015948;1096.9396683182422;1099.5766629847487;1099.6975831646282;1101.1081024370285;1035.663409391947;1074.5648012554889;1078.9352638841656;1093.8577984861997;1094.9178811589163;1126.9154813388989;1129.5199540195383;1129.6723950054475;1129.813580759178;1131.2420678145663;1119.4906317625503;1122.0182340452104;1124.8481455003553;1125.5441546173813;1133.6372360844532;819.1439945257221;823.6458322921142;825.475822852487;825.9710910118117;826.0500424511799;18051.368202112862;18096.366627168118;18148.4555463335;18766;21252.25617103394;21787.34637960848;21800.89099554508;22198.556028879495;22217.888910555506;22349.888250558644;14839.183844888526;15507;15520.223988800628;15539.300731466998;15629.531114066596;3534.9469757953652;3573.285342931424;3573.4818451324672;3573.6426357364317;3574.928501429983;148011;148601.2569937165;150513;150926.24536877245;152565;16046.75929861053;16654.08402537872;16708.24812883423;16709.331626734795;16768.49694509142;31705.5244171333;32248.032559023268;32344.35311293761;32575.51136732951;32717.345653086806;8634.5251011195;8796.12038796128;8852.336074794288;8855.822883542292;8927.151920567536;4419.955800442019;4441.333799930037;4503.954960450354;4524;4530.207213737649;5624.21261023457;5672.5745569081655;5713.485786279255;5726.713664316768;5767.36558978512;1011.5498603121688;1020.8366661334151;1040.079529616295;1042.0361165921493;1042.9791404171874;740.1118657610889;754.909410870699;756.9962150189324;774.7249726347178;777.1373775109623;12755.42600582976;13313.134646247963;13581.11722738019;13618;13633;686.4679873098389;699.8530308635244;707.7664370757637;717.4726575966661;719.8632259870712;6022;6030.849228769316;6034.2155519782145;6117.897713130873;6128.754849806047;128841;131229;132352.3382383082;132553.3372333132;133233.33383333022;119888.40055799665;120220;122360;122691;123113.38443307726;102327.4883625577;103235;105296.47351763345;107269;108055;11823.231489953125;11846.407679616157;11875.643730688093;11900.345480998629;12014.75970480603;49004;49205.507944921526;49240.507594925024;50157.498425015285;51244.487555125466;62522.37477625166;63201;63225.36774632379;63490.68254658882;63701;16476.917615411847;16632.91683541623;16633.584160396087;16801.159942003094;16946.830531694526;18057;18211.089445527406;18338.633227335646;18539.81460185381;18547.72178417298;15522.84477155214;15690.843091569395;15716.764248536052;15723.213839308217;15822.446214382442;16124.596885077966;16390.67218655644;16497;16602.16989150562;16635.66728665444;16074.919625401799;16216.513504594881;16304;16439.753403699193;16510.33958641641;12305.26168429897;12581.811272830731;12709.682257943625;12762.61712148637;12804.10371274002;12544.560940367044;12647.557335493213;12747.553835615709;12779.744405112031;12955.417006234553 05:30:52 INFO - PID 25429 | __end_tp_report 05:30:52 INFO - PID 25429 | __start_cc_report 05:30:52 INFO - PID 25429 | _x_x_mozilla_cycle_collect,289 05:30:52 INFO - PID 25429 | __end_cc_report 05:30:52 INFO - PID 25429 | __startTimestamp1505305852919__endTimestamp 05:30:52 INFO - PID 25429 | 05:30:52 INFO - PID 25429 | ------- Summary: start ------- 05:30:52 INFO - PID 25429 | Number of tests: 6 05:30:52 INFO - PID 25429 | 05:30:52 INFO - PID 25429 | [#0] dojo.html Cycles:165 Average:6372.96 Median:6731.29 stddev:800.94 (11.9%) stddev-sans-first:773.25 05:30:52 INFO - PID 25429 | Values: 3598.2 3627.7 3628.4 3630.3 3653.1 6343.4 6385.5 6450.0 6482.2 6484.5 6365.3 6381.6 6483.9 6485.5 6490.3 5574.0 5582.7 5618.0 5641.0 5642.4 5639.4 5656.4 5678.1 5705.1 5712.3 5620.0 5673.1 5714.1 5724.0 5725.7 5576.5 5611.1 5627.4 5641.3 5665.5 5515.6 5522.1 5543.1 5557.7 5564.1 6174.5 6225.7 6263.1 6264.8 6272.3 6750.6 6793.2 6831.7 6839.1 6886.6 6880.1 6953.4 6970.9 7032.1 7034.3 6371.1 6406.8 6434.5 6438.2 6454.5 6922.5 7101.0 7132.1 7134.2 7138.9 6781.8 6783.3 6810.4 6824.0 6931.8 6933.3 6984.8 6989.0 7000.1 7021.8 6760.9 6835.5 6838.0 6930.1 6980.4 6888.4 6953.9 6956.7 6962.2 6967.1 5066.7 5085.4 5123.5 5130.4 5140.8 4541.7 4559.5 4599.6 4604.7 4614.3 6446.3 6572.3 6579.0 6613.1 6615.0 7011.2 7014.5 7019.5 7025.9 7038.4 6428.8 6501.3 6522.8 6590.3 6597.0 5748.5 5809.8 5834.3 5869.2 5870.2 7078.9 7088.1 7098.5 7099.9 7107.9 6969.5 7007.4 7049.1 7061.5 7062.1 7005.7 7013.2 7066.8 7090.8 7178.0 6626.7 6731.1 6767.6 6803.9 6859.3 6905.3 6906.7 6931.6 7001.1 7052.0 6771.4 6829.0 6836.6 6841.1 6846.4 6734.0 6739.6 6753.1 6815.8 6820.1 6709.5 6749.6 6762.9 6769.7 6834.7 6829.0 6883.5 6908.3 6930.9 6948.4 6653.9 6655.7 6665.6 6722.0 6731.3 05:30:52 INFO - PID 25429 | 05:30:52 INFO - PID 25429 | [#1] ext.html Cycles:180 Average:43877.47 Median:38441.02 stddev:66618.19 (173.3%) stddev-sans-first:66726.92 05:30:52 INFO - PID 25429 | Values: 904.1 937.2 952.9 972.8 977.4 42677.4 43002.6 43013.0 43069.0 43475.6 38598.6 39047.0 39053.2 39117.0 39147.4 7054.8 7169.3 7173.7 7177.4 7181.9 6956.7 6984.5 7056.5 7060.0 7060.6 7567.9 7658.1 7669.5 7671.5 7672.0 7519.6 7626.4 7653.6 7663.5 7673.5 7522.2 7600.1 7611.5 7613.0 7618.2 40620.6 40799.0 40868.0 40876.2 40969.4 3617.2 3640.8 3670.8 3693.5 3697.0 30932.7 31051.0 31132.0 31145.5 31190.7 4495.4 4511.0 4513.4 4525.4 4532.9 212977.0 214716.0 221087.9 222097.0 225066.0 52071.7 52086.5 52115.5 52168.7 52209.5 55059.0 55070.2 55132.0 55182.4 55245.7 17883.3 18009.2 18021.1 18047.2 18108.3 14931.8 15037.1 15112.6 15152.8 15176.9 14777.0 14949.4 15025.9 15067.0 15219.9 6018.8 6094.4 6104.7 6146.7 6167.2 1102.1 1120.1 1127.1 1128.1 1128.8 25271.0 25275.6 25357.1 25360.7 25515.0 1238.8 1240.1 1249.2 1253.8 1257.1 13360.1 13385.3 13406.0 18290.3 18355.9 295962.0 296844.0 299185.0 299311.0 300104.0 63715.0 63745.7 63841.4 64021.4 64326.4 1590.3 1634.1 1634.5 1640.9 1649.4 30697.7 31145.5 31296.5 31410.4 32415.4 42649.0 42707.4 42860.8 42911.8 42951.1 241632.0 243440.0 243946.0 244726.0 244845.0 38283.4 38803.8 41336.2 41449.2 41489.2 50714.5 51595.7 51986.2 52261.2 52290.5 37121.8 37234.8 37323.5 37439.0 37571.8 37232.6 37376.6 37583.0 37623.6 37921.0 42649.6 43701.6 43992.3 44004.6 44112.8 35584.3 36022.3 36286.5 36445.3 36754.8 26773.3 26836.0 26870.0 27318.0 27713.7 05:30:52 INFO - PID 25429 | 05:30:52 INFO - PID 25429 | [#2] jquery.html Cycles:180 Average:43362.41 Median:13157.93 stddev:111762.91 (849.4%) stddev-sans-first:112030.30 05:30:52 INFO - PID 25429 | Values: 595.1 612.6 613.3 613.4 635.9 23501.9 24177.4 24202.8 24220.6 24800.4 29505.8 30003.2 30123.8 30174.1 30265.8 6323.4 6480.5 6483.7 6487.3 6489.4 6094.8 6324.2 6351.4 6367.2 6424.2 6288.6 6310.7 6352.4 6357.1 6357.5 6253.5 6258.7 6270.8 6286.0 6298.4 5818.0 5860.5 5860.6 5877.9 5878.5 32116.7 32423.5 32541.5 32939.3 33547.2 2302.4 2340.5 2346.4 2352.0 2359.9 20100.2 20881.3 20905.9 20955.9 20967.9 2391.1 2403.9 2474.6 2479.7 2482.9 148444.0 153542.0 154739.0 154960.2 154971.0 15759.0 16304.6 16727.9 16873.8 17067.2 26268.5 26405.0 26544.2 26566.5 26579.3 10222.3 10236.7 10368.9 10370.6 10456.0 9044.5 9116.4 9201.8 9367.5 9799.6 8815.6 10025.8 10143.0 10178.5 10501.7 2800.9 2873.8 2913.9 2918.8 2948.9 1051.8 1069.7 1070.2 1072.7 1088.8 22346.2 22543.7 22920.4 23028.8 23036.7 1150.8 1152.0 1152.6 1156.9 1159.6 15124.4 15726.1 15751.4 15970.4 16224.7 661676.0 662225.0 664160.0 674256.0 687435.0 143281.0 147922.3 152154.0 153049.0 153235.2 1323.6 1345.3 1399.2 1416.3 1418.0 22954.4 24376.9 24379.9 24524.6 24592.1 63855.7 64038.4 65288.3 66292.0 68289.3 78021.0 79083.2 79084.6 79193.0 79298.0 19058.9 21282.0 22724.7 23077.0 23924.8 25961.0 26128.7 27120.0 27365.2 27403.7 21667.7 21975.2 21980.0 22093.4 22178.0 19039.3 19655.6 19691.3 19975.8 20479.6 21671.6 22436.2 22680.4 22855.4 22880.9 22842.4 23504.9 23593.0 23819.9 23850.4 18748.9 20026.0 21260.7 21666.7 21678.1 05:30:52 INFO - PID 25429 | 05:30:52 INFO - PID 25429 | [#3] mootools.html Cycles:180 Average:10149.42 Median:2737.76 stddev:7182.30 (262.3%) stddev-sans-first:7172.71 05:30:52 INFO - PID 25429 | Values: 1450.7 1470.2 1517.3 1520.3 1544.0 15424.9 16042.9 16054.8 16056.4 16081.6 15887.6 16835.8 16855.0 16875.2 16879.5 3028.1 3064.5 3099.4 3121.4 3122.8 2877.8 2884.5 2927.1 2993.5 2995.0 3022.3 3022.4 3049.5 3052.1 3052.9 2733.1 2742.4 2907.3 2910.6 2994.7 2919.8 2925.8 2926.9 2954.3 2967.0 15820.4 15831.0 15835.6 15929.2 15946.4 8742.5 9036.0 9056.1 9060.7 9064.0 5497.1 5642.6 5667.4 5773.4 5790.6 1848.7 1867.4 1872.4 1905.2 1909.6 27822.4 27871.6 28053.7 28074.9 28090.4 7299.3 7525.2 7630.9 7723.3 7765.4 18483.8 18668.5 18672.1 18769.9 18772.2 8584.7 8684.8 8797.7 8803.4 8825.2 7914.6 8017.0 8135.1 8163.5 8166.0 5595.8 5680.3 5864.5 6052.7 6072.6 1728.0 1761.7 1764.0 1783.3 1786.8 906.4 951.6 953.5 954.6 964.4 8956.8 8968.0 9043.0 9113.8 9126.5 1047.8 1057.7 1104.0 1105.8 1122.5 5478.2 5597.0 5819.9 5958.9 6330.6 23232.0 23327.7 23748.3 23980.5 23990.5 23174.2 24127.5 24144.8 24156.2 24159.9 11157.5 11334.1 11637.6 11810.5 11888.6 9314.4 9393.0 9465.0 9538.0 9966.1 19904.5 20204.2 20328.6 20395.3 20602.7 20668.8 20737.4 20825.6 20861.5 21362.3 13085.3 13331.9 13454.3 13461.5 13498.3 12213.6 14588.6 14720.2 14737.0 14739.5 11137.0 11570.0 12298.5 12640.8 12775.8 11709.4 11782.6 11908.3 11921.9 12123.8 10402.7 10484.5 10558.1 10616.6 10635.9 8119.6 8146.9 8218.5 8238.1 8334.2 8191.5 8223.1 8226.0 8253.4 8257.2 05:30:52 INFO - PID 25429 | 05:30:52 INFO - PID 25429 | [#4] prototype.html Cycles:180 Average:5692.83 Median:6365.33 stddev:1613.23 (25.3%) stddev-sans-first:1570.72 05:30:52 INFO - PID 25429 | Values: 540.3 544.2 556.2 557.9 566.2 6316.1 6347.2 6350.0 6371.1 6401.9 6199.4 6251.2 6255.6 6262.5 6280.5 5013.6 5039.4 5048.2 5052.6 5071.0 4813.4 4924.6 4925.7 4937.4 5004.2 4832.8 4837.0 4871.8 4902.4 4917.6 4841.7 4846.2 4893.2 4900.5 4904.9 4429.4 4470.3 4485.0 4486.1 4499.3 6121.9 6179.2 6212.6 6216.3 6223.6 5754.6 5790.7 5796.4 5908.2 5936.7 6620.2 6630.3 6666.8 6678.6 6717.4 5015.8 5030.3 5045.9 5096.3 5115.4 6827.6 6873.7 6917.6 7019.7 7054.8 5153.2 5156.5 5169.0 5204.2 5244.0 5199.6 5212.5 5289.1 5325.9 5342.5 5859.7 5861.8 5868.6 5868.8 5895.9 6675.9 6731.9 6770.8 6772.7 6819.5 1823.7 1825.3 1832.3 1849.3 1852.7 1268.8 1285.4 1297.2 1302.4 1322.9 6359.5 6432.4 6460.5 6505.6 6527.9 6660.1 6739.5 6792.2 6801.9 6880.6 6315.7 6389.7 6411.8 6445.9 6468.9 3582.4 3623.7 3650.0 3660.4 3660.8 7065.7 7067.9 7098.0 7135.0 7159.4 6951.2 7009.7 7056.6 7064.6 7073.3 7066.2 7099.6 7103.6 7128.1 7130.3 6856.9 6889.3 6896.7 6907.6 6939.7 6698.5 6792.2 6815.9 6826.3 6829.6 7030.2 7068.1 7076.2 7111.5 7132.2 5227.6 5258.0 5260.7 5262.8 5265.7 6642.4 6819.5 6863.7 6998.2 7003.6 6258.8 6635.2 6690.2 6728.3 6739.7 6627.6 6630.7 6684.0 6694.0 6737.5 6613.8 6705.0 6709.9 6726.4 6742.7 6625.7 6701.8 6740.0 6757.0 6795.1 6471.2 6568.9 6577.9 6582.3 6632.5 05:30:52 INFO - PID 25429 | 05:30:52 INFO - PID 25429 | [#5] yui.html Cycles:180 Average:26161.11 Median:16708.79 stddev:38537.48 (230.6%) stddev-sans-first:38599.13 05:30:52 INFO - PID 25429 | Values: 957.5 960.0 960.5 992.1 994.4 19306.5 20289.9 20304.9 20343.1 22395.8 22691.4 22800.8 22873.5 23070.7 23117.0 1013.8 1096.9 1099.6 1099.7 1101.1 1035.7 1074.6 1078.9 1093.9 1094.9 1126.9 1129.5 1129.7 1129.8 1131.2 1119.5 1122.0 1124.8 1125.5 1133.6 819.1 823.6 825.5 826.0 826.1 18051.4 18096.4 18148.5 18766.0 21252.3 21787.3 21800.9 22198.6 22217.9 22349.9 14839.2 15507.0 15520.2 15539.3 15629.5 3534.9 3573.3 3573.5 3573.6 3574.9 148011.0 148601.3 150513.0 150926.2 152565.0 16046.8 16654.1 16708.2 16709.3 16768.5 31705.5 32248.0 32344.4 32575.5 32717.3 8634.5 8796.1 8852.3 8855.8 8927.2 4420.0 4441.3 4504.0 4524.0 4530.2 5624.2 5672.6 5713.5 5726.7 5767.4 1011.5 1020.8 1040.1 1042.0 1043.0 740.1 754.9 757.0 774.7 777.1 12755.4 13313.1 13581.1 13618.0 13633.0 686.5 699.9 707.8 717.5 719.9 6022.0 6030.8 6034.2 6117.9 6128.8 128841.0 131229.0 132352.3 132553.3 133233.3 119888.4 120220.0 122360.0 122691.0 123113.4 102327.5 103235.0 105296.5 107269.0 108055.0 11823.2 11846.4 11875.6 11900.3 12014.8 49004.0 49205.5 49240.5 50157.5 51244.5 62522.4 63201.0 63225.4 63490.7 63701.0 16476.9 16632.9 16633.6 16801.2 16946.8 18057.0 18211.1 18338.6 18539.8 18547.7 15522.8 15690.8 15716.8 15723.2 15822.4 16124.6 16390.7 16497.0 16602.2 16635.7 16074.9 16216.5 16304.0 16439.8 16510.3 12305.3 12581.8 12709.7 12762.6 12804.1 12544.6 12647.6 12747.6 12779.7 12955.4 05:30:52 INFO - PID 25429 | -------- Summary: end -------- 05:30:52 INFO - PID 25429 | 05:30:53 INFO - TEST-INFO | 25429: exit 0 05:30:53 INFO - TEST-OK | dromaeo_css | took 1108318ms 05:30:53 INFO - TEST-START | kraken 05:30:53 INFO - Initialising browser for kraken test... 05:30:53 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:53277/getInfo.html -profile /tmp/tmpXBJYXI/profile 05:30:53 INFO - TEST-INFO | started process 25788 (/builds/slave/test/build/application/firefox/firefox http://localhost:53277/getInfo.html) 05:30:58 INFO - TEST-INFO | 25788: exit 0 05:30:58 INFO - Browser initialized. 05:30:58 INFO - Running cycle 1/1 for kraken test... 05:30:58 INFO - TEST-INFO | started process 25949 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpXBJYXI/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 05:31:09 INFO - PID 25949 | RSS: Main: 156254208 05:31:09 INFO - PID 25949 | 05:31:12 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:53277/tests/kraken/driver.html?testName=audio-beat-detection) 05:31:13 INFO - PID 25949 | RSS: Main: 162443264 05:31:13 INFO - PID 25949 | 05:31:15 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:53277/tests/kraken/driver.html?testName=audio-dft) 05:31:16 INFO - PID 25949 | RSS: Main: 162906112 05:31:16 INFO - PID 25949 | 05:31:19 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:53277/tests/kraken/driver.html?testName=audio-fft) 05:31:19 INFO - PID 25949 | RSS: Main: 163655680 05:31:19 INFO - PID 25949 | 05:31:21 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:53277/tests/kraken/driver.html?testName=audio-oscillator) 05:31:22 INFO - PID 25949 | RSS: Main: 163008512 05:31:22 INFO - PID 25949 | 05:31:24 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:53277/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:31:25 INFO - PID 25949 | RSS: Main: 162476032 05:31:25 INFO - PID 25949 | 05:31:28 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:53277/tests/kraken/driver.html?testName=imaging-darkroom) 05:31:28 INFO - PID 25949 | RSS: Main: 162955264 05:31:28 INFO - PID 25949 | 05:31:32 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:53277/tests/kraken/driver.html?testName=imaging-desaturate) 05:31:32 INFO - PID 25949 | RSS: Main: 165756928 05:31:32 INFO - PID 25949 | 05:31:35 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:53277/tests/kraken/driver.html?testName=json-parse-financial) 05:31:36 INFO - PID 25949 | RSS: Main: 167387136 05:31:36 INFO - PID 25949 | 05:31:37 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:53277/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:31:38 INFO - PID 25949 | RSS: Main: 166338560 05:31:38 INFO - PID 25949 | 05:31:40 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:53277/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:31:40 INFO - PID 25949 | RSS: Main: 166735872 05:31:40 INFO - PID 25949 | 05:31:42 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:53277/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:31:43 INFO - PID 25949 | RSS: Main: 163037184 05:31:43 INFO - PID 25949 | 05:31:45 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:53277/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:31:46 INFO - PID 25949 | RSS: Main: 163827712 05:31:46 INFO - PID 25949 | 05:31:49 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:53277/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:31:49 INFO - PID 25949 | RSS: Main: 163397632 05:31:49 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | Cycle 1(1): loaded http://localhost:53277/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:53277/tests/kraken/driver.html?testName=ai-astar) 05:31:51 INFO - PID 25949 | RSS: Main: 165314560 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | __start_tp_report 05:31:51 INFO - PID 25949 | _x_x_mozilla_page_load 05:31:51 INFO - PID 25949 | _x_x_mozilla_page_load_details 05:31:51 INFO - PID 25949 | |i|pagename|runs| 05:31:51 INFO - PID 25949 | |0;ai-astar;96;106;98;106;105;106;109;96;105;110 05:31:51 INFO - PID 25949 | |1;audio-beat-detection;141;114;145;169;111;149;139;115;161;113 05:31:51 INFO - PID 25949 | |2;audio-dft;161;164;161;160;161;161;162;162;163;162 05:31:51 INFO - PID 25949 | |3;audio-fft;74;73;73;172;76;76;75;75;162;77 05:31:51 INFO - PID 25949 | |4;audio-oscillator;77;78;124;78;77;77;124;77;77;139 05:31:51 INFO - PID 25949 | |5;imaging-gaussian-blur;113;113;114;113;117;113;114;114;114;114 05:31:51 INFO - PID 25949 | |6;imaging-darkroom;148;149;148;148;148;147;147;149;150;147 05:31:51 INFO - PID 25949 | |7;imaging-desaturate;93;94;94;94;94;94;93;94;94;94 05:31:51 INFO - PID 25949 | |8;json-parse-financial;45;49;52;46;48;45;45;45;45;45 05:31:51 INFO - PID 25949 | |9;json-stringify-tinderbox;52;52;52;52;52;57;52;53;51;52 05:31:51 INFO - PID 25949 | |10;stanford-crypto-aes;72;75;80;72;72;74;73;73;74;72 05:31:51 INFO - PID 25949 | |11;stanford-crypto-ccm;119;132;116;130;117;122;120;114;131;133 05:31:51 INFO - PID 25949 | |12;stanford-crypto-pbkdf2;163;160;157;159;161;159;165;160;158;170 05:31:51 INFO - PID 25949 | |13;stanford-crypto-sha256-iterative;61;60;60;60;64;59;60;59;58;59 05:31:51 INFO - PID 25949 | __end_tp_report 05:31:51 INFO - PID 25949 | __start_cc_report 05:31:51 INFO - PID 25949 | _x_x_mozilla_cycle_collect,785 05:31:51 INFO - PID 25949 | __end_cc_report 05:31:51 INFO - PID 25949 | __startTimestamp1505305911765__endTimestamp 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | ------- Summary: start ------- 05:31:51 INFO - PID 25949 | Number of tests: 14 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#0] ai-astar Cycles:10 Average:103.70 Median:109.50 stddev:5.14 (4.7%) stddev-sans-first:4.64 05:31:51 INFO - PID 25949 | Values: 96.0 106.0 98.0 106.0 105.0 106.0 109.0 96.0 105.0 110.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#1] audio-beat-detection Cycles:10 Average:135.70 Median:143.00 stddev:21.28 (14.9%) stddev-sans-first:22.49 05:31:51 INFO - PID 25949 | Values: 141.0 114.0 145.0 169.0 111.0 149.0 139.0 115.0 161.0 113.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#2] audio-dft Cycles:10 Average:161.70 Median:162.00 stddev:1.16 (0.7%) stddev-sans-first:1.20 05:31:51 INFO - PID 25949 | Values: 161.0 164.0 161.0 160.0 161.0 161.0 162.0 162.0 163.0 162.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#3] audio-fft Cycles:10 Average:93.30 Median:75.00 stddev:38.94 (51.9%) stddev-sans-first:40.67 05:31:51 INFO - PID 25949 | Values: 74.0 73.0 73.0 172.0 76.0 76.0 75.0 75.0 162.0 77.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#4] audio-oscillator Cycles:10 Average:92.80 Median:77.00 stddev:25.31 (32.9%) stddev-sans-first:26.20 05:31:51 INFO - PID 25949 | Values: 77.0 78.0 124.0 78.0 77.0 77.0 124.0 77.0 77.0 139.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#5] imaging-gaussian-blur Cycles:10 Average:113.90 Median:114.00 stddev:1.20 (1.1%) stddev-sans-first:1.22 05:31:51 INFO - PID 25949 | Values: 113.0 113.0 114.0 113.0 117.0 113.0 114.0 114.0 114.0 114.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#6] imaging-darkroom Cycles:10 Average:148.10 Median:148.00 stddev:0.99 (0.7%) stddev-sans-first:1.05 05:31:51 INFO - PID 25949 | Values: 148.0 149.0 148.0 148.0 148.0 147.0 147.0 149.0 150.0 147.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#7] imaging-desaturate Cycles:10 Average:93.80 Median:94.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 05:31:51 INFO - PID 25949 | Values: 93.0 94.0 94.0 94.0 94.0 94.0 93.0 94.0 94.0 94.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#8] json-parse-financial Cycles:10 Average:46.50 Median:45.50 stddev:2.42 (5.3%) stddev-sans-first:2.50 05:31:51 INFO - PID 25949 | Values: 45.0 49.0 52.0 46.0 48.0 45.0 45.0 45.0 45.0 45.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#9] json-stringify-tinderbox Cycles:10 Average:52.50 Median:52.00 stddev:1.65 (3.2%) stddev-sans-first:1.74 05:31:51 INFO - PID 25949 | Values: 52.0 52.0 52.0 52.0 52.0 57.0 52.0 53.0 51.0 52.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#10] stanford-crypto-aes Cycles:10 Average:73.70 Median:73.50 stddev:2.45 (3.3%) stddev-sans-first:2.52 05:31:51 INFO - PID 25949 | Values: 72.0 75.0 80.0 72.0 72.0 74.0 73.0 73.0 74.0 72.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#11] stanford-crypto-ccm Cycles:10 Average:123.40 Median:126.00 stddev:7.34 (5.8%) stddev-sans-first:7.61 05:31:51 INFO - PID 25949 | Values: 119.0 132.0 116.0 130.0 117.0 122.0 120.0 114.0 131.0 133.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:161.20 Median:160.50 stddev:3.88 (2.4%) stddev-sans-first:4.06 05:31:51 INFO - PID 25949 | Values: 163.0 160.0 157.0 159.0 161.0 159.0 165.0 160.0 158.0 170.0 05:31:51 INFO - PID 25949 | 05:31:51 INFO - PID 25949 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:60.00 Median:60.00 stddev:1.63 (2.7%) stddev-sans-first:1.69 05:31:51 INFO - PID 25949 | Values: 61.0 60.0 60.0 60.0 64.0 59.0 60.0 59.0 58.0 59.0 05:31:51 INFO - PID 25949 | -------- Summary: end -------- 05:31:51 INFO - PID 25949 | 05:31:52 INFO - PID 25949 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 05:31:52 INFO - TEST-INFO | 25949: exit 0 05:31:52 INFO - TEST-OK | kraken | took 58974ms 05:31:52 INFO - SUITE-END | took 1167s 05:31:52 INFO - Completed test suite (00:19:27) 05:31:52 INFO - javascript benchmark 05:31:52 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 9142.44392560608, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3598.15443370808, 3627.709783217343, 3628.437592173213, 3630.3283892479885, 3653.1232504199, 6343.397377249165, 6385.457236134928, 6450.000249961257, 6482.189726284215, 6484.546081774278, 6365.331640177784, 6381.649009304487, 6483.935160648392, 6485.48116150708, 6490.286068532458, 5574.0, 5582.665040097587, 5618.0449323615085, 5641.0, 5642.407547207546, 5639.407862174474, 5656.434356564352, 5678.148277758349, 5705.058665320217, 5712.2574065371655, 5620.0, 5673.149027645845, 5714.1428785682065, 5723.9713801430935, 5725.713714314288, 5576.525995290405, 5611.102223644198, 5627.409122042209, 5641.294838145232, 5665.5467562594895, 5515.586331025189, 5522.061249587539, 5543.1408131739645, 5557.694326812024, 5564.081926482126, 6174.5060395168275, 6225.657588832612, 6263.060540918853, 6264.7807326743805, 6272.341404152544, 6750.594964302158, 6793.150856142982, 6831.69257383419, 6839.1451068616425, 6886.621235832027, 6880.105586273752, 6953.374196322356, 6970.860582788367, 7032.085828842269, 7034.296570342976, 6371.139896114058, 6406.775762848324, 6434.485241180694, 6438.1630388049725, 6454.451371633417, 6922.480813938974, 7101.0, 7132.108486439195, 7134.215236324104, 7138.892916606255, 6781.830454238585, 6783.253842077367, 6810.387065164159, 6823.965880170666, 6931.826704332432, 6933.306669333027, 6984.79045628632, 6989.0, 7000.054992576039, 7021.824454388579, 6760.864782704319, 6835.487338449636, 6838.0, 6930.13373328334, 6980.371766541036, 6888.448924086061, 6953.89569156463, 6956.721731130698, 6962.199347075151, 6967.1291088613925, 5066.746662666852, 5085.364329458817, 5123.538881500683, 5130.4356520782685, 5140.845774626767, 4541.659375546781, 4559.52125026874, 4599.563041511051, 4604.677672562889, 4614.330922016289, 6446.323136070645, 6572.309907459648, 6579.0, 6613.074169616258, 6615.0, 7011.193712723, 7014.473914456436, 7019.543729657556, 7025.89461158083, 7038.3665470107935, 6428.8071357859335, 6501.252355979028, 6522.804315870531, 6590.3080176581725, 6597.0, 5748.540116790647, 5809.767609295665, 5834.299884013945, 5869.236999190078, 5870.207521984563, 7078.893816592756, 7088.113985751781, 7098.538594991309, 7099.89350159748, 7107.8933815992805, 6969.477289203229, 7007.404370628554, 7049.118860142482, 7061.470389720689, 7062.081929349151, 7005.719771209095, 7013.193482749549, 7066.823329416806, 7090.751823686146, 7177.964110179416, 6626.6686665667485, 6731.124953755981, 6767.560108593123, 6803.93196068033, 6859.279775623488, 6905.309469053054, 6906.723731050702, 6931.584104953719, 7001.054857594159, 7051.964740176266, 6771.3905748482875, 6829.0, 6836.589804611739, 6841.076454678555, 6846.383825455733, 6733.966330168318, 6739.629320387426, 6753.088333074972, 6815.795526134224, 6820.147481564804, 6709.496787741036, 6749.628770417674, 6762.8985565217545, 6769.661516924232, 6834.658267086726, 6829.0, 6883.483738719516, 6908.3437073477935, 6930.930690693231, 6948.374646281859, 6653.866922661617, 6655.700493477708, 6665.600063996176, 6722.0, 6731.293214212633], "value": 6313.417429195156, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [904.0913881549044, 937.1799675284126, 952.8713623660806, 972.7616733900192, 977.3647129365906, 42677.359839602395, 43002.56997430025, 43012.99999999996, 43069.0, 43475.56524434755, 38598.61401385985, 39047.0, 39053.21893562134, 39117.02207444808, 39147.41278880812, 7054.823629409255, 7169.318914703121, 7173.6771845267085, 7177.425805935539, 7181.85636287274, 6956.686949087303, 6984.511084224081, 7056.54132481387, 7060.011598376232, 7060.576365418091, 7567.924320756777, 7658.119316278616, 7669.539827610333, 7671.501352412075, 7671.961640191791, 7519.624018799065, 7626.38988880891, 7653.579053152074, 7663.540187588706, 7673.53958762476, 7522.210167932398, 7600.125985511681, 7611.505252158648, 7612.961935190288, 7618.238176182393, 40620.59379406198, 40799.0, 40868.0, 40876.18247635031, 40969.38545921814, 3617.1861331200535, 3640.7815531067954, 3670.8436842394563, 3693.501377314055, 3696.963030369716, 30932.690673093206, 31051.0, 31132.0, 31145.532817007763, 31190.688093119006, 4495.393121928563, 4511.03012852235, 4513.390692256569, 4525.389072475239, 4532.909341813145, 212977.0, 214716.0, 221087.89456052778, 222097.0, 225066.0, 52071.73964130155, 52086.47913520892, 52115.478845211066, 52168.739156304735, 52209.47790522046, 55059.0, 55070.173947390824, 55132.0, 55182.44817551853, 55245.723771380886, 17883.28466861311, 18009.18958646838, 18021.098945052956, 18047.187876545588, 18108.275668973358, 14931.776023359658, 15037.097774133586, 15112.622184445478, 15152.848471515365, 15176.924115379352, 14777.0, 14949.402023918921, 15025.924870375578, 15067.0, 15219.923900380427, 6018.8194354169445, 6094.360092190344, 6104.725287362079, 6146.678464130234, 6167.198264225712, 1102.1458369763498, 1120.1151090638468, 1127.0532752487786, 1128.0975219824109, 1128.7516746315798, 25271.0, 25275.62086568703, 25357.112501062373, 25360.746392536206, 25515.0, 1238.8451443569554, 1240.1173487146482, 1249.2192379762648, 1253.8307328510716, 1257.0948916779903, 13360.131591446525, 13385.263810490516, 13406.0, 18290.268389264547, 18355.908220459078, 295962.0, 296844.0, 299185.0, 299311.0, 300104.0, 63715.0, 63745.68127159427, 63841.361586383544, 64021.35978640247, 64326.35673643297, 1590.3161640494698, 1634.0849124490323, 1634.47696737043, 1640.9343626254815, 1649.389725801461, 30697.693023069485, 31145.532817007308, 31296.530552041284, 31410.371792564478, 32415.351692965538, 42649.0, 42707.3593896098, 42860.78569607132, 42911.78544107259, 42951.140977180905, 241632.0, 243440.0, 243946.0, 244726.0, 244845.0, 38283.425748613234, 38803.80598096991, 41336.1732765349, 41449.1710165789, 41489.1702165961, 50714.492855070974, 51595.742021289654, 51986.22020669769, 52261.216081758044, 52290.47709522856, 37121.81439092787, 37234.813825930694, 37323.50705971731, 37439.0, 37571.81214093912, 37232.627673724, 37376.62623373731, 37583.0, 37623.623763763106, 37921.0, 42649.57350426456, 43701.56298437102, 43992.34011489894, 44004.55995440004, 44112.77943610262, 35584.28831423409, 36022.27955440929, 36286.45570316395, 36445.27109457743, 36754.81622591977, 26773.33066673271, 26836.0, 26870.0, 27318.0, 27713.72286277192], "value": 18849.680847447435, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [595.1489370200611, 612.6140531465177, 613.267145760816, 613.4478968927964, 635.923689157301, 23501.882490587544, 24177.39556511086, 24202.75797242027, 24220.636690449657, 24800.379990500245, 29505.819767209287, 30003.24991875204, 30123.84938075312, 30174.09477715672, 30265.848670756615, 6323.399277068671, 6480.513961452886, 6483.740650373979, 6487.318831522693, 6489.415952564268, 6094.847628809293, 6324.177856878599, 6351.39661732137, 6367.235931688181, 6424.16485856838, 6288.622682639033, 6310.684465776716, 6352.428281454668, 6357.141785858896, 6357.523185761063, 6253.53098517613, 6258.718357673893, 6270.843228919268, 6285.96857015712, 6298.401651843091, 5817.970910145465, 5860.531157507389, 5860.619059761102, 5877.9118313225335, 5878.5297176225795, 32116.678833211838, 32423.51364729531, 32541.511877321624, 32939.341213175605, 33547.16132096693, 2302.401375642345, 2340.461693810416, 2346.3547524430746, 2352.023910077316, 2359.917402890908, 20100.195992160297, 20881.269155579634, 20905.8954705227, 20955.8952205238, 20967.895160524098, 2391.1033362489065, 2403.927882163538, 2474.5545801755675, 2479.7396273391396, 2482.8510289382693, 148444.0, 153542.0, 154739.0, 154960.2251988733, 154971.0, 15759.0, 16304.592385190464, 16727.897132816743, 16873.831261687472, 17067.231974561175, 26268.474630507666, 26405.0, 26544.203673889813, 26566.46867062648, 26579.33551661224, 10222.335548189343, 10236.692899213036, 10368.896311036944, 10370.585176593002, 10456.0, 9044.502552359552, 9116.407433516933, 9201.815963680689, 9367.484788336571, 9799.559019843982, 8815.603297851612, 10025.849612255823, 10143.0, 10178.506265964887, 10501.684949451375, 2800.8599570021415, 2873.7700983921236, 2913.8543072846273, 2918.8102773319665, 2948.8673009714616, 1051.75283808305, 1069.7379142110233, 1070.1920050362082, 1072.6771112416973, 1088.8094583447864, 22346.21788237404, 22543.661845072336, 22920.4269893254, 23028.769712302663, 23036.65445018326, 1150.7640933608757, 1152.0380482297207, 1152.5793085523724, 1156.8669602995594, 1159.5593674403672, 15124.39502419913, 15726.135062571668, 15751.44869929547, 15970.36118555268, 16224.675506489804, 661676.0, 662225.0, 664160.0, 674256.0, 687435.0, 143281.0, 147922.26038869738, 152154.0, 153049.0, 153235.23382383017, 1323.563224136052, 1345.2668295778628, 1399.244408019658, 1416.3201663201721, 1417.9858201417853, 22954.42613934665, 24376.90303936292, 24379.878100609385, 24524.6321305177, 24592.139275126, 63855.680721596094, 64038.35961640324, 65288.347116528224, 66292.0, 68289.3171068283, 78021.0, 79083.20916790758, 79084.60457697675, 79193.0, 79298.0, 19058.904705476383, 21282.0, 22724.659130113392, 23077.0, 23924.760752392252, 25961.0, 26128.73871261263, 27120.0, 27365.179044628694, 27403.725962740118, 21667.674984874924, 21975.23086691958, 21980.0, 22093.447663808533, 22178.0, 19039.333623323117, 19655.606887861875, 19691.310804121786, 19975.80145191235, 20479.59040819205, 21671.566568668855, 22436.214732484284, 22680.432989175402, 22855.428614284112, 22880.885595571915, 22842.42893927665, 23504.882475587514, 23593.0, 23819.88090059608, 23850.40373990664, 18748.906255468635, 20026.0, 21260.681089783357, 21666.67499987533, 21678.132874685467], "value": 13610.842270692878, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1450.6663467402498, 1470.2060887120956, 1517.2565442932953, 1520.3386526860813, 1543.9768403473956, 15424.92287538562, 16042.91978540107, 16054.83945160548, 16056.357745690188, 16081.597960051005, 15887.602809929758, 16835.83164168358, 16855.0, 16875.240614172362, 16879.49361519153, 3028.1067085209916, 3064.4943584308617, 3099.380123975203, 3121.375724855027, 3122.8126312421214, 2877.7985541012135, 2884.480793457177, 2927.077970439305, 2993.536001919706, 2995.026616349684, 3022.2897619059504, 3022.350194708137, 3049.4815881300233, 3052.0996306089755, 3052.8931487397945, 2733.1117386849255, 2742.4103817679197, 2907.3313137978384, 2910.5925170476257, 2994.7454466370386, 2919.7664186865, 2925.80982236154, 2926.88292468301, 2954.3057381515328, 2966.9851650741607, 15820.446284379992, 15831.0, 15835.60410989723, 15929.203539823078, 15946.362145514166, 8742.475451472868, 9036.0, 9056.139666731717, 9060.68287609937, 9063.954680226556, 5497.147942068986, 5642.57680673947, 5667.376588575254, 5773.422657734235, 5790.565707571906, 1848.7042073268346, 1867.4304337177155, 1872.382113902409, 1905.1522072677665, 1909.5703466720015, 27822.443551128865, 27871.581926271123, 28053.719462805315, 28074.85962570174, 28090.438191236266, 7299.270072992765, 7525.172231054579, 7630.923690763021, 7723.304902558797, 7765.417593680384, 18483.815161848208, 18668.53328666767, 18672.06639668011, 18769.90615046916, 18772.155253013374, 8584.74245772628, 8684.826303474021, 8797.736067917973, 8803.383763136648, 8825.161609647073, 7914.643841027168, 8017.0, 8135.1051384347675, 8163.469374490758, 8165.95917020423, 5595.832125036255, 5680.261565996477, 5864.530837532987, 6052.727627256784, 6072.635641861502, 1727.9654406912043, 1761.6917039518032, 1764.0474143962374, 1783.3223375117373, 1786.8391844734037, 906.4334790755778, 951.6383774165772, 953.4803532075035, 954.6229239450518, 964.4454438697777, 8956.776080597907, 8967.955160224157, 9042.954785226031, 9113.817723645623, 9126.543672816333, 1047.7694907120422, 1057.7144171073767, 1103.9724006899892, 1105.795427845851, 1122.5004872831676, 5478.233047373371, 5597.0, 5819.88360232793, 5958.940410595838, 6330.556861019684, 23232.0, 23327.650085248733, 23748.287551373487, 23980.52038959246, 23990.52018959611, 23174.1889033883, 24127.51744965091, 24144.758552414252, 24156.154534591205, 24159.879200603886, 11157.497912593954, 11334.149938754792, 11637.592684256011, 11810.527578896748, 11888.583899563646, 9314.44113353201, 9392.95303523478, 9464.95267523658, 9538.046195380406, 9966.053224943618, 19904.50238744043, 20204.19183232713, 20328.59342813165, 20395.286164984154, 20602.690959635318, 20668.793312066686, 20737.377878663665, 20825.583488329845, 20861.478463038544, 21362.252321168686, 13085.345732713517, 13331.866681333451, 13454.327283635976, 13461.461541538229, 13498.325083745576, 12213.595720900683, 14588.562343129723, 14720.19038952825, 14737.0, 14739.484118055816, 11137.0, 11570.0, 12298.462692163479, 12640.810387844005, 12775.808362874379, 11709.414529273672, 11782.646520604396, 11908.285502869856, 11921.94039029834, 12123.818142728043, 10402.687919362432, 10484.528196231035, 10558.102561282378, 10616.575336986434, 10635.89364106349, 8119.59402029908, 8146.877796833171, 8218.506889586644, 8238.116374989373, 8334.208250216463, 8191.508509489449, 8223.136570659995, 8226.0, 8253.380996425412, 8257.21556452136], "value": 7288.94761391604, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [540.3272925208116, 544.1918750655276, 556.1990733343985, 557.9302587176603, 566.2129639800678, 6316.115743795866, 6347.206599175103, 6350.0, 6371.139896114023, 6401.935980640193, 6199.44205021548, 6251.187345645071, 6255.562110652245, 6262.467690246334, 6280.5289603279825, 5013.573846223076, 5039.445660977308, 5048.1670524363435, 5052.621053420999, 5071.0, 4813.446453657839, 4924.630652701044, 4925.655204135712, 4937.432195297533, 5004.223500657251, 4832.806687732486, 4836.992648051072, 4871.757701786039, 4902.436219834711, 4917.606591472673, 4841.709497430165, 4846.224604063333, 4893.168161412551, 4900.529841047689, 4904.852854414374, 4429.424174857248, 4470.329450582406, 4485.0, 4486.125205584913, 4499.280115181588, 6121.938780612181, 6179.196704428396, 6212.627242365473, 6216.2540495140875, 6223.6081335671715, 5754.625949313281, 5790.743803304567, 5796.391378905197, 5908.172855800191, 5936.7328470218945, 6620.238672552622, 6630.303818099078, 6666.799996000128, 6678.565893216925, 6717.395434410878, 5015.8212819987275, 5030.2957585938, 5045.924311135336, 5096.311997880276, 5115.363083813181, 6827.590344579291, 6873.690683919235, 6917.584944903271, 7019.736447439459, 7054.788356349318, 5153.175491921274, 5156.484351564814, 5169.0, 5204.193350030751, 5243.973780131075, 5199.610029247746, 5212.50481204285, 5289.127293996525, 5325.946740532622, 5342.492463215988, 5859.736311865976, 5861.794837180678, 5868.559858010666, 5868.794592189253, 5895.941040589625, 6675.897092415874, 6731.899021514681, 6770.830729231809, 6772.69522871472, 6819.454443644497, 1823.717323814811, 1825.2607693884, 1832.2854086906118, 1849.2972670385168, 1852.7498787663762, 1268.8033354830015, 1285.4087119924752, 1297.202220634303, 1302.4008955880402, 1322.9206247625173, 6359.523035772336, 6432.42108210254, 6460.450861676716, 6505.60966342021, 6527.8694426111215, 6660.090275909508, 6739.52823302374, 6792.184937807495, 6801.857414914286, 6880.58716477013, 6315.715792789336, 6389.6805159741825, 6411.775587854403, 6445.9355406446275, 6468.870622587616, 3582.390993531106, 3623.655752703489, 3649.9635003649623, 3660.401115208232, 3660.7986560739414, 7065.682044308019, 7067.89398159028, 7097.964510177416, 7135.0, 7159.353348729717, 6951.227437003532, 7009.684564194624, 7056.647167641598, 7064.646767661597, 7073.328033836778, 7066.152061752623, 7099.609521476368, 7103.573785572882, 7128.073350464407, 7130.251323610946, 6856.902895536889, 6889.311068893271, 6896.724131034703, 6907.6184763048595, 6939.653017349011, 6698.464122870256, 6792.150981127359, 6815.897761533482, 6826.283240259701, 6829.556078854858, 7030.191527974348, 7068.11648543932, 7076.22161562238, 7111.466640001917, 7132.216945763559, 5227.634065615371, 5257.973710131425, 5260.6843589383225, 5262.815801446931, 5265.657732247391, 6642.4021838034805, 6819.488538359544, 6863.691133898887, 6998.1952075509935, 7003.649817509002, 6258.843528911631, 6635.23694775107, 6690.230623478362, 6728.293529179366, 6739.742186367425, 6627.569208001464, 6630.668466576748, 6683.966580167068, 6694.029365742038, 6737.494687898329, 6613.834654133685, 6705.0, 6709.93290067093, 6726.428253598499, 6742.741181703987, 6625.668716564249, 6701.798946031627, 6740.0, 6757.0, 6795.082663840319, 6471.2234531856475, 6568.868622627425, 6577.934220657732, 6582.341765823379, 6632.50256230775], "value": 5226.332377094434, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [957.5116690487854, 959.9616015359386, 960.4765402855443, 992.1071036067543, 994.4431118573599, 19306.51733706656, 20289.898550507245, 20304.89847550762, 20343.084561194744, 22395.768232747192, 22691.432714182152, 22800.77199228007, 22873.542529149407, 23070.65394019087, 23117.0, 1013.8327176015948, 1096.9396683182422, 1099.5766629847487, 1099.6975831646282, 1101.1081024370285, 1035.663409391947, 1074.5648012554889, 1078.9352638841656, 1093.8577984861997, 1094.9178811589163, 1126.9154813388989, 1129.5199540195383, 1129.6723950054475, 1129.813580759178, 1131.2420678145663, 1119.4906317625503, 1122.0182340452104, 1124.8481455003553, 1125.5441546173813, 1133.6372360844532, 819.1439945257221, 823.6458322921142, 825.475822852487, 825.9710910118117, 826.0500424511799, 18051.368202112862, 18096.366627168118, 18148.4555463335, 18766.0, 21252.25617103394, 21787.34637960848, 21800.89099554508, 22198.556028879495, 22217.888910555506, 22349.888250558644, 14839.183844888526, 15507.0, 15520.223988800628, 15539.300731466998, 15629.531114066596, 3534.9469757953652, 3573.285342931424, 3573.4818451324672, 3573.6426357364317, 3574.928501429983, 148011.0, 148601.2569937165, 150513.0, 150926.24536877245, 152565.0, 16046.75929861053, 16654.08402537872, 16708.24812883423, 16709.331626734795, 16768.49694509142, 31705.5244171333, 32248.032559023268, 32344.35311293761, 32575.51136732951, 32717.345653086806, 8634.5251011195, 8796.12038796128, 8852.336074794288, 8855.822883542292, 8927.151920567536, 4419.955800442019, 4441.333799930037, 4503.954960450354, 4524.0, 4530.207213737649, 5624.21261023457, 5672.5745569081655, 5713.485786279255, 5726.713664316768, 5767.36558978512, 1011.5498603121688, 1020.8366661334151, 1040.079529616295, 1042.0361165921493, 1042.9791404171874, 740.1118657610889, 754.909410870699, 756.9962150189324, 774.7249726347178, 777.1373775109623, 12755.42600582976, 13313.134646247963, 13581.11722738019, 13618.0, 13633.0, 686.4679873098389, 699.8530308635244, 707.7664370757637, 717.4726575966661, 719.8632259870712, 6022.0, 6030.849228769316, 6034.2155519782145, 6117.897713130873, 6128.754849806047, 128841.0, 131229.0, 132352.3382383082, 132553.3372333132, 133233.33383333022, 119888.40055799665, 120220.0, 122360.0, 122691.0, 123113.38443307726, 102327.4883625577, 103235.0, 105296.47351763345, 107269.0, 108055.0, 11823.231489953125, 11846.407679616157, 11875.643730688093, 11900.345480998629, 12014.75970480603, 49004.0, 49205.507944921526, 49240.507594925024, 50157.498425015285, 51244.487555125466, 62522.37477625166, 63201.0, 63225.36774632379, 63490.68254658882, 63701.0, 16476.917615411847, 16632.91683541623, 16633.584160396087, 16801.159942003094, 16946.830531694526, 18057.0, 18211.089445527406, 18338.633227335646, 18539.81460185381, 18547.72178417298, 15522.84477155214, 15690.843091569395, 15716.764248536052, 15723.213839308217, 15822.446214382442, 16124.596885077966, 16390.67218655644, 16497.0, 16602.16989150562, 16635.66728665444, 16074.919625401799, 16216.513504594881, 16304.0, 16439.753403699193, 16510.33958641641, 12305.26168429897, 12581.811272830731, 12709.682257943625, 12762.61712148637, 12804.10371274002, 12544.560940367044, 12647.557335493213, 12747.553835615709, 12779.744405112031, 12955.417006234553], "value": 9463.051064352907, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1460.3000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 106.0, 98.0, 106.0, 105.0, 106.0, 109.0, 96.0, 105.0, 110.0], "value": 103.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 114.0, 145.0, 169.0, 111.0, 149.0, 139.0, 115.0, 161.0, 113.0], "value": 135.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 164.0, 161.0, 160.0, 161.0, 161.0, 162.0, 162.0, 163.0, 162.0], "value": 161.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 73.0, 73.0, 172.0, 76.0, 76.0, 75.0, 75.0, 162.0, 77.0], "value": 93.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 78.0, 124.0, 78.0, 77.0, 77.0, 124.0, 77.0, 77.0, 139.0], "value": 92.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 113.0, 114.0, 113.0, 117.0, 113.0, 114.0, 114.0, 114.0, 114.0], "value": 113.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 149.0, 148.0, 148.0, 148.0, 147.0, 147.0, 149.0, 150.0, 147.0], "value": 148.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 94.0, 94.0, 94.0, 94.0, 94.0, 93.0, 94.0, 94.0, 94.0], "value": 93.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [45.0, 49.0, 52.0, 46.0, 48.0, 45.0, 45.0, 45.0, 45.0, 45.0], "value": 46.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 52.0, 52.0, 52.0, 52.0, 57.0, 52.0, 53.0, 51.0, 52.0], "value": 52.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 75.0, 80.0, 72.0, 72.0, 74.0, 73.0, 73.0, 74.0, 72.0], "value": 73.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 132.0, 116.0, 130.0, 117.0, 122.0, 120.0, 114.0, 131.0, 133.0], "value": 123.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 160.0, 157.0, 159.0, 161.0, 159.0, 165.0, 160.0, 158.0, 170.0], "value": 161.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 60.0, 60.0, 60.0, 64.0, 59.0, 60.0, 59.0, 58.0, 59.0], "value": 60.0, "unit": "score"}]}]} 05:31:53 INFO - Return code: 0 05:31:53 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:31:53 INFO - # TBPL SUCCESS # 05:31:53 INFO - Running post-action listener: _package_coverage_data 05:31:53 INFO - Running post-action listener: _resource_record_post_action 05:31:53 INFO - [mozharness: 2017-09-13 12:31:53.068982Z] Finished run-tests step (success) 05:31:53 INFO - Running post-run listener: _resource_record_post_run 05:31:53 INFO - Total resource usage - Wall time: 1183s; CPU: 13.0%; Read bytes: 507904; Write bytes: 336142336; Read time: 296; Write time: 178132 05:31:53 INFO - TinderboxPrint: CPU usage
13.0% 05:31:53 INFO - TinderboxPrint: I/O read bytes / time
507,904 / 296 05:31:53 INFO - TinderboxPrint: I/O write bytes / time
336,142,336 / 178,132 05:31:53 INFO - TinderboxPrint: CPU idle
8,202.9 (87.0%) 05:31:53 INFO - TinderboxPrint: CPU user
1,181.8 (12.5%) 05:31:53 INFO - TinderboxPrint: Swap in / out
0 / 0 05:31:53 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 4096; Write bytes: 67989504; Read time: 172; Write time: 32080 05:31:53 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 05:31:53 INFO - run-tests - Wall time: 1168s; CPU: 13.0%; Read bytes: 499712; Write bytes: 268152832; Read time: 108; Write time: 146052 05:31:53 INFO - Running post-run listener: _upload_blobber_files 05:31:53 INFO - Blob upload gear active. 05:31:53 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:31:53 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 05:31:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:31:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:31:54 INFO - (blobuploader) - INFO - Open directory for files ... 05:31:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 05:31:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:31:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:32:00 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:32:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:32:00 INFO - (blobuploader) - INFO - Done attempting. 05:32:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 05:32:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:32:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:32:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 05:32:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:32:01 INFO - (blobuploader) - INFO - Done attempting. 05:32:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 05:32:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:32:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:32:02 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 05:32:02 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:32:02 INFO - (blobuploader) - INFO - Done attempting. 05:32:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 05:32:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:32:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:32:03 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 05:32:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:32:03 INFO - (blobuploader) - INFO - Done attempting. 05:32:03 INFO - (blobuploader) - INFO - Iteration through files over. 05:32:03 INFO - Return code: 0 05:32:03 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:32:03 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:32:03 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/aae5d0e64b47ba3bc53cdfd315bcafedd4039cf6f72835152391b97995380086f82cd0a1ffa1f1e149888cf8bc07f3f7944491a8a97f4b2b82697e5999fc57d7", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/e000b9db44e964b2bd244094e88205dde1e260ad8c47b4d1834814dcf7249627d1bace973470dea9fd5510a5b8f77c9b58e4d1c711e6afc397d5174ef9a280c3", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d6f881c1493d31cabb4486d9a4ffb89a14fc5ddc53dfe8b40c55239cef1996e34c64abd79983bdd687641446a678cba0c8f09eadd36957acb7007bc4277fa106", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d6fbbee1f708119b7566fbfae8111437a4e39a20babf579ce6a91c1c2b9398b3562eaec256105568ff9d2d95bb2b25f1cde2811d1dc2cc4b3afad5e335391265"} 05:32:03 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:32:03 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:32:03 INFO - Contents: 05:32:03 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/aae5d0e64b47ba3bc53cdfd315bcafedd4039cf6f72835152391b97995380086f82cd0a1ffa1f1e149888cf8bc07f3f7944491a8a97f4b2b82697e5999fc57d7", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/e000b9db44e964b2bd244094e88205dde1e260ad8c47b4d1834814dcf7249627d1bace973470dea9fd5510a5b8f77c9b58e4d1c711e6afc397d5174ef9a280c3", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d6f881c1493d31cabb4486d9a4ffb89a14fc5ddc53dfe8b40c55239cef1996e34c64abd79983bdd687641446a678cba0c8f09eadd36957acb7007bc4277fa106", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d6fbbee1f708119b7566fbfae8111437a4e39a20babf579ce6a91c1c2b9398b3562eaec256105568ff9d2d95bb2b25f1cde2811d1dc2cc4b3afad5e335391265"} 05:32:03 INFO - Running post-run listener: copy_logs_to_upload_dir 05:32:03 INFO - Copying logs to upload dir... 05:32:03 INFO - mkdir: /builds/slave/test/build/upload/logs 05:32:03 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.879142 ========= master_lag: -0.09 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2017-09-13 05:32:03.835720) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-13 05:32:03.839006) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=dac658600622fd96716c9acf000001b3-1505302147.882449-517250158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/aae5d0e64b47ba3bc53cdfd315bcafedd4039cf6f72835152391b97995380086f82cd0a1ffa1f1e149888cf8bc07f3f7944491a8a97f4b2b82697e5999fc57d7", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/e000b9db44e964b2bd244094e88205dde1e260ad8c47b4d1834814dcf7249627d1bace973470dea9fd5510a5b8f77c9b58e4d1c711e6afc397d5174ef9a280c3", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d6f881c1493d31cabb4486d9a4ffb89a14fc5ddc53dfe8b40c55239cef1996e34c64abd79983bdd687641446a678cba0c8f09eadd36957acb7007bc4277fa106", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d6fbbee1f708119b7566fbfae8111437a4e39a20babf579ce6a91c1c2b9398b3562eaec256105568ff9d2d95bb2b25f1cde2811d1dc2cc4b3afad5e335391265"} build_url:https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011288 build_url: 'https://queue.taskcluster.net/v1/task/PcHb8D8WQ7CpRTiLR8nJfQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/aae5d0e64b47ba3bc53cdfd315bcafedd4039cf6f72835152391b97995380086f82cd0a1ffa1f1e149888cf8bc07f3f7944491a8a97f4b2b82697e5999fc57d7", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/e000b9db44e964b2bd244094e88205dde1e260ad8c47b4d1834814dcf7249627d1bace973470dea9fd5510a5b8f77c9b58e4d1c711e6afc397d5174ef9a280c3", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d6f881c1493d31cabb4486d9a4ffb89a14fc5ddc53dfe8b40c55239cef1996e34c64abd79983bdd687641446a678cba0c8f09eadd36957acb7007bc4277fa106", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/d6fbbee1f708119b7566fbfae8111437a4e39a20babf579ce6a91c1c2b9398b3562eaec256105568ff9d2d95bb2b25f1cde2811d1dc2cc4b3afad5e335391265"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-13 05:32:03.867976) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 05:32:03.868363) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=dac658600622fd96716c9acf000001b3-1505302147.882449-517250158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004484 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 05:32:03.949515) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-13 05:32:03.949816) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-13 05:32:03.950165) ========= ========= Total master_lag: 0.10 =========